After doing some further reading I'm not pretty sure there's a much easier way to do this... I've been trying to pull some numbers out of the PRI trunk to copper ports.
I have this AdTran registered as a Endpoint with my VoIP provider. Since I was originally unsure of how to do this otherwise I decided to pull two numbers out of that trunk and point them at our main gateway, and Asterisk server. I then set up two SIP users on the FXS ports to register to our asterisk box.
We can call out from those ports but inbound calls result in 486 BUSY HERE.
Looking over things again I'm starting to think there is probably a more elegant way to to point certain DIDs to the FXS ports I want from the PRI, instead of this ridiculous workaround that is not actually working. But I am unclear on how to do this....
If that's not the case, here is my current config:
Any help would be greatly appreciated!
!
!
! ADTRAN, Inc. OS version A4.11.00.E
! Boot ROM version 14.04.00
! Platform: Total Access 916 (2nd Gen), part number 4212916L1
! Serial number CFG1326470
!
!
hostname "XXXXXXXXXXXXXXXX"
enable password XXXXXXXXXXXXXXXX
!
clock timezone -5-Eastern-Time
!
ip subnet-zero
ip classless
ip default-gateway XXXXXXXXXXXXXXXX
ip routing
!
!
ip name-server XXXXXXXXXXXXXXXX XXXXXXXXXXXXXXXX
!
!
no auto-config
!
event-history on
no logging forwarding
no logging email
!
no service password-encryption
!
username "XXXXXXXXXXXXXXXX" password "XXXXXXXXXXXXXXXX"
!
!
no ip firewall alg msn
no ip firewall alg mszone
no ip firewall alg h323
!
!
!
!
!
no dot11ap access-point-control
!
!
!
!
!
!
!
!
!
!
!
!
!
interface eth 0/1
ip address XXXXXXXXXXXXXXXX 255.255.255.252
media-gateway ip primary
no awcp
no shutdown
!
!
!
!
interface t1 0/1
shutdown
!
interface t1 0/2
tdm-group 1 timeslots 1-24 speed 64
no shutdown
!
!
interface pri 1
description PRI to PBX
isdn name-delivery setup
connect t1 0/2 tdm-group 1
role network b-channel-restarts disable
no shutdown
!
!
interface fxs 0/1
no shutdown
!
interface fxs 0/2
no shutdown
!
interface fxs 0/3
no shutdown
!
interface fxs 0/4
no shutdown
!
interface fxs 0/5
no shutdown
!
interface fxs 0/6
no shutdown
!
interface fxs 0/7
no shutdown
!
interface fxs 0/8
no shutdown
!
interface fxs 0/9
no shutdown
!
interface fxs 0/10
no shutdown
!
interface fxs 0/11
no shutdown
!
interface fxs 0/12
no shutdown
!
interface fxs 0/13
no shutdown
!
interface fxs 0/14
no shutdown
!
interface fxs 0/15
no shutdown
!
interface fxs 0/16
no shutdown
!
!
isdn-group 1
connect pri 1
!
!
!
!
!
!
!
!
!
!
ip route 0.0.0.0 0.0.0.0 XXXXXXXXXXXXXXXX
!
no ip tftp server
no ip tftp server overwrite
ip http server
no ip http secure-server
no ip snmp agent
no ip ftp server
no ip scp server
no ip sntp server
!
!
!
!
!
!
ip sip
ip sip udp 5060
no ip sip tcp
!
!
!
voice feature-mode network
voice forward-mode network
!
!
!
!
!
!
!
voice dial-plan 1 local NXX-XXXX
voice dial-plan 3 international 011-$
voice dial-plan 4 long-distance 1-NXX-NXX-XXXX
!
!
!
!
voice codec-list "PRI to PBX"
codec g729
codec g711ulaw
!
!
!
voice trunk T01 type sip
description "vi1"
match dnis "NXX-XXXX" substitute "1-607-NXX-XXXX" name "local"
sip-server primary XXXXXXXXXXXXXXXX
codec-group "PRI to PBX"
!
voice trunk T02 type sip
description "vi2"
match dnis "NXX-XXXX" substitute "1-607-NXX-XXXX" name "local"
sip-server primary XXXXXXXXXXXXXXXX
!
voice trunk T03 type isdn
description "PRI to PBX"
resource-selection circular descending
connect isdn-group 1
modem-passthrough
t38
rtp delay-mode adaptive
rtp dtmf-relay inband
codec-group "PRI to PBX"
!
voice trunk T04 type sip
description "fxS15-SIP"
match dnis "NXX-XXXX" substitute "1-607-NXX-XXXX" name "local prefix"
sip-server primary XXXXXXXXXXXXXXXX
registrar primary XXXXXXXXXXXXXXXX
outbound-proxy primary XXXXXXXXXXXXXXXX
authentication username "XXXXXXXXXXXXXXXX" password "XXXXXXXXXXXXXXXX"
!
voice trunk T05 type sip
description "fxS16-SIP"
match dnis "NXX-XXXX" substitute "1-607-NXX-XXXX" name "local prefix"
sip-server primary XXXXXXXXXXXXXXXX
registrar primary XXXXXXXXXXXXXXXX
outbound-proxy primary XXXXXXXXXXXXXXXX
authentication username "XXXXXXXXXXXXXXXX" password "XXXXXXXXXXXXXXXX"
!
!
voice grouped-trunk "PRI TO PBX"
description "PRI to PBX"
trunk T03
accept $ cost 0
!
!
voice grouped-trunk "SIP VI"
description "SIP Trunk"
trunk T01
trunk T02
accept $ cost 0
!
!
voice grouped-trunk STANDALONE-PORTS
trunk T04
trunk T05
accept NXX-XXXX cost 0
accept 1-NXX-NXX-XXXX cost 0
accept 1-800-NXX-XXXX cost 0
accept 1-888-NXX-XXXX cost 0
accept 1-877-NXX-XXXX cost 0
accept 1-866-NXX-XXXX cost 0
accept 1-855-NXX-XXXX cost 0
accept 011-$ cost 0
accept 411 cost 0
accept 611 cost 0
accept 911 cost 0
accept 0-NXX-NXX-XXXX cost 0
accept 10-10-XXX-$ cost 0
reject 976-XXXX
reject 1-900-NXX-XXXX
reject 1-976-NXX-XXXX
!
!
voice user 9901
connect fxs 0/15
first-name "XXXXXXXXXXXXXXXX"
last-name "XXXXXXXXXXXXXXXX"
password "XXXXXXXXXXXXXXXX"
num-rings 9
sip-identity XXXXXXXXXXXXXXXX T04 register auth-name "XXXXXXXXXXXXXXXX" password "XXXXXXXXXXXXXXXX"
sip-authentication password "XXXXXXXXXXXXXXXX"
t38
codec-group "PRI to PBX"
!
!
voice user 9902
connect fxs 0/16
first-name "XXXXXXXXXXXXXXXX"
last-name "XXXXXXXXXXXXXXXX"
password "XXXXXXXXXXXXXXXX"
sip-identity XXXXXXXXXXXXXXXX T05 register auth-name "XXXXXXXXXXXXXXXX" password "XXXXXXXXXXXXXXXX"
sip-authentication password "XXXXXXXXXXXXXXXX"
t38
codec-group "PRI to PBX"
!
!
!
!
!
!
!
!
!
!
!
!
!
!
!
!
!
!
!
!
!
!
!
!
!
line con 0
login
!
line telnet 0 4
login
password XXXXXXXXXXXXXXXX
no shutdown
line ssh 0 4
login local-userlist
no shutdown
!
!
ntp source ethernet 0/1
ntp server XXXXXXXXXXXXXXXX version 3 source ethernet 0/1 prefer
!
!
!
end
Sam, direct TDM to TDM connection is not supported. You would need to route the numbers to a PBX before routing back to the 900. Thanks
Jay
Hello Jay, thanks for the reply!
Can you elaborate on that?
I have gotten things working a bit better and more streamlined. I can call into all the FXS ports I just cannot call out, I guess a 'Busy Here' message. This is my current configuration;
!
!
! ADTRAN, Inc. OS version A4.11.00.E
! Boot ROM version 14.04.00
! Platform: Total Access 916 (2nd Gen), part number 4212916L1
! Serial number CFG1326470
!
!
hostname "XXXXXXXXXXXXXXXXXXXX"
enable password XXXXXXXXXXXXXXXXXXXX
!
clock timezone -5-Eastern-Time
!
ip subnet-zero
ip classless
ip default-gateway XXXXXXXXXXXXXXXXXXXX
ip routing
!
!
ip name-server XXXXXXXXXXXXXXXXXXXX XXXXXXXXXXXXXXXXXXXX
!
!
no auto-config
!
event-history on
no logging forwarding
no logging email
!
no service password-encryption
!
username "admin" password "XXXXXXXXXXXXXXXXXXXX"
!
!
no ip firewall alg msn
no ip firewall alg mszone
no ip firewall alg h323
!
!
!
!
!
no dot11ap access-point-control
!
!
!
!
!
!
!
!
!
!
!
!
!
interface eth 0/1
ip address XXXXXXXXXXXXXXXXXXXX 255.255.255.252
media-gateway ip primary
no awcp
no shutdown
!
!
!
!
interface t1 0/1
shutdown
!
interface t1 0/2
tdm-group 1 timeslots 1-24 speed 64
no shutdown
!
!
interface pri 1
description PRI to PBX
isdn name-delivery setup
connect t1 0/2 tdm-group 1
role network b-channel-restarts disable
no shutdown
!
!
interface fxs 0/1
no shutdown
!
interface fxs 0/2
no shutdown
!
interface fxs 0/3
no shutdown
!
interface fxs 0/4
no shutdown
!
interface fxs 0/5
no shutdown
!
interface fxs 0/6
no shutdown
!
interface fxs 0/7
no shutdown
!
interface fxs 0/8
no shutdown
!
interface fxs 0/9
no shutdown
!
interface fxs 0/10
no shutdown
!
interface fxs 0/11
no shutdown
!
interface fxs 0/12
no shutdown
!
interface fxs 0/13
no shutdown
!
interface fxs 0/14
no shutdown
!
interface fxs 0/15
no shutdown
!
interface fxs 0/16
no shutdown
!
!
isdn-group 1
connect pri 1
!
!
!
!
!
!
!
!
!
!
ip route 0.0.0.0 0.0.0.0 XXXXXXXXXXXXXXXXXXXX
!
no ip tftp server
no ip tftp server overwrite
ip http server
no ip http secure-server
no ip snmp agent
no ip ftp server
no ip scp server
no ip sntp server
!
!
!
!
!
!
ip sip
ip sip udp 5060
no ip sip tcp
!
!
!
voice feature-mode network
voice forward-mode network
!
!
!
!
!
!
!
voice dial-plan 1 local NXX-XXXX
voice dial-plan 3 international 011-$
voice dial-plan 4 long-distance 1-NXX-NXX-XXXX
!
!
!
!
voice codec-list "PRI to PBX"
codec g729
codec g711ulaw
!
!
!
voice trunk T01 type sip
description "vi1"
match dnis "NXX-XXXX" substitute "1-607-NXX-XXXX" name "local"
sip-server primary XXXXXXXXXXXXXXXXXXXX
codec-group "PRI to PBX"
!
voice trunk T02 type sip
description "vi2"
match dnis "NXX-XXXX" substitute "1-607-NXX-XXXX" name "local"
sip-server primary XXXXXXXXXXXXXXXXXXXX
!
voice trunk T03 type isdn
description "PRI to PBX"
resource-selection circular descending
connect isdn-group 1
modem-passthrough
t38
rtp delay-mode adaptive
rtp dtmf-relay inband
codec-group "PRI to PBX"
!
!
voice grouped-trunk "PRI TO PBX"
description "PRI to PBX"
trunk T03
accept $ cost 0
!
!
voice grouped-trunk "SIP VI"
description "SIP Trunk"
trunk T01
trunk T02
accept $ cost 0
!
!
voice user 9901
connect fxs 0/15
first-name "XXXX"
last-name "XXXX"
password "1234"
caller-id-override external-number nnnnnn7603
caller-id-override internal-name "XXXX"
caller-id-override internal-number nnnnnn7603
did "nnnnnn7603"
sip-authentication password "1234"
modem-passthrough
t38
codec-group "PRI to PBX"
!
!
voice user 9902
connect fxs 0/16
first-name "XXXX"
last-name "XXXX"
password "1234"
caller-id-override external-number nnnnnn7439
caller-id-override internal-name "XXXX"
caller-id-override internal-number nnnnnn7439
did "nnnnnn7439"
sip-authentication password "1234"
modem-passthrough
t38
codec-group "PRI to PBX"
!
!
voice user 9903
connect fxs 0/14
first-name "XXXX"
last-name "pXXXX"
password "1234"
caller-id-override external-number nnnnnn4673
caller-id-override internal-name "XXXX"
caller-id-override internal-number nnnnnn4673
did "nnnnnn4673"
sip-authentication password "1234"
modem-passthrough
t38
codec-group "PRI to PBX"
!
!
!
!
!
!
!
!
!
!
!
!
!
!
!
!
!
!
!
!
!
!
!
!
!
line con 0
login
!
line telnet 0 4
login
password XXXXXXXXXXXXXXXXXXXX
no shutdown
line ssh 0 4
login local-userlist
no shutdown
!
!
ntp source ethernet 0/1
ntp server XXXXXXXXXXXXXXXXXXXX version 3 source ethernet 0/1 prefer
!
!
!
end
It does look like its trying to route the call from the FXS port into the ISDN PRI port. Is that what you were referring to with TDM to TDM?
I have a few options for how I can do this. I'd like to make it all work through the Adtran but if its not possible we can drop some smaller Cisco SPA122s. But here is my setup and what I have at my disposal:
This Adtran is setup as an Endpoint through my VoIP Wholesaler. You've seen the rest of the config.
I have an asterisk server set up as a separate endpoint through the same wholesaler. Would I be able to set up the FXS ports as entirely stand alone SIP users? I can take the three DIDs they want on the FXS ports and point them at the other endpoint. I tried this before with one of the lines and it didn't seem to work properly, but maybe I flubbed something up there. What would be the best way to have these two separate trunks working in tandem on the same unit?
Here is my debug info:
16:14:40.814 PM.0:14 Idle | Processed OFFHOOK |
16:14:40.815 PM.0:14 State change | >> Idle->Requesting Dialtone |
16:14:40.815 SA.9903 Ca:0 Idle | rcvd: AcctPhoneMgr_appearance(ON) from PM |
16:14:40.816 SA.9903 Ca:0 State change | >> Idle->DigitGathering |
16:14:40.816 SA.9903 Ca:0 DigitGathering | sent: AcctPhoneMgr_cachg(CAS_ReqDigits) to PM |
16:14:40.817 PM.0:14 Requesting Dialtone CACHG:ReqDigits on primary CA
16:14:40.817 PM.0:14 State change | >> Requesting Dialtone->SendingDigits |
16:14:40.819 TONESERVICES.EVENTS fxs 0/14 - empty - Tone Detection: Request resource
16:14:40.820 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: DSP channel allocated for the resource
16:14:40.821 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: constructed
16:14:40.821 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: starting
16:14:40.822 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: TDM map
16:14:41.321 TONESERVICES.EVENTS fxs 0/14 - empty - DialTone Generation: Request resource
16:14:41.322 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: DSP channel allocated for the resource
16:14:41.322 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: constructed
16:14:41.323 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: starting
16:14:41.323 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: TDM map
16:14:44.079 PM.0:14 SendingDigits | Digit 2 processed |
16:14:44.080 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (2) event
16:14:44.081 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: stopping
16:14:44.082 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: TDM unmap
16:14:44.082 RTP.CHANNEL fxs 0/14 - dsp 0/1.2 - DialTone Generation: releasing RTP resource
16:14:44.083 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: release
16:14:44.084 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(2) from PM |
16:14:44.084 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 second(s) for more digits |
16:14:44.369 PM.0:14 SendingDigits | Digit 2 processed |
16:14:44.371 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (2) event
16:14:44.371 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(2) from PM |
16:14:44.372 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:14:44.589 PM.0:14 SendingDigits | Digit 2 processed |
16:14:44.591 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (2) event
16:14:44.591 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(2) from PM |
16:14:44.592 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:14:44.969 PM.0:14 SendingDigits | Digit 5 processed |
16:14:44.970 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (5) event
16:14:44.971 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(5) from PM |
16:14:44.972 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:14:45.309 PM.0:14 SendingDigits | Digit 3 processed |
16:14:45.311 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (3) event
16:14:45.311 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(3) from PM |
16:14:45.312 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:14:45.770 PM.0:14 SendingDigits | Digit 9 processed |
16:14:45.771 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (9) event
16:14:45.771 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(9) from PM |
16:14:45.772 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:14:46.189 PM.0:14 SendingDigits | Digit 3 processed |
16:14:46.190 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (3) event
16:14:46.191 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(3) from PM |
16:14:46.192 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:14:50.192 SA.9903 Ca:0 State change | >> DigitGathering->DigitGathering |
16:14:50.193 SA.9903 Ca:0 DigitGathering | sent: AcctPhoneMgr_cachg(CAS_Active) to PM |
16:14:50.194 PM.0:14 State change | >> SendingDigits->Call Pending |
16:14:50.195 SA.9903 Ca:0 DigitGathering | sent: call to SB |
16:14:50.195 SA.9903 Ca:0 State change | >> DigitGathering->CallPending |
16:14:50.196 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: stopping
16:14:50.197 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: TDM unmap
16:14:50.198 RTP.CHANNEL fxs 0/14 - dsp 0/1.2 - Tone Detection: releasing RTP resource
16:14:50.198 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: release
16:14:50.199 SA.9903 rcvd: AcctPhoneMgr_billingCode from PM
16:14:50.199 SB.CALL 184 Idle | Called the call routine with 2225393 |
16:14:50 SB.TGMgr For dialed number 2225393, against template $, on TrunkGroup PRI TO PBX, the score is 500
16:14:50 SB.TGMgr For dialed number 2225393, against template $, on TrunkGroup SIP VI, the score is 500
16:14:50.201 SB.CCM isMappable:
16:14:50.202 SB.CCM : Call Struct 0x2952e10 : Call-ID = 184
16:14:50.202 SB.CCM : Org Acct = 9903 | Dst Acct = T03 |
16:14:50.203 SB.CCM : Org Port ID = 0/14.0 Dst Port ID = 0/0.0
16:14:50.203 SB.CCM : Org TID = Fxs Dst TID =
16:14:50.204 SB.CCM isMappable: Call Connection Type is TDM_TO_TDM
16:14:50.205 SB.CALL 184 Idle | Call sent from 9903 to T03 (2225393) |
16:14:50.205 SB.CALL 184 State change | >> Idle->Delivering |
16:14:50.206 SA.9903 Ca:0 CallPending | rcvd: callResponse from SB |
16:14:50.206 SA.9903 Ca:0 State change | >> CallPending->Calling |
16:14:50.207 TA.T03 07 State change | >> TAIdle->TAOutGoing (TAS_Delivering) |
16:14:50.208 TM.T03 07 tachg_Delivering
16:14:50.209 TM.T03 07 IsdnTmStateIdle->IsdnTmStateOutboundDeliver
16:14:50.210 TM.T03 07 IsdnTmStateOutboundDeliver::enter()
16:14:50.211 ISDN.L2_FMT PRI 1 ==============================================
16:14:50.212 ISDN.L2_FMT PRI 1 Sent Sapi:00 C/R:C Tei:00 INFO Ns:57 Nr:5 P:0
16:14:50.212 ISDN.L2_FMT PRI 1 | Prot:08 CRL:2 CRV:006C | |
16:14:50.212 ISDN.L2_FMT PRI 1 | M - 05 SETUP | |
16:14:50.213 ISDN.L2_FMT PRI 1 | IE - 04 BEARER CAPABILITY Len=3 | |
16:14:50.213 ISDN.L2_FMT PRI 1 | 80 Xfer Cap.:SPEECH | |
16:14:50.213 ISDN.L2_FMT PRI 1 | 90 Xfer Rate:64k | |
16:14:50.214 ISDN.L2_FMT PRI 1 | A2 Layer 1:u-Law | |
16:14:50.214 ISDN.L2_FMT PRI 1 | IE - 18 CHANNEL ID | Len=3 |
16:14:50.214 ISDN.L2_FMT PRI 1 | A1 Primary Rate | |
16:14:50.215 ISDN.L2_FMT PRI 1 | Intfc ID:IMPLICIT | |
16:14:50.215 ISDN.L2_FMT PRI 1 | Pref/Excl:PREFERRED | |
16:14:50.215 ISDN.L2_FMT PRI 1 | D-Chan Indicated:NO | |
16:14:50.216 ISDN.L2_FMT PRI 1 | Chan. Sel:FOLLOWS | |
16:14:50.216 ISDN.L2_FMT PRI 1 | 83 Numb/Map:NUMBER | |
16:14:50.216 ISDN.L2_FMT PRI 1 | 87 Channel:7 | |
16:14:50.217 ISDN.L2_FMT PRI 1 | IE - 1C FACILITY | Len=28 |
16:14:50.217 ISDN.L2_FMT PRI 1 | Calling Name: XXXXXXXXXXXXXXXXXXX | |
16:14:50.218 ISDN.L2_FMT PRI 1 | IE - 6C CALLING PARTY # | Len=12 |
16:14:50.218 ISDN.L2_FMT PRI 1 | 00 Numb. Type:UNKNOWN | |
16:14:50.218 ISDN.L2_FMT PRI 1 | Numb. Plan:UNKNOWN | |
16:14:50.219 ISDN.L2_FMT PRI 1 | 80 Presentation:ALLOWED | |
16:14:50.219 ISDN.L2_FMT PRI 1 | Ph.# 6073044673 | |
16:14:50.220 ISDN.L2_FMT PRI 1 | IE - 70 CALLED PARTY # | Len=8 |
16:14:50.220 ISDN.L2_FMT PRI 1 | 80 Numb. Type:UNKNOWN | |
16:14:50.220 ISDN.L2_FMT PRI 1 | Numb. Plan:UNKNOWN | |
16:14:50.221 ISDN.L2_FMT PRI 1 | Ph.# 2225393 | |
16:14:50.221 SB.CALL 184 Delivering | Called the deliverResponse routine from Delivering | |
16:14:50.222 SB.CALL 184 Delivering | DeliverResponse(accept) sent from T03 to 9903 | |
16:14:50.223 SA.9903 Ca:0 Calling | rcvd: deliverResponse from SB | |
16:14:50.223 SA.9903 Ca:0 Calling | sent: AcctPhoneMgr_info to PM |
16:14:50.224 PM.0:14 ERROR! APM_Info ignored
16:14:50.336 ISDN.L2_FMT PRI 1 ==============================================
16:14:50.337 ISDN.L2_FMT PRI 1 Recd Sapi:00 C/R:R Tei:00 INFO Ns:5 Nr:58 P:0
16:14:50.337 ISDN.L2_FMT PRI 1 | Prot:08 CRL:2 CRV:806C | |
16:14:50.337 ISDN.L2_FMT PRI 1 | M - 5A RELEASE_CMP | |
16:14:50.338 ISDN.L2_FMT PRI 1 | IE - 08 CAUSE | Len=2 |
16:14:50.338 ISDN.L2_FMT PRI 1 | 80 Location:U | |
16:14:50.339 ISDN.L2_FMT PRI 1 | 91 Cause:17 (USER_BUSY) |
16:14:50.349 TM.T03 07 IsdnTmStateOutboundDeliver->IsdnTmStateTrunkClearing
16:14:50.349 TM.T03 07 IsdnTmStateTrunkClearing::enter()
16:14:50.350 TM.T03 07 IsdnTmStateTrunkClearing->IsdnTmStateIdling
16:14:50.351 TM.T03 07 IsdnTmStateIdling::enter()
16:14:50.352 TM.T03 07 IsdnTmStateIdling - send appearance off
16:14:50.352 TM.T03 07 IsdnTmStateIdling->IsdnTmStateIdle
16:14:50.353 TM.T03 07 IsdnAppearanceChannel::releaseChannel
16:14:50.353 TM.T03 07 IsdnTmStateIdle::enter()
16:14:50.354 TA.T03 07 TAOutGoing | rcvd: clear from TM |
16:14:50.355 TA.T03 07 State change | >> TAOutGoing->TATrunkClearing (TAS_Clearing) |
16:14:50.355 TM.T03 07 IsdnTmStateIdle::tachgClearing - send appearance off
16:14:50.356 TA.T03 07 TATrunkClearing | rcvd: clear from TM |
16:14:50.357 TA.T03 07 State change | >> TATrunkClearing->TAClearingComplete (TAS_Clearing) |
16:14:50.357 TA.T03 07 TAClearingComplete rcvd: appearance off from TM
16:14:50.358 TA.T03 07 TAClearingComplete Clear Local Variables
16:14:50.358 TA.T03 07 State change | >> TAClearingComplete->TAIdle (TAS_Idle) |
16:14:50.359 SB.CALL 184 Delivering | Called the clearCall routine from Delivering |
16:14:50.360 SB.CALL 184 Delivering | Clearing due to Trunk Clear Reason on call from T03 to 9903 |
16:14:50.361 SB.CALL 184 State change | >> Delivering->Clearing |
16:14:50.361 TA.T03 07 TAIdle | rcvd: appearance off from TM |
16:14:50.362 TA.T03 07 TAIdle | Processing an appearance OFF |
16:14:50.363 SA.9903 Ca:0 Calling | rcvd: clearCall from SB |
16:14:50.363 SA.9903 Ca:0 Calling | sent: clearResponse(pass) to SB |
16:14:50.364 SA.9903 Ca:0 State change | >> Calling->Idle |
16:14:50.364 SA.9903 Ca:0 Idle | sent: AcctPhoneMgr_faxModem to PM |
16:14:50.365 SA.9903 Ca:0 Idle | sent: AcctPhoneMgr_cachg(CAS_Idle) to PM |
16:14:50.365 PM.0:14 Call Pending | Pri CA, Idle response, App OFF sent |
16:14:50.366 PM.0:14 State change | >> Call Pending->Clearing Busy |
16:14:50.367 SB.CALL 184 Clearing | Called the clearResponse routine |
16:14:50.368 SB.CALL 184 State change | >> Clearing->CallIdlePending |
16:14:50.369 SB.CCM release:
16:14:50.369 SB.CCM : Call Struct 0x2952e10 : Call-ID = 184
16:14:50.370 SB.CCM : Org Acct = 9903 | Dst Acct = T03 |
16:14:50.371 SB.CCM : Org Port ID = 0/14.0 Dst Port ID = 0/0.0
16:14:50.371 SB.CCM : Org TID = Fxs Dst TID = Isdn Group Table
16:14:50.372 SB.CCM release: Call Connection Type is TDM_TO_TDM
16:14:50.372 SB.CALL 184 CallIdlePending | ClearResponse sent from 9903 to T03 |
16:14:50.373 SA.9903 Ca:0 Idle | rcvd: AcctPhoneMgr_appearance(OFF) from PM |
16:14:50.374 SA.9903 Ca:0 Idle | sent: AcctPhoneMgr_cachg(CAS_Idle) to PM |
16:14:50.374 PM.0:14 Clearing Busy | Dropped CACHG w/Call State not RINGING |
16:14:50.375 TONESERVICES.EVENTS fxs 0/14 - empty - Busy Generation: Request resource
16:14:50.376 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Busy Generation: DSP channel allocated for the resource
16:14:50.376 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Busy Generation: constructed
16:14:50.377 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Busy Generation: starting
16:14:50.377 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Busy Generation: TDM map
16:14:50.378 TA.T03 clearResponse event rejected, no matching CallID
2016.05.26 16:14:50 TM.T03 07 IsdnTmStateIdling - clear trunk appearance
2016.05.26 16:14:51 SMDR 184 | 05/26/2016 16:14:50 | 0.0 0 | I 00/14 XXXXXXXXXXXXXXXXXXX 6073044673 | 00/00 T03 | 2225393 | 0 N |
16:14:55.642 PM.0:14 Clearing Busy | Processed OnHook | |||||
16:14:55.643 PM.0:14 State change | >> Clearing Busy->Idle |
16:14:55.644 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Busy Generation: stopping
16:14:55.645 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Busy Generation: TDM unmap
16:14:55.645 RTP.CHANNEL fxs 0/14 - dsp 0/1.2 - Busy Generation: releasing RTP resource
16:14:55.646 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Busy Generation: release
16:14:55.647 SA.9903 rcvd: AcctPhoneMgr_COSOverride from PM
16:14:58.525 PM.0:14 Idle | Processed OFFHOOK |
16:14:58.525 PM.0:14 State change | >> Idle->Requesting Dialtone |
16:14:58.526 SA.9903 Ca:0 Idle | rcvd: AcctPhoneMgr_appearance(ON) from PM |
16:14:58.526 SA.9903 Ca:0 State change | >> Idle->DigitGathering |
16:14:58.527 SA.9903 Ca:0 DigitGathering | sent: AcctPhoneMgr_cachg(CAS_ReqDigits) to PM |
16:14:58.527 PM.0:14 Requesting Dialtone CACHG:ReqDigits on primary CA
16:14:58.528 PM.0:14 State change | >> Requesting Dialtone->SendingDigits |
16:14:58.530 TONESERVICES.EVENTS fxs 0/14 - empty - Tone Detection: Request resource
16:14:58.531 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: DSP channel allocated for the resource
16:14:58.531 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: constructed
16:14:58.532 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: starting
16:14:58.533 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: TDM map
16:14:59.031 TONESERVICES.EVENTS fxs 0/14 - empty - DialTone Generation: Request resource
16:14:59.032 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: DSP channel allocated for the resource
16:14:59.033 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: constructed
16:14:59.033 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: starting
16:14:59.034 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: TDM map
16:14:59.591 PM.0:14 SendingDigits | Processed ONHOOK |
16:14:59.592 PM.0:14 State change | >> SendingDigits->Idle |
16:14:59.594 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_appearance(OFF) from PM |
16:14:59.594 SA.9903 Ca:0 State change | >> DigitGathering->Idle |
16:14:59.595 SA.9903 Ca:0 Idle | sent: AcctPhoneMgr_faxModem to PM |
16:14:59.595 SA.9903 Ca:0 Idle | sent: AcctPhoneMgr_cachg(CAS_Idle) to PM |
16:14:59.596 PM.0:14 Idle | Dropped CACHG w/Call State not RINGING |
16:14:59.597 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: stopping
16:14:59.597 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: TDM unmap
16:14:59.598 RTP.CHANNEL fxs 0/14 - dsp 0/1.2 - DialTone Generation: releasing RTP resource
16:14:59.599 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: release
16:14:59.599 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: stopping
16:14:59.600 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: TDM unmap
16:14:59.600 RTP.CHANNEL fxs 0/14 - dsp 0/1.2 - Tone Detection: releasing RTP resource
16:14:59.601 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: release
16:14:59.602 SA.9903 rcvd: AcctPhoneMgr_COSOverride from PM
16:15:10.647 PM.0:14 Idle | Processed OFFHOOK |
16:15:10.648 PM.0:14 State change | >> Idle->Requesting Dialtone |
16:15:10.648 SA.9903 Ca:0 Idle | rcvd: AcctPhoneMgr_appearance(ON) from PM |
16:15:10.649 SA.9903 Ca:0 State change | >> Idle->DigitGathering |
16:15:10.649 SA.9903 Ca:0 DigitGathering | sent: AcctPhoneMgr_cachg(CAS_ReqDigits) to PM |
16:15:10.650 PM.0:14 Requesting Dialtone CACHG:ReqDigits on primary CA
16:15:10.651 PM.0:14 State change | >> Requesting Dialtone->SendingDigits |
16:15:10.653 TONESERVICES.EVENTS fxs 0/14 - empty - Tone Detection: Request resource
16:15:10.653 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: DSP channel allocated for the resource
16:15:10.654 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: constructed
16:15:10.655 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: starting
16:15:10.655 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: TDM map
16:15:11.154 TONESERVICES.EVENTS fxs 0/14 - empty - DialTone Generation: Request resource
16:15:11.155 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: DSP channel allocated for the resource
16:15:11.155 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: constructed
16:15:11.156 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: starting
16:15:11.156 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: TDM map
16:15:12.631 PM.0:14 SendingDigits | Digit 1 processed |
16:15:12.632 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (1) event
16:15:12.632 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: stopping
16:15:12.633 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: TDM unmap
16:15:12.633 RTP.CHANNEL fxs 0/14 - dsp 0/1.2 - DialTone Generation: releasing RTP resource
16:15:12.634 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: release
16:15:12.635 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(1) from PM |
16:15:12.635 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 second(s) for more digits |
16:15:13.370 PM.0:14 SendingDigits | Digit 6 processed |
16:15:13.371 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (6) event
16:15:13.372 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(6) from PM |
16:15:13.372 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:13.800 PM.0:14 SendingDigits | Digit 0 processed |
16:15:13.801 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (0) event
16:15:13.801 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(0) from PM |
16:15:13.802 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:14.160 PM.0:14 SendingDigits | Digit 7 processed |
16:15:14.161 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (7) event
16:15:14.161 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(7) from PM |
16:15:14.162 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:14.740 PM.0:14 SendingDigits | Digit 2 processed |
16:15:14.741 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (2) event
16:15:14.741 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(2) from PM |
16:15:14.742 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:15.070 PM.0:14 SendingDigits | Digit 2 processed |
16:15:15.071 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (2) event
16:15:15.072 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(2) from PM |
16:15:15.072 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:15.350 PM.0:14 SendingDigits | Digit 2 processed |
16:15:15.351 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (2) event
16:15:15.352 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(2) from PM |
16:15:15.352 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:16.130 PM.0:14 SendingDigits | Digit 5 processed |
16:15:16.131 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (5) event
16:15:16.132 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(5) from PM |
16:15:16.132 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:17.940 PM.0:14 SendingDigits | Processed ONHOOK |
16:15:17.941 PM.0:14 State change | >> SendingDigits->Idle |
16:15:17.942 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_appearance(OFF) from PM |
16:15:17.942 SA.9903 Ca:0 State change | >> DigitGathering->Idle |
16:15:17.943 SA.9903 Ca:0 Idle | sent: AcctPhoneMgr_faxModem to PM |
16:15:17.943 SA.9903 Ca:0 Idle | sent: AcctPhoneMgr_cachg(CAS_Idle) to PM |
16:15:17.944 PM.0:14 Idle | Dropped CACHG w/Call State not RINGING |
16:15:17.945 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: stopping
16:15:17.945 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: TDM unmap
16:15:17.946 RTP.CHANNEL fxs 0/14 - dsp 0/1.2 - Tone Detection: releasing RTP resource
16:15:17.947 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: release
16:15:17.947 SA.9903 rcvd: AcctPhoneMgr_COSOverride from PM
16:15:18.072 PM.0:14 Idle | Processed OFFHOOK |
16:15:18.073 PM.0:14 State change | >> Idle->Requesting Dialtone |
16:15:18.073 SA.9903 Ca:0 Idle | rcvd: AcctPhoneMgr_appearance(ON) from PM |
16:15:18.074 SA.9903 Ca:0 State change | >> Idle->DigitGathering |
16:15:18.074 SA.9903 Ca:0 DigitGathering | sent: AcctPhoneMgr_cachg(CAS_ReqDigits) to PM |
16:15:18.075 PM.0:14 Requesting Dialtone CACHG:ReqDigits on primary CA
16:15:18.075 PM.0:14 State change | >> Requesting Dialtone->SendingDigits |
16:15:18.077 TONESERVICES.EVENTS fxs 0/14 - empty - Tone Detection: Request resource
16:15:18.078 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: DSP channel allocated for the resource
16:15:18.078 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: constructed
16:15:18.079 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: starting
16:15:18.080 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: TDM map
16:15:18.579 TONESERVICES.EVENTS fxs 0/14 - empty - DialTone Generation: Request resource
16:15:18.579 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: DSP channel allocated for the resource
16:15:18.580 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: constructed
16:15:18.581 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: starting
16:15:18.582 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: TDM map
16:15:19.408 ISDN.L2_FMT PRI 1 ==============================================
16:15:19.408 ISDN.L2_FMT PRI 1 Recd Sapi:00 C/R:R Tei:00 INFO Ns:6 Nr:58 P:0
16:15:19.408 ISDN.L2_FMT PRI 1 | Prot:08 CRL:2 CRV:02F2 | |
16:15:19.409 ISDN.L2_FMT PRI 1 | M - 05 SETUP | |
16:15:19.409 ISDN.L2_FMT PRI 1 | IE - 04 BEARER CAPABILITY Len=3 | |
16:15:19.410 ISDN.L2_FMT PRI 1 | 80 Xfer Cap.:SPEECH | |
16:15:19.410 ISDN.L2_FMT PRI 1 | 90 Xfer Rate:64k | |
16:15:19.411 ISDN.L2_FMT PRI 1 | A2 Layer 1:u-Law | |
16:15:19.411 ISDN.L2_FMT PRI 1 | IE - 18 CHANNEL ID | Len=3 |
16:15:19.412 ISDN.L2_FMT PRI 1 | A9 Primary Rate | |
16:15:19.412 ISDN.L2_FMT PRI 1 | Intfc ID:IMPLICIT | |
16:15:19.412 ISDN.L2_FMT PRI 1 | Pref/Excl:EXCLUSIVE | |
16:15:19.413 ISDN.L2_FMT PRI 1 | D-Chan Indicated:NO | |
16:15:19.413 ISDN.L2_FMT PRI 1 | Chan. Sel:FOLLOWS | |
16:15:19.413 ISDN.L2_FMT PRI 1 | 83 Numb/Map:NUMBER | |
16:15:19.414 ISDN.L2_FMT PRI 1 | 96 Channel:22 | |
16:15:19.414 ISDN.L2_FMT PRI 1 | IE - 1E PROGRESS INDICATOR Len=2 | |
16:15:19.415 ISDN.L2_FMT PRI 1 | 81 Location:LPN | |
16:15:19.415 ISDN.L2_FMT PRI 1 | 83 Description:ORIG. NOT ISDN | |
16:15:19.415 ISDN.L2_FMT PRI 1 | IE - 6C CALLING PARTY # | Len=12 |
16:15:19.416 ISDN.L2_FMT PRI 1 | 21 Numb. Type:NATIONAL | |
16:15:19.416 ISDN.L2_FMT PRI 1 | Numb. Plan:E.164 | |
16:15:19.416 ISDN.L2_FMT PRI 1 | 80 Presentation:ALLOWED | |
16:15:19.417 ISDN.L2_FMT PRI 1 | Ph.# 6072387077 | |
16:15:19.417 ISDN.L2_FMT PRI 1 | IE - 70 CALLED PARTY # | Len=8 |
16:15:19.418 ISDN.L2_FMT PRI 1 | 80 Numb. Type:UNKNOWN | |
16:15:19.418 ISDN.L2_FMT PRI 1 | Numb. Plan:UNKNOWN | |
16:15:19.418 ISDN.L2_FMT PRI 1 | Ph.# 2395254 | |
16:15:19.419 ISDN.L2_FMT PRI 1 | IE - 7C LOW LAYER COMPAT. Len=3 | |
16:15:19.419 ISDN.L2_FMT PRI 1 | 80 Info Xfer Cap:Speech. | |
16:15:19.419 ISDN.L2_FMT PRI 1 | 90 Octet 4 | |
16:15:19.420 ISDN.L2_FMT PRI 1 | A2 Octet 5 | |
16:15:19.420 ISDN.L2_FMT PRI 1 | IE - 7D HIGH LAYER COMPAT. Len=2 | |
16:15:19.420 ISDN.L2_FMT PRI 1 | 91 Coding Standard:CCITT. | |
16:15:19.421 ISDN.L2_FMT PRI 1 | Interpretation:Octet 4 only. | |
16:15:19.421 ISDN.L2_FMT PRI 1 | Pres Method:High Layer Prot Profile | |
16:15:19.422 ISDN.L2_FMT PRI 1 | 81 High Layer Char ID:Telephony. |
16:15:19.423 ISDN.L2_FMT PRI 1 ==============================================
16:15:19.424 ISDN.L2_FMT PRI 1 Sent Sapi:00 C/R:C Tei:00 INFO Ns:58 Nr:7 P:0
16:15:19.424 ISDN.L2_FMT PRI 1 | Prot:08 CRL:2 CRV:82F2 | |
16:15:19.425 ISDN.L2_FMT PRI 1 | M - 02 CALL_PROC | |
16:15:19.425 ISDN.L2_FMT PRI 1 | IE - 18 CHANNEL ID | Len=3 |
16:15:19.426 ISDN.L2_FMT PRI 1 | A9 Primary Rate | |
16:15:19.426 ISDN.L2_FMT PRI 1 | Intfc ID:IMPLICIT | |
16:15:19.426 ISDN.L2_FMT PRI 1 | Pref/Excl:EXCLUSIVE | |
16:15:19.427 ISDN.L2_FMT PRI 1 | D-Chan Indicated:NO | |
16:15:19.427 ISDN.L2_FMT PRI 1 | Chan. Sel:FOLLOWS | |
16:15:19.427 ISDN.L2_FMT PRI 1 | 83 Numb/Map:NUMBER | |
16:15:19.428 ISDN.L2_FMT PRI 1 | 96 Channel:22 |
16:15:19.428 TM.T03 22 en bloc sending call rec'd
16:15:19.429 TM.T03 22 IsdnTmStateIdle->IsdnTmStateInboundAccept
16:15:19.430 TM.T03 22 IsdnTmStateInboundAccept::enter() send call to acct
16:15:19.431 TA.T03 22 TAIdle | rcvd: inboundCall from TM |
16:15:19.431 TA.T03 22 State change | >> TAIdle->TAInboundCall (TAS_Calling) |
16:15:19.432 TA.T03 22 Failed - DID translation: no match for 2395254, using 2395254
16:15:19.433 TA.T03 22 TAIdle | sent: call to SB |
16:15:19.434 TM.T03 22 tachg_TAInboundCall do nothing
16:15:19.434 SB.CALL 185 Idle | Called the call routine with 2395254 |
16:15:19 SB.TGMgr For dialed number 2395254, against template $, on TrunkGroup PRI TO PBX, the score is 500
16:15:19 SB.TGMgr For dialed number 2395254, against template $, on TrunkGroup SIP VI, the score is 500
16:15:19.437 SB.CCM isMappable:
16:15:19.437 SB.CCM : Call Struct 0x2984c10 : Call-ID = 185
16:15:19.438 SB.CCM : Org Acct = T03 | Dst Acct = T01 |
16:15:19.438 SB.CCM : Org Port ID = 0/2.22 Dst Port ID = 0/0.0
16:15:19.439 SB.CCM : Org TID = Ds1Ds0Usage Dst TID =
16:15:19.439 SB.CCM isMappable: Call Connection Type is TDM_TO_RTP
16:15:19.440 SB.CCM isMappable: Reserving RTP Channel 0/1.3
16:15:19.441 SB.CCM isMappable: Creating SDP Offer
16:15:19.443 SB.CCM getBestMatchCodecList: G729 PCMU
16:15:19.445 SB.CALL 185 Idle | Call sent from T03 to T01 (2395254) |
16:15:19.446 SB.CALL 185 State change | >> Idle->Delivering |
16:15:19.446 RTP.MANAGER t1 0/2.0.22 - empty - RTP: Request resource
16:15:19.447 RTP.MANAGER t1 0/2.0.22 - dsp 0/1.3 - RTP: DSP channel allocated for the resource
16:15:19.448 RTP.PROVIDER t1 0/2.0.22 - dsp 0/1.3 - RTP: providing already allocated RTP channel
16:15:19.448 TA.T03 22 TAInboundCall | CallResp event accepted | |
16:15:19.449 TA.T03 22 State change | >> TAInboundCall->TAConnectWaitIn (TAS_Calling) | |
16:15:19.450 TA.T01 33 State change | >> TAIdle->TAOutGoing (TAS_Delivering) | |
16:15:19.451 TM.T01 33 SipTM_Idle | State change | >> SipTM_Idle->SipTM_Delivering |
16:15:19.452 TA.T01 33 DNIS Substitution: dialed number 2395254 -> 16072395254
16:15:19.452 TA.T01 33 DNIS Substitution: dialed number 2395254 -> dialed name "local"
16:15:19.454 TM.T01 33 call-leg (0x259eac0) -> src-ip: XXX.XXX.XXX.XXX dst-ip: 64.136.174.30
16:15:19.456 TM.T01 33 Undo of previous operation not required (RTP NAT Entry for 127.0.0.2:10004 not found)
16:15:19.456 TM.T01 33 Checking for internal Media Gateway IP Address
16:15:19.457 TM.T01 33 Using RTP Channel 0/1.3
16:15:19.457 TM.T01 33 Inserting XXX.XXX.XXX.XXX into SDP for Media Gateway on interface eth 0/1
16:15:19.459 TM.T01 33 Adding RTP Media Gateway Entry: 127.0.0.2:10004 -> XXX.XXX.XXX.XXX:10004
16:15:19.459 TM.T01 33 No action taken, firewall traversal is not enabled
16:15:19.464 SIP.STACK MSG | Tx: UDP src=XXX.XXX.XXX.XXX:5060 dst=64.136.174.30:5060 |
16:15:19.464 SIP.STACK MSG | INVITE sip:16072395254@64.136.174.30:5060 SIP/2.0 |
16:15:19.465 SIP.STACK MSG | From: <sip:6072387077@64.136.174.30:5060;transport=UDP>;tag=25843b0-7f000001-13c4-d092-512dd0d9-d092 |
16:15:19.465 SIP.STACK MSG | To: "local" <sip:16072395254@64.136.174.30:5060> |
16:15:19.466 SIP.STACK MSG | Call-ID: 259eac0-7f000001-13c4-d092-390708b9-d092@64.136.174.30 |
16:15:19.466 SIP.STACK MSG | CSeq: 1 INVITE |
16:15:19.467 SIP.STACK MSG | Via: SIP/2.0/UDP XXX.XXX.XXX.XXX:5060;branch=z9hG4bK-d092-32ebe19-1b069291 |
16:15:19.467 SIP.STACK MSG | Max-Forwards: 70 |
16:15:19.468 SIP.STACK MSG | Supported: 100rel,replaces |
16:15:19.468 SIP.STACK MSG | Allow: ACK, BYE, CANCEL, INFO, INVITE, NOTIFY, OPTIONS, PRACK, REFER, REGISTER |
16:15:19.469 SIP.STACK MSG | User-Agent: ADTRAN_Total_Access_916_2nd_Gen/A4.11.00.E |
16:15:19.470 SIP.STACK MSG | Contact: <sip:6072387077@XXX.XXX.XXX.XXX:5060;transport=UDP> |
16:15:19.470 SIP.STACK MSG | Content-Type: application/sdp |
16:15:19.471 SIP.STACK MSG | Content-Length: 208 |
16:15:19.471 SIP.STACK MSG | |
16:15:19.472 SIP.STACK MSG | v=0 |
16:15:19.472 SIP.STACK MSG | o=- 1464293719 1464293719 IN IP4 XXX.XXX.XXX.XXX |
16:15:19.473 SIP.STACK MSG | s=- |
16:15:19.473 SIP.STACK MSG | c=IN IP4 XXX.XXX.XXX.XXX |
16:15:19.474 SIP.STACK MSG | t=0 0 |
16:15:19.474 SIP.STACK MSG | m=audio 10004 RTP/AVP 18 0 |
16:15:19.475 SIP.STACK MSG | a=rtpmap:18 G729/8000 |
16:15:19.475 SIP.STACK MSG | a=fmtp:18 annexb=no |
16:15:19.476 SIP.STACK MSG | a=rtpmap:0 PCMU/8000 |
16:15:19.476 SIP.STACK MSG | a=silenceSupp:off - - - - |
16:15:19.477 SIP.STACK MSG | |
16:15:19.478 TM.T01 33 SipTM_Delivering | call-leg -> Inviting |
16:15:19.479 TM.T01 33 SipTM_Delivering | sent: INVITE |
16:15:19.480 SB.CALL 185 Delivering | Called the deliverResponse routine from Delivering |
16:15:19.481 SB.CALL 185 Delivering | DeliverResponse(accept) sent from T01 to T03 |
16:15:19.482 TA.T03 22 TAConnectWaitIn | deliverResponse event accepted |
16:15:19.482 TA.T03 22 TAConnectWaitIn | ERROR! deliverResponse ignored |
16:15:19.641 SIP.STACK MSG | Rx: UDP src=64.136.174.30:5060 dst=XXX.XXX.XXX.XXX:5060 |
16:15:19.641 SIP.STACK MSG | SIP/2.0 100 Trying |
16:15:19.642 SIP.STACK MSG | Via: SIP/2.0/UDP XXX.XXX.XXX.XXX:5060;branch=z9hG4bK-d092-32ebe19-1b069291 |
16:15:19.642 SIP.STACK MSG | To: "local" <sip:16072395254@64.136.174.30:5060> |
16:15:19.643 SIP.STACK MSG | From: <sip:6072387077@64.136.174.30:5060;transport=UDP>;tag=25843b0-7f000001-13c4-d092-512dd0d9-d092 |
16:15:19.643 SIP.STACK MSG | Call-ID: 259eac0-7f000001-13c4-d092-390708b9-d092@64.136.174.30 |
16:15:19.644 SIP.STACK MSG | CSeq: 1 INVITE |
16:15:19.644 SIP.STACK MSG | Content-Length: 0 |
16:15:19.645 SIP.STACK MSG | |
16:15:19.648 TM.T01 33 SipTM_Delivering | rcvd SIP call-leg response: 100 Trying |
16:15:19.649 TM.T01 33 SipTM_Delivering | No Supported header in message |
16:15:19.649 TM.T01 33 SipTM_Delivering | rcvd: Provisional Response 100 Trying |
16:15:19.650 TM.T01 33 SipTM_Delivering | call-leg -> Proceeding |
16:15:21.517 SIP.STACK MSG | Rx: UDP src=64.136.174.30:5060 dst=XXX.XXX.XXX.XXX:5060 |
16:15:21.517 SIP.STACK MSG | SIP/2.0 183 Session Progress |
16:15:21.518 SIP.STACK MSG | Via: SIP/2.0/UDP XXX.XXX.XXX.XXX:5060;branch=z9hG4bK-d092-32ebe19-1b069291 |
16:15:21.518 SIP.STACK MSG | Record-Route: <sip:sansay2589032518rdb16371@64.136.174.30:5060;lr;transport=udp> |
16:15:21.519 SIP.STACK MSG | To: "local" <sip:16072395254@64.136.174.30:5060>;tag=sansay2589032518rdb16371 |
16:15:21.520 SIP.STACK MSG | From: <sip:6072387077@64.136.174.30:5060;transport=UDP>;tag=25843b0-7f000001-13c4-d092-512dd0d9-d092 |
16:15:21.520 SIP.STACK MSG | Call-ID: 259eac0-7f000001-13c4-d092-390708b9-d092@64.136.174.30 |
16:15:21.521 SIP.STACK MSG | CSeq: 1 INVITE |
16:15:21.521 SIP.STACK MSG | Contact: <sip:16072395254@64.136.174.30:5060> |
16:15:21.522 SIP.STACK MSG | Content-Type: application/sdp |
16:15:21.522 SIP.STACK MSG | Content-Length: 170 |
16:15:21.523 SIP.STACK MSG | |
16:15:21.523 SIP.STACK MSG | v=0 |
16:15:21.524 SIP.STACK MSG | o=Sansay-VSXi 188 1 IN IP4 64.136.174.30 |
16:15:21.524 SIP.STACK MSG | s=Session Controller |
16:15:21.525 SIP.STACK MSG | c=IN IP4 69.85.181.73 |
16:15:21.525 SIP.STACK MSG | t=0 0 |
16:15:21.526 SIP.STACK MSG | m=audio 20958 RTP/AVP 0 |
16:15:21.526 SIP.STACK MSG | a=rtpmap:0 PCMU/8000 |
16:15:21.527 SIP.STACK MSG | a=sendrecv |
16:15:21.527 SIP.STACK MSG | a=ptime:20 |
16:15:21.528 SIP.STACK MSG | |
16:15:21.532 TM.T01 33 SipTM_Delivering | rcvd SIP call-leg response: 183 Session Progress |
16:15:21.533 TM.T01 33 SipTM_Delivering | No Supported header in message |
16:15:21.534 TM.T01 33 SipTM_Delivering | rcvd: Provisional Response 183 Session Progress (with SDP) |
16:15:21.535 TM.T01 33 SipTM_Delivering | sent: TA->PreConnect |
16:15:21.536 TA.T01 33 TAOutGoing | rcvd: preConnect from TM |
16:15:21.536 SB.CALL 185 State change | >> Delivering->PreConnecting |
16:15:21.537 SB.CALL 185 PreConnecting | Call PreConnecting from T01 to T03 |
16:15:21.538 TA.T03 22 TAConnectWaitIn | preConnect event accepted |
16:15:21.539 TM.T03 22 IsdnTmStateInboundAccept->IsdnTmStateInboundPreconnect
16:15:21.539 TM.T03 22 IsdnTmStateInboundPreconnect::enter()
16:15:21.540 TA.T03 22 TAConnectWaitIn | rcvd: preConnectResponse from TM |
16:15:21.541 SB.CCM connect:
16:15:21.541 SB.CCM : Call Struct 0x2984c10 : Call-ID = 185
16:15:21.542 SB.CCM : Org Acct = T03 | Dst Acct = T01 |
16:15:21.542 SB.CCM : Org Port ID = 0/2.22 Dst Port ID = 0/0.32
16:15:21.543 SB.CCM : Org TID = Ds1Ds0Usage Dst TID =
16:15:21.543 SB.CCM : SDP Transaction = CallID: 185
16:15:21.544 SB.CCM : SDP Offer = 0x02991d10, (127.0.0.2:10004)
16:15:21.545 SB.CCM : SDP Answer = 0x0298a610, (69.85.181.73:20958)
16:15:21.545 SB.CCM : RTP Channel = 0/1.3
16:15:21.546 SB.CCM connect: Call Connection Type is TDM_TO_RTP
16:15:21.546 SB.CCM offer ip 127.0.0.2, 10004, answer ip 69.85.181.73, 20958
16:15:21.548 SB.CCM Looking up outbound interface to 69.85.181.73
16:15:21.549 ISDN.L2_FMT PRI 1 ==============================================
16:15:21.549 ISDN.L2_FMT PRI 1 Sent Sapi:00 C/R:C Tei:00 INFO Ns:59 Nr:7 P:0
16:15:21.550 ISDN.L2_FMT PRI 1 | Prot:08 CRL:2 CRV:82F2 |
16:15:21.550 ISDN.L2_FMT PRI 1 | M - 03 PROGRESS |
16:15:21.551 ISDN.L2_FMT PRI 1 | IE - 1E PROGRESS INDICATOR Len=2 |
16:15:21.551 ISDN.L2_FMT PRI 1 | 82 Location:LN |
16:15:21.551 ISDN.L2_FMT PRI 1 | 88 Description:INBAND AUDIO AVAIL |
16:15:21.553 PM.0:14 SendingDigits | Digit 6 processed |
16:15:21.553 SB.CCM Changing RTP Channel source IP Address to XXX.XXX.XXX.XXX for Media Gateway on interface eth 0/1
16:15:21.554 SB.CCM connect: TDM streams: Table Ds1Ds0Usage 0/2.22 to Table 12372 0/1.3
16:15:21.555 SB.CCM not tdm only, call setupRtpChannel
16:15:21.555 SB.CCM setupRtpChannel, type 3, source 1, silence 0
16:15:21.556 SB.CCM TheCallConnectionManager::setupRtpChannel, IP addr = 69.85.181.73, port = 20958
16:15:21.557 SB.CCM connect: Undo of previous operation not required
16:15:21.558 SB.CCM getFinalCodec: PCMU
16:15:21.559 SB.CCM connect: Configuring RTP Channel 0/1.3 to 69.85.181.73:20958 via PCMU
16:15:21.560 SB.CCM connect: | fpp=2 echo=on dtmf=0/0 dscp=46 vad=off |
16:15:21.561 SB.CCM connect: Starting RTP Channel
16:15:21.561 RTP.CHANNEL Channel 0/1.3 session statistics cleared.
16:15:21.562 RTP.CHANNEL Channel 0/1.3 started sucessfully.
16:15:21.562 SB.CCM firewallConnectCall: No action taken, firewall traversal is not enabled
16:15:21.563 SB.CALL 185 State change | >> PreConnecting->PreConnected |
16:15:21.564 SB.CALL 185 PreConnected | Call PreConnecting from T03 to T01 |
16:15:21.565 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (6) event
16:15:21.565 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: stopping
16:15:21.566 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: TDM unmap
16:15:21.567 RTP.CHANNEL fxs 0/14 - dsp 0/1.2 - DialTone Generation: releasing RTP resource
16:15:21.567 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: release
16:15:21.568 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(6) from PM |
16:15:21.569 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 second(s) for more digits |
16:15:21.570 RTP.CHANNEL t1 0/2.0.22 - dsp 0/1.3 - RTP: starting
16:15:21.573 TA.T01 ERROR! preConnectResponse ignored
16:15:22.440 PM.0:14 SendingDigits | Digit 0 processed |
16:15:22.441 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (0) event
16:15:22.441 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(0) from PM |
16:15:22.442 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:23.010 PM.0:14 SendingDigits | Digit 7 processed |
16:15:23.011 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (7) event
16:15:23.012 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(7) from PM |
16:15:23.013 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:23.770 PM.0:14 SendingDigits | Digit 2 processed |
16:15:23.771 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (2) event
16:15:23.772 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(2) from PM |
16:15:23.773 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:24.120 PM.0:14 SendingDigits | Digit 2 processed |
16:15:24.121 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (2) event
16:15:24.121 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(2) from PM |
16:15:24.122 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:24.400 PM.0:14 SendingDigits | Digit 2 processed |
16:15:24.401 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (2) event
16:15:24.401 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(2) from PM |
16:15:24.402 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:24.870 PM.0:14 SendingDigits | Digit 5 processed |
16:15:24.871 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (5) event
16:15:24.872 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(5) from PM |
16:15:24.873 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:25.230 PM.0:14 SendingDigits | Digit 3 processed |
16:15:25.231 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (3) event
16:15:25.232 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(3) from PM |
16:15:25.232 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:25.660 PM.0:14 SendingDigits | Digit 9 processed |
16:15:25.661 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (9) event
16:15:25.661 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(9) from PM |
16:15:25.662 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:26.050 PM.0:14 SendingDigits | Digit 3 processed |
16:15:26.051 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (3) event
16:15:26.052 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(3) from PM |
16:15:26.052 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:26.053 SA.9903 Ca:0 State change | >> DigitGathering->DigitGathering |
16:15:26.054 SA.9903 Ca:0 DigitGathering | sent: AcctPhoneMgr_cachg(CAS_Active) to PM |
16:15:26.054 PM.0:14 State change | >> SendingDigits->Call Pending |
16:15:26.056 SA.9903 Ca:0 DigitGathering | sent: call to SB |
16:15:26.056 SA.9903 Ca:0 State change | >> DigitGathering->CallPending |
16:15:26.057 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: stopping
16:15:26.058 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: TDM unmap
16:15:26.059 RTP.CHANNEL fxs 0/14 - dsp 0/1.2 - Tone Detection: releasing RTP resource
16:15:26.059 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: release
16:15:26.060 SA.9903 rcvd: AcctPhoneMgr_billingCode from PM
16:15:26.060 SB.CALL 186 Idle | Called the call routine with 6072225393 |
16:15:26 SB.TGMgr For dialed number 6072225393, against template $, on TrunkGroup PRI TO PBX, the score is 500
16:15:26 SB.TGMgr For dialed number 6072225393, against template $, on TrunkGroup SIP VI, the score is 500
16:15:26.062 SB.CCM isMappable:
16:15:26.063 SB.CCM : Call Struct 0x2983c10 : Call-ID = 186
16:15:26.063 SB.CCM : Org Acct = 9903 | Dst Acct = T03 |
16:15:26.064 SB.CCM : Org Port ID = 0/14.0 Dst Port ID = 0/0.0
16:15:26.065 SB.CCM : Org TID = Fxs Dst TID =
16:15:26.065 SB.CCM isMappable: Call Connection Type is TDM_TO_TDM
16:15:26.066 SB.CALL 186 Idle | Call sent from 9903 to T03 (6072225393) |
16:15:26.066 SB.CALL 186 State change | >> Idle->Delivering |
16:15:26.067 SA.9903 Ca:0 CallPending | rcvd: callResponse from SB |
16:15:26.067 SA.9903 Ca:0 State change | >> CallPending->Calling |
16:15:26.068 TA.T03 06 State change | >> TAIdle->TAOutGoing (TAS_Delivering) |
16:15:26.069 TM.T03 06 tachg_Delivering
16:15:26.070 TM.T03 06 IsdnTmStateIdle->IsdnTmStateOutboundDeliver
16:15:26.071 TM.T03 06 IsdnTmStateOutboundDeliver::enter()
16:15:26.072 ISDN.L2_FMT PRI 1 ==============================================
16:15:26.073 ISDN.L2_FMT PRI 1 Sent Sapi:00 C/R:C Tei:00 INFO Ns:60 Nr:7 P:0
16:15:26.073 ISDN.L2_FMT PRI 1 | Prot:08 CRL:2 CRV:006D | |
16:15:26.074 ISDN.L2_FMT PRI 1 | M - 05 SETUP | |
16:15:26.074 ISDN.L2_FMT PRI 1 | IE - 04 BEARER CAPABILITY Len=3 | |
16:15:26.074 ISDN.L2_FMT PRI 1 | 80 Xfer Cap.:SPEECH | |
16:15:26.075 ISDN.L2_FMT PRI 1 | 90 Xfer Rate:64k | |
16:15:26.075 ISDN.L2_FMT PRI 1 | A2 Layer 1:u-Law | |
16:15:26.075 ISDN.L2_FMT PRI 1 | IE - 18 CHANNEL ID | Len=3 |
16:15:26.076 ISDN.L2_FMT PRI 1 | A1 Primary Rate | |
16:15:26.076 ISDN.L2_FMT PRI 1 | Intfc ID:IMPLICIT | |
16:15:26.076 ISDN.L2_FMT PRI 1 | Pref/Excl:PREFERRED | |
16:15:26.077 ISDN.L2_FMT PRI 1 | D-Chan Indicated:NO | |
16:15:26.077 ISDN.L2_FMT PRI 1 | Chan. Sel:FOLLOWS | |
16:15:26.077 ISDN.L2_FMT PRI 1 | 83 Numb/Map:NUMBER | |
16:15:26.078 ISDN.L2_FMT PRI 1 | 86 Channel:6 | |
16:15:26.078 ISDN.L2_FMT PRI 1 | IE - 1C FACILITY | Len=28 |
16:15:26.078 ISDN.L2_FMT PRI 1 | Calling Name: XXXXXXXXXXXXXXXXXXX | |
16:15:26.079 ISDN.L2_FMT PRI 1 | IE - 6C CALLING PARTY # | Len=12 |
16:15:26.079 ISDN.L2_FMT PRI 1 | 00 Numb. Type:UNKNOWN | |
16:15:26.080 ISDN.L2_FMT PRI 1 | Numb. Plan:UNKNOWN | |
16:15:26.080 ISDN.L2_FMT PRI 1 | 80 Presentation:ALLOWED | |
16:15:26.081 ISDN.L2_FMT PRI 1 | Ph.# 6073044673 | |
16:15:26.081 ISDN.L2_FMT PRI 1 | IE - 70 CALLED PARTY # | Len=11 |
16:15:26.081 ISDN.L2_FMT PRI 1 | 80 Numb. Type:UNKNOWN | |
16:15:26.082 ISDN.L2_FMT PRI 1 | Numb. Plan:UNKNOWN | |
16:15:26.082 ISDN.L2_FMT PRI 1 | Ph.# 6072225393 | |
16:15:26.083 SB.CALL 186 Delivering | Called the deliverResponse routine from Delivering | |
16:15:26.083 SB.CALL 186 Delivering | DeliverResponse(accept) sent from T03 to 9903 | |
16:15:26.084 SA.9903 Ca:0 Calling | rcvd: deliverResponse from SB | |
16:15:26.085 SA.9903 Ca:0 Calling | sent: AcctPhoneMgr_info to PM |
16:15:26.085 PM.0:14 ERROR! APM_Info ignored
16:15:26.163 ISDN.L2_FMT PRI 1 ==============================================
16:15:26.164 ISDN.L2_FMT PRI 1 Recd Sapi:00 C/R:R Tei:00 INFO Ns:7 Nr:61 P:0
16:15:26.164 ISDN.L2_FMT PRI 1 | Prot:08 CRL:2 CRV:806D | |
16:15:26.164 ISDN.L2_FMT PRI 1 | M - 5A RELEASE_CMP | |
16:15:26.165 ISDN.L2_FMT PRI 1 | IE - 08 CAUSE | Len=2 |
16:15:26.165 ISDN.L2_FMT PRI 1 | 80 Location:U | |
16:15:26.166 ISDN.L2_FMT PRI 1 | 91 Cause:17 (USER_BUSY) |
16:15:26.169 TM.T03 06 IsdnTmStateOutboundDeliver->IsdnTmStateTrunkClearing
16:15:26.170 TM.T03 06 IsdnTmStateTrunkClearing::enter()
16:15:26.171 TM.T03 06 IsdnTmStateTrunkClearing->IsdnTmStateIdling
16:15:26.171 TM.T03 06 IsdnTmStateIdling::enter()
16:15:26.172 TM.T03 06 IsdnTmStateIdling - send appearance off
16:15:26.172 TM.T03 06 IsdnTmStateIdling->IsdnTmStateIdle
16:15:26.173 TM.T03 06 IsdnAppearanceChannel::releaseChannel
16:15:26.173 TM.T03 06 IsdnTmStateIdle::enter()
16:15:26.174 TA.T03 06 TAOutGoing | rcvd: clear from TM |
16:15:26.175 TA.T03 06 State change | >> TAOutGoing->TATrunkClearing (TAS_Clearing) |
16:15:26.175 TM.T03 06 IsdnTmStateIdle::tachgClearing - send appearance off
16:15:26.176 TA.T03 06 TATrunkClearing | rcvd: clear from TM |
16:15:26.177 TA.T03 06 State change | >> TATrunkClearing->TAClearingComplete (TAS_Clearing) |
16:15:26.177 TA.T03 06 TAClearingComplete rcvd: appearance off from TM
16:15:26.178 TA.T03 06 TAClearingComplete Clear Local Variables
16:15:26.178 TA.T03 06 State change | >> TAClearingComplete->TAIdle (TAS_Idle) |
16:15:26.179 SB.CALL 186 Delivering | Called the clearCall routine from Delivering |
16:15:26.180 SB.CALL 186 Delivering | Clearing due to Trunk Clear Reason on call from T03 to 9903 |
16:15:26.181 SB.CALL 186 State change | >> Delivering->Clearing |
16:15:26.181 TA.T03 06 TAIdle | rcvd: appearance off from TM |
16:15:26.182 TA.T03 06 TAIdle | Processing an appearance OFF |
16:15:26.182 SA.9903 Ca:0 Calling | rcvd: clearCall from SB |
16:15:26.183 SA.9903 Ca:0 Calling | sent: clearResponse(pass) to SB |
16:15:26.183 SA.9903 Ca:0 State change | >> Calling->Idle |
16:15:26.184 SA.9903 Ca:0 Idle | sent: AcctPhoneMgr_faxModem to PM |
16:15:26.185 SA.9903 Ca:0 Idle | sent: AcctPhoneMgr_cachg(CAS_Idle) to PM |
16:15:26.186 PM.0:14 Call Pending | Pri CA, Idle response, App OFF sent |
16:15:26.186 PM.0:14 State change | >> Call Pending->Clearing Busy |
16:15:26.188 SB.CALL 186 Clearing | Called the clearResponse routine |
16:15:26.188 SB.CALL 186 State change | >> Clearing->CallIdlePending |
16:15:26.189 SB.CCM release:
16:15:26.189 SB.CCM : Call Struct 0x2983c10 : Call-ID = 186
16:15:26.191 SB.CCM : Org Acct = 9903 | Dst Acct = T03 |
16:15:26.191 SB.CCM : Org Port ID = 0/14.0 Dst Port ID = 0/0.0
16:15:26.192 SB.CCM : Org TID = Fxs Dst TID = Isdn Group Table
16:15:26.192 SB.CCM release: Call Connection Type is TDM_TO_TDM
16:15:26.193 SB.CALL 186 CallIdlePending | ClearResponse sent from 9903 to T03 |
16:15:26.194 SA.9903 Ca:0 Idle | rcvd: AcctPhoneMgr_appearance(OFF) from PM |
16:15:26.194 SA.9903 Ca:0 Idle | sent: AcctPhoneMgr_cachg(CAS_Idle) to PM |
16:15:26.195 PM.0:14 Clearing Busy | Dropped CACHG w/Call State not RINGING |
16:15:26.196 TONESERVICES.EVENTS fxs 0/14 - empty - Busy Generation: Request resource
16:15:26.196 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Busy Generation: DSP channel allocated for the resource
16:15:26.197 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Busy Generation: constructed
16:15:26.197 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Busy Generation: starting
16:15:26.198 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Busy Generation: TDM map
16:15:26.199 TA.T03 clearResponse event rejected, no matching CallID
2016.05.26 16:15:26 TM.T03 06 IsdnTmStateIdling - clear trunk appearance
2016.05.26 16:15:27 SMDR 186 | 05/26/2016 16:15:26 | 0.0 0 | I 00/14 XXXXXXXXXXXXXXXXXXX 6073044673 | 00/00 T03 | 6072225393 | 0 N |
16:15:28.725 SIP.STACK MSG | Rx: UDP src=64.136.174.30:5060 dst=XXX.XXX.XXX.XXX:5060 |
16:15:28.726 SIP.STACK MSG | SIP/2.0 200 OK | |
16:15:28.727 SIP.STACK MSG | Via: SIP/2.0/UDP XXX.XXX.XXX.XXX:5060;branch=z9hG4bK-d092-32ebe19-1b069291 | |
16:15:28.727 SIP.STACK MSG | Record-Route: <sip:sansay2589032518rdb16371@64.136.174.30:5060;lr;transport=udp> | |
16:15:28.728 SIP.STACK MSG | To: "local" <sip:16072395254@64.136.174.30:5060>;tag=sansay2589032518rdb16371 | |
16:15:28.728 SIP.STACK MSG | From: <sip:6072387077@64.136.174.30:5060;transport=UDP>;tag=25843b0-7f000001-13c4-d092-512dd0d9-d092 | |
16:15:28.729 SIP.STACK MSG | Call-ID: 259eac0-7f000001-13c4-d092-390708b9-d092@64.136.174.30 | |
16:15:28.729 SIP.STACK MSG | CSeq: 1 INVITE | |
16:15:28.730 SIP.STACK MSG | Contact: <sip:16072395254@64.136.174.30:5060> | |
16:15:28.730 SIP.STACK MSG | Content-Type: application/sdp | |
16:15:28.732 SIP.STACK MSG | Content-Length: 170 | |
16:15:28.732 SIP.STACK MSG | ||
16:15:28.732 SIP.STACK MSG | v=0 | |
16:15:28.733 SIP.STACK MSG | o=Sansay-VSXi 188 1 IN IP4 64.136.174.30 | |
16:15:28.733 SIP.STACK MSG | s=Session Controller | |
16:15:28.734 SIP.STACK MSG | c=IN IP4 69.85.181.73 | |
16:15:28.734 SIP.STACK MSG | t=0 0 | |
16:15:28.735 SIP.STACK MSG | m=audio 20958 RTP/AVP 0 | |
16:15:28.735 SIP.STACK MSG | a=rtpmap:0 PCMU/8000 | |
16:15:28.736 SIP.STACK MSG | a=sendrecv | |
16:15:28.736 SIP.STACK MSG | a=ptime:20 | |
16:15:28.737 SIP.STACK MSG | ||
16:15:28.741 TM.T01 33 SipTM_Delivering | rcvd SIP call-leg response: 200 OK | |
16:15:28.741 TM.T01 33 SipTM_Delivering | No Supported header in message | |
16:15:28.742 TM.T01 33 SipTM_Delivering | call-leg -> RemoteAccepted | |
16:15:28.743 TM.T01 33 SipTM_Delivering | Loose Routing detected in Record-Route header URL. | |
16:15:28.744 TM.T01 33 SipTM_Delivering | Using addr spec from Record-Route instead of Contact. | |
16:15:28.745 TM.T01 33 SipTM_Delivering | State change | >> SipTM_Delivering->SipTM_Answering |
16:15:28.746 TM.T01 33 SipTM_Answering | rcvd: SIP 200 OK | |
16:15:28.747 TM.T01 33 SipTM_Answering | sent: TA->Connect | |
16:15:28.748 TA.T01 33 TAOutGoing | rcvd: connect from TM | |
16:15:28.749 TA.T01 33 State change | >> TAOutGoing->TAConnectWaitOut (TAS_Delivering) | |
16:15:28.750 SB.CALL 185 PreConnected | Called the connect routine | |
16:15:28.750 SB.CALL 185 State change | >> PreConnected->Connecting | |
16:15:28.751 SB.CALL 185 Connecting | Connect sent from T01 to T03 | |
16:15:28.752 TA.T03 22 TAConnectWaitIn | connect event accepted | |
16:15:28.752 TA.T03 22 State change | >> TAConnectWaitIn->TAConnectPending (TAS_Connected) |
16:15:28.753 TM.T03 22 IsdnTmStateInboundPreconnect->IsdnTmStateInboundConnecting
16:15:28.754 TM.T03 22 IsdnTmStateInboundConnecting::enter()
16:15:28.755 TM.T03 22 IsdnTmStateInboundConnecting->IsdnTmStateInboundConnected
16:15:28.755 TM.T03 22 IsdnTmStateInboundConnected::enter()
16:15:28.756 TA.T03 22 TAConnectPending | rcvd: connect from TM |
16:15:28.756 TM.T03 22 IsdnAppearanceChannel::enableFaxModemToneDetect - delayFaxEnableEvent enqueued
16:15:28.757 TA.T03 22 State change | >> TAConnectPending->TAConnected (TAS_Connected) |
16:15:28.758 SB.CALL 185 Connecting | Called the connectResponse routine |
16:15:28.758 SB.CCM connect:
16:15:28.759 SB.CCM : Call Struct 0x2984c10 : Call-ID = 185
16:15:28.759 SB.CCM : Org Acct = T03 | Dst Acct = T01 |
16:15:28.760 SB.CCM : Org Port ID = 0/2.22 Dst Port ID = 0/0.32
16:15:28.760 SB.CCM : Org TID = Ds1Ds0Usage Dst TID =
16:15:28.761 SB.CCM : SDP Transaction = CallID: 185
16:15:28.762 SB.CCM : SDP Offer = 0x02991d10, (127.0.0.2:10004)
16:15:28.762 SB.CCM : SDP Answer = 0x028b2310, (69.85.181.73:20958)
16:15:28.763 SB.CCM : RTP Channel = 0/1.3
16:15:28.763 SB.CCM connect: Call Connection Type is TDM_TO_RTP
16:15:28.764 SB.CCM offer ip 127.0.0.2, 10004, answer ip 69.85.181.73, 20958
16:15:28.766 SB.CCM Looking up outbound interface to 69.85.181.73
16:15:28.767 SB.CCM Changing RTP Channel source IP Address to XXX.XXX.XXX.XXX for Media Gateway on interface eth 0/1
16:15:28.767 SB.CCM connect: TDM streams: Table Ds1Ds0Usage 0/2.22 to Table 12372 0/1.3
16:15:28.768 SB.CCM not tdm only, call setupRtpChannel
16:15:28.768 SB.CCM setupRtpChannel, type 3, source 2, silence 0
16:15:28.769 ISDN.L2_FMT PRI 1 ==============================================
16:15:28.770 ISDN.L2_FMT PRI 1 Sent Sapi:00 C/R:C Tei:00 INFO Ns:61 Nr:8 P:0
16:15:28.770 ISDN.L2_FMT PRI 1 | Prot:08 CRL:2 CRV:82F2 | |
16:15:28.771 ISDN.L2_FMT PRI 1 | M - 07 CONNECT |
16:15:28.772 SB.CCM TheCallConnectionManager::setupRtpChannel, IP addr = 69.85.181.73, port = 20958
16:15:28.772 SB.CCM connect: Undo of previous operation not required
16:15:28.773 SB.CCM getFinalCodec: PCMU
16:15:28.774 SB.CCM connect: Configuring RTP Channel 0/1.3 to 69.85.181.73:20958 via PCMU
16:15:28.775 SB.CCM connect: | fpp=2 echo=on dtmf=0/0 dscp=46 vad=off |
16:15:28.776 RTP.CHANNEL Channel 0/1.3 stopped sucessfully.
16:15:28.777 SB.CCM connect: Starting RTP Channel
16:15:28.777 RTP.CHANNEL Channel 0/1.3 session statistics cleared.
16:15:28.778 RTP.CHANNEL Channel 0/1.3 started sucessfully.
16:15:28.778 SB.CCM firewallConnectCall: No action taken, firewall traversal is not enabled
16:15:28.779 SB.CALL 185 State change | >> Connecting->Connected |
16:15:28.780 SB.CALL 185 Connected | ConnectResponse sent from T03 to T01 |
16:15:28.780 RTP.CHANNEL t1 0/2.0.22 - dsp 0/1.3 - RTP: stopping
16:15:28.781 RTP.CHANNEL t1 0/2.0.22 - dsp 0/1.3 - RTP: starting
16:15:28.782 TA.T01 33 TAConnectWaitOut | connectResponse event accepted | |
16:15:28.782 TA.T01 33 State change | >> TAConnectWaitOut->TAConnected (TAS_Connected) | |
16:15:28.783 TM.T01 33 SipTM_Answering | tachg -> TAConnected | |
16:15:28.784 TM.T01 33 SipTM_Answering | State change | >> SipTM_Answering->SipTM_Acking |
16:15:28.787 SIP.STACK MSG | Tx: UDP src=XXX.XXX.XXX.XXX:5060 dst=64.136.174.30:5060 |
16:15:28.788 SIP.STACK MSG | ACK sip:16072395254@64.136.174.30:5060;transport=UDP SIP/2.0 | |
16:15:28.788 SIP.STACK MSG | From: <sip:6072387077@64.136.174.30:5060;transport=UDP>;tag=25843b0-7f000001-13c4-d092-512dd0d9-d092 | |
16:15:28.789 SIP.STACK MSG | To: "local" <sip:16072395254@64.136.174.30:5060>;tag=sansay2589032518rdb16371 | |
16:15:28.790 SIP.STACK MSG | Call-ID: 259eac0-7f000001-13c4-d092-390708b9-d092@64.136.174.30 | |
16:15:28.790 SIP.STACK MSG | CSeq: 1 ACK | |
16:15:28.791 SIP.STACK MSG | Via: SIP/2.0/UDP XXX.XXX.XXX.XXX:5060;branch=z9hG4bK-d09c-32ee284-7160fc46 | |
16:15:28.792 SIP.STACK MSG | Max-Forwards: 70 | |
16:15:28.792 SIP.STACK MSG | Supported: 100rel,replaces | |
16:15:28.793 SIP.STACK MSG | Allow: ACK, BYE, CANCEL, INFO, INVITE, NOTIFY, OPTIONS, PRACK, REFER, REGISTER | |
16:15:28.793 SIP.STACK MSG | User-Agent: ADTRAN_Total_Access_916_2nd_Gen/A4.11.00.E | |
16:15:28.794 SIP.STACK MSG | Contact: <sip:6072387077@XXX.XXX.XXX.XXX:5060;transport=UDP> | |
16:15:28.794 SIP.STACK MSG | Route: <sip:sansay2589032518rdb16371@64.136.174.30:5060;transport=udp;lr> | |
16:15:28.795 SIP.STACK MSG | Content-Length: 0 | |
16:15:28.795 SIP.STACK MSG | ||
16:15:28.797 TM.T01 33 SipTM_Acking | call-leg -> Connected | |
16:15:28.798 TM.T01 33 SipTM_Acking | State change | >> SipTM_Acking->SipTM_Connected |
16:15:28.798 TM.T01 33 SipTM_Connected | call-leg-mod -> Modify Idle | |
16:15:28.799 TM.T01 33 SipTM_Acking | sent: ACK |
16:15:29.007 TM.T03 22 IsdnApperanceChannel::delayFax
16:15:29.008 TM.T03 22 faxModemDetResource - startResource Passed TA-21 dspRes-295f090
16:15:29.009 TONESERVICES.EVENTS t1 0/2.0.22 - empty - Modem/FAX Detection: Request resource
16:15:29.010 TONESERVICES.EVENTS t1 0/2.0.22 - dsp 0/1.3 - Modem/FAX Detection: DSP channel allocated for the resource
16:15:29.011 TONESERVICES.EVENTS t1 0/2.0.22 - dsp 0/1.3 - Modem/FAX Detection: constructed
16:15:29.011 TONESERVICES.EVENTS t1 0/2.0.22 - dsp 0/1.3 - Modem/FAX Detection: starting
16:15:29.012 TONESERVICES.EVENTS t1 0/2.0.22 - dsp 0/1.3 - Modem/FAX Detection: TDM map
16:15:30.326 PM.0:14 Clearing Busy | Processed OnHook |
16:15:30.327 PM.0:14 State change | >> Clearing Busy->Idle |
16:15:30.328 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Busy Generation: stopping
16:15:30.329 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Busy Generation: TDM unmap
16:15:30.330 RTP.CHANNEL fxs 0/14 - dsp 0/1.2 - Busy Generation: releasing RTP resource
16:15:30.330 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Busy Generation: release
16:15:30.331 SA.9903 rcvd: AcctPhoneMgr_COSOverride from PM
16:15:33.462 PM.0:14 Idle | Processed OFFHOOK |
16:15:33.462 PM.0:14 State change | >> Idle->Requesting Dialtone |
16:15:33.463 SA.9903 Ca:0 Idle | rcvd: AcctPhoneMgr_appearance(ON) from PM |
16:15:33.463 SA.9903 Ca:0 State change | >> Idle->DigitGathering |
16:15:33.464 SA.9903 Ca:0 DigitGathering | sent: AcctPhoneMgr_cachg(CAS_ReqDigits) to PM |
16:15:33.465 PM.0:14 Requesting Dialtone CACHG:ReqDigits on primary CA
16:15:33.465 PM.0:14 State change | >> Requesting Dialtone->SendingDigits |
16:15:33.467 TONESERVICES.EVENTS fxs 0/14 - empty - Tone Detection: Request resource
16:15:33.468 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: DSP channel allocated for the resource
16:15:33.468 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: constructed
16:15:33.469 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: starting
16:15:33.470 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: TDM map
16:15:33.968 TONESERVICES.EVENTS fxs 0/14 - empty - DialTone Generation: Request resource
16:15:33.969 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: DSP channel allocated for the resource
16:15:33.970 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: constructed
16:15:33.971 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: starting
16:15:33.972 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: TDM map
16:15:35.591 PM.0:14 SendingDigits | Digit 1 processed |
16:15:35.592 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (1) event
16:15:35.593 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: stopping
16:15:35.593 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: TDM unmap
16:15:35.594 RTP.CHANNEL fxs 0/14 - dsp 0/1.2 - DialTone Generation: releasing RTP resource
16:15:35.595 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - DialTone Generation: release
16:15:35.596 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(1) from PM |
16:15:35.596 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 second(s) for more digits |
16:15:36.261 PM.0:14 SendingDigits | Digit 6 processed |
16:15:36.262 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (6) event
16:15:36.262 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(6) from PM |
16:15:36.263 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:36.731 PM.0:14 SendingDigits | Digit 0 processed |
16:15:36.732 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (0) event
16:15:36.732 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(0) from PM |
16:15:36.733 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:37.160 PM.0:14 SendingDigits | Digit 7 processed |
16:15:37.161 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (7) event
16:15:37.162 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(7) from PM |
16:15:37.163 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:37.840 PM.0:14 SendingDigits | Digit 2 processed |
16:15:37.841 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (2) event
16:15:37.842 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(2) from PM |
16:15:37.843 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:38.200 PM.0:14 SendingDigits | Digit 2 processed |
16:15:38.201 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (2) event
16:15:38.202 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(2) from PM |
16:15:38.203 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:38.511 PM.0:14 SendingDigits | Digit 2 processed |
16:15:38.512 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (2) event
16:15:38.512 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(2) from PM |
16:15:38.513 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:38.991 PM.0:14 SendingDigits | Digit 5 processed |
16:15:38.992 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (5) event
16:15:38.992 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(5) from PM |
16:15:38.993 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:39.371 PM.0:14 SendingDigits | Digit 3 processed |
16:15:39.372 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (3) event
16:15:39.372 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(3) from PM |
16:15:39.373 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:39.840 PM.0:14 SendingDigits | Digit 9 processed |
16:15:39.842 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (9) event
16:15:39.842 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(9) from PM |
16:15:39.843 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:40.260 PM.0:14 SendingDigits | Digit 3 processed |
16:15:40.261 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: received digit (3) event
16:15:40.262 SA.9903 Ca:0 DigitGathering | rcvd: AcctPhoneMgr_dialDigit(3) from PM |
16:15:40.263 SA.9903 Ca:0 DigitGathering | Named-digit-timeout waiting 0 seconds for more digits |
16:15:40.263 SA.9903 Ca:0 State change | >> DigitGathering->DigitGathering |
16:15:40.264 SA.9903 Ca:0 DigitGathering | sent: AcctPhoneMgr_cachg(CAS_Active) to PM |
16:15:40.265 PM.0:14 State change | >> SendingDigits->Call Pending |
16:15:40.266 SA.9903 Ca:0 DigitGathering | sent: call to SB |
16:15:40.267 SA.9903 Ca:0 State change | >> DigitGathering->CallPending |
16:15:40.268 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: stopping
16:15:40.268 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: TDM unmap
16:15:40.269 RTP.CHANNEL fxs 0/14 - dsp 0/1.2 - Tone Detection: releasing RTP resource
16:15:40.270 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Tone Detection: release
16:15:40.271 SA.9903 rcvd: AcctPhoneMgr_billingCode from PM
16:15:40.271 SB.CALL 187 Idle | Called the call routine with 16072225393 |
16:15:40 SB.TGMgr For dialed number 16072225393, against template $, on TrunkGroup PRI TO PBX, the score is 500
16:15:40 SB.TGMgr For dialed number 16072225393, against template $, on TrunkGroup SIP VI, the score is 500
16:15:40.273 SB.CCM isMappable:
16:15:40.274 SB.CCM : Call Struct 0x280bc10 : Call-ID = 187
16:15:40.274 SB.CCM : Org Acct = 9903 | Dst Acct = T03 |
16:15:40.275 SB.CCM : Org Port ID = 0/14.0 Dst Port ID = 0/0.0
16:15:40.275 SB.CCM : Org TID = Fxs Dst TID =
16:15:40.276 SB.CCM isMappable: Call Connection Type is TDM_TO_TDM
16:15:40.277 SB.CALL 187 Idle | Call sent from 9903 to T03 (16072225393) |
16:15:40.277 SB.CALL 187 State change | >> Idle->Delivering |
16:15:40.278 SA.9903 Ca:0 CallPending | rcvd: callResponse from SB |
16:15:40.278 SA.9903 Ca:0 State change | >> CallPending->Calling |
16:15:40.279 TA.T03 05 State change | >> TAIdle->TAOutGoing (TAS_Delivering) |
16:15:40.280 TM.T03 05 tachg_Delivering
16:15:40.281 TM.T03 05 IsdnTmStateIdle->IsdnTmStateOutboundDeliver
16:15:40.282 TM.T03 05 IsdnTmStateOutboundDeliver::enter()
16:15:40.283 ISDN.L2_FMT PRI 1 ==============================================
16:15:40.283 ISDN.L2_FMT PRI 1 Sent Sapi:00 C/R:C Tei:00 INFO Ns:62 Nr:8 P:0
16:15:40.284 ISDN.L2_FMT PRI 1 | Prot:08 CRL:2 CRV:006E | |
16:15:40.284 ISDN.L2_FMT PRI 1 | M - 05 SETUP | |
16:15:40.284 ISDN.L2_FMT PRI 1 | IE - 04 BEARER CAPABILITY Len=3 | |
16:15:40.285 ISDN.L2_FMT PRI 1 | 80 Xfer Cap.:SPEECH | |
16:15:40.285 ISDN.L2_FMT PRI 1 | 90 Xfer Rate:64k | |
16:15:40.286 ISDN.L2_FMT PRI 1 | A2 Layer 1:u-Law | |
16:15:40.286 ISDN.L2_FMT PRI 1 | IE - 18 CHANNEL ID | Len=3 |
16:15:40.286 ISDN.L2_FMT PRI 1 | A1 Primary Rate | |
16:15:40.287 ISDN.L2_FMT PRI 1 | Intfc ID:IMPLICIT | |
16:15:40.287 ISDN.L2_FMT PRI 1 | Pref/Excl:PREFERRED | |
16:15:40.287 ISDN.L2_FMT PRI 1 | D-Chan Indicated:NO | |
16:15:40.288 ISDN.L2_FMT PRI 1 | Chan. Sel:FOLLOWS | |
16:15:40.288 ISDN.L2_FMT PRI 1 | 83 Numb/Map:NUMBER | |
16:15:40.288 ISDN.L2_FMT PRI 1 | 85 Channel:5 | |
16:15:40.289 ISDN.L2_FMT PRI 1 | IE - 1C FACILITY | Len=28 |
16:15:40.289 ISDN.L2_FMT PRI 1 | Calling Name: XXXXXXXXXXXXXXXXXXX | |
16:15:40.289 ISDN.L2_FMT PRI 1 | IE - 6C CALLING PARTY # | Len=12 |
16:15:40.290 ISDN.L2_FMT PRI 1 | 00 Numb. Type:UNKNOWN | |
16:15:40.290 ISDN.L2_FMT PRI 1 | Numb. Plan:UNKNOWN | |
16:15:40.291 ISDN.L2_FMT PRI 1 | 80 Presentation:ALLOWED | |
16:15:40.291 ISDN.L2_FMT PRI 1 | Ph.# 6073044673 | |
16:15:40.291 ISDN.L2_FMT PRI 1 | IE - 70 CALLED PARTY # | Len=12 |
16:15:40.292 ISDN.L2_FMT PRI 1 | 80 Numb. Type:UNKNOWN | |
16:15:40.292 ISDN.L2_FMT PRI 1 | Numb. Plan:UNKNOWN | |
16:15:40.293 ISDN.L2_FMT PRI 1 | Ph.# 16072225393 | |
16:15:40.294 SB.CALL 187 Delivering | Called the deliverResponse routine from Delivering | |
16:15:40.295 SB.CALL 187 Delivering | DeliverResponse(accept) sent from T03 to 9903 | |
16:15:40.295 SA.9903 Ca:0 Calling | rcvd: deliverResponse from SB | |
16:15:40.296 SA.9903 Ca:0 Calling | sent: AcctPhoneMgr_info to PM |
16:15:40.296 PM.0:14 ERROR! APM_Info ignored
16:15:40.402 ISDN.L2_FMT PRI 1 ==============================================
16:15:40.402 ISDN.L2_FMT PRI 1 Recd Sapi:00 C/R:R Tei:00 INFO Ns:8 Nr:63 P:0
16:15:40.403 ISDN.L2_FMT PRI 1 | Prot:08 CRL:2 CRV:806E | |
16:15:40.403 ISDN.L2_FMT PRI 1 | M - 5A RELEASE_CMP | |
16:15:40.404 ISDN.L2_FMT PRI 1 | IE - 08 CAUSE | Len=2 |
16:15:40.404 ISDN.L2_FMT PRI 1 | 80 Location:U | |
16:15:40.405 ISDN.L2_FMT PRI 1 | 91 Cause:17 (USER_BUSY) |
16:15:40.410 TM.T03 05 IsdnTmStateOutboundDeliver->IsdnTmStateTrunkClearing
16:15:40.410 TM.T03 05 IsdnTmStateTrunkClearing::enter()
16:15:40.411 TM.T03 05 IsdnTmStateTrunkClearing->IsdnTmStateIdling
16:15:40.412 TM.T03 05 IsdnTmStateIdling::enter()
16:15:40.412 TM.T03 05 IsdnTmStateIdling - send appearance off
16:15:40.413 TM.T03 05 IsdnTmStateIdling->IsdnTmStateIdle
16:15:40.414 TM.T03 05 IsdnAppearanceChannel::releaseChannel
16:15:40.414 TM.T03 05 IsdnTmStateIdle::enter()
16:15:40.415 TA.T03 05 TAOutGoing | rcvd: clear from TM |
16:15:40.415 TA.T03 05 State change | >> TAOutGoing->TATrunkClearing (TAS_Clearing) |
16:15:40.416 TM.T03 05 IsdnTmStateIdle::tachgClearing - send appearance off
16:15:40.417 TA.T03 05 TATrunkClearing | rcvd: clear from TM |
16:15:40.417 TA.T03 05 State change | >> TATrunkClearing->TAClearingComplete (TAS_Clearing) |
16:15:40.418 TA.T03 05 TAClearingComplete rcvd: appearance off from TM
16:15:40.418 TA.T03 05 TAClearingComplete Clear Local Variables
16:15:40.419 TA.T03 05 State change | >> TAClearingComplete->TAIdle (TAS_Idle) |
16:15:40.420 SB.CALL 187 Delivering | Called the clearCall routine from Delivering |
16:15:40.420 SB.CALL 187 Delivering | Clearing due to Trunk Clear Reason on call from T03 to 9903 |
16:15:40.421 SB.CALL 187 State change | >> Delivering->Clearing |
16:15:40.422 TA.T03 05 TAIdle | rcvd: appearance off from TM |
16:15:40.423 TA.T03 05 TAIdle | Processing an appearance OFF |
16:15:40.423 SA.9903 Ca:0 Calling | rcvd: clearCall from SB |
16:15:40.424 SA.9903 Ca:0 Calling | sent: clearResponse(pass) to SB |
16:15:40.424 SA.9903 Ca:0 State change | >> Calling->Idle |
16:15:40.425 SA.9903 Ca:0 Idle | sent: AcctPhoneMgr_faxModem to PM |
16:15:40.426 SA.9903 Ca:0 Idle | sent: AcctPhoneMgr_cachg(CAS_Idle) to PM |
16:15:40.427 PM.0:14 Call Pending | Pri CA, Idle response, App OFF sent |
16:15:40.427 PM.0:14 State change | >> Call Pending->Clearing Busy |
16:15:40.429 SB.CALL 187 Clearing | Called the clearResponse routine |
16:15:40.429 SB.CALL 187 State change | >> Clearing->CallIdlePending |
16:15:40.430 SB.CCM release:
16:15:40.431 SB.CCM : Call Struct 0x280bc10 : Call-ID = 187
16:15:40.431 SB.CCM : Org Acct = 9903 | Dst Acct = T03 |
16:15:40.432 SB.CCM : Org Port ID = 0/14.0 Dst Port ID = 0/0.0
16:15:40.432 SB.CCM : Org TID = Fxs Dst TID = Isdn Group Table
16:15:40.433 SB.CCM release: Call Connection Type is TDM_TO_TDM
16:15:40.433 SB.CALL 187 CallIdlePending | ClearResponse sent from 9903 to T03 |
16:15:40.434 SA.9903 Ca:0 Idle | rcvd: AcctPhoneMgr_appearance(OFF) from PM |
16:15:40.435 SA.9903 Ca:0 Idle | sent: AcctPhoneMgr_cachg(CAS_Idle) to PM |
16:15:40.435 PM.0:14 Clearing Busy | Dropped CACHG w/Call State not RINGING |
16:15:40.436 TONESERVICES.EVENTS fxs 0/14 - empty - Busy Generation: Request resource
16:15:40.437 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Busy Generation: DSP channel allocated for the resource
16:15:40.437 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Busy Generation: constructed
16:15:40.438 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Busy Generation: starting
16:15:40.439 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Busy Generation: TDM map
16:15:40.439 TA.T03 clearResponse event rejected, no matching CallID
2016.05.26 16:15:40 TM.T03 05 IsdnTmStateIdling - clear trunk appearance
2016.05.26 16:15:41 SMDR 187 | 05/26/2016 16:15:40 | 0.0 0 | I 00/14 XXXXXXXXXXXXXXXXXXX 6073044673 | 00/00 T03 | 16072225393 | 0 N |
16:15:44.582 PM.0:14 Clearing Busy | Processed OnHook | |||||
16:15:44.583 PM.0:14 State change | >> Clearing Busy->Idle |
16:15:44.584 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Busy Generation: stopping
16:15:44.585 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Busy Generation: TDM unmap
16:15:44.586 RTP.CHANNEL fxs 0/14 - dsp 0/1.2 - Busy Generation: releasing RTP resource
16:15:44.587 TONESERVICES.EVENTS fxs 0/14 - dsp 0/1.2 - Busy Generation: release
16:15:44.587 SA.9903 rcvd: AcctPhoneMgr_COSOverride from PM
Sam, the 900 is designed to act as a gateway between an IP source and a TDM source, whether it be one direction or another. It is not designed to route calls from one TDM interface to another and as such, that application has not been tested and can not be guaranteed to work. Thanks
Jay
ADTRAN TSE