05663163mS RES: Fri 5/7/2013 14:47:32 FreeMem=60333268 59431900(2) CachedMem=901368 CMMsg=11(11) Buff=5200 1420 999 12351 5 Links=14171 BTree=0 CPU=1/3/7227/40012/50225/2
805663163mS RES2: IP 500 V2 8.1(69) Tasks=43 RTEngine=0 CMRTEngine=0 ExRTEngine=0 Timer=86 Poll=0 Ready=0 CMReady=0 CMQueue=0 VPNNQueue=0 Monitor=3 SSA=1 TCP=38 TAPI=0 ASC=1 SYS=MNTD OPT=UMNT SDSPD=2034
805663163mS RES4: XML MemObjs=45 PoolMem=2097152(1) FreeMem=2082064(1)
805663185mS PRN: Monitor Status IP 500 V2 8.1(69)
805663185mS PRN: LAW=A PRI=0, BRI=0, ALOG=0, VCOMP=32, MDM=0, WAN=0, MODU=0 LANM=0 CkSRC=0 VMAIL=1(VER=3 TYP=1) 1-X=0 CALLS=2(TOT=3146)
805663825mS SIP Rx: UDP 88.215.XX.XXX:5060 -> 10.170.xxx.xxx:5060
SIP/2.0 100 Trying
Via: SIP/2.0/UDP 10.170.xxx.xxx:5060;rport=5060;received=10.170.xxx.xxx;branch=z9hG4bKa5308a8cf38a8b7fe27a48f355d32cd1
From: "Main Fax" <sip:01293225101@10.170.xxx.xxx>;tag=98010bfdc0eddc1d
To: <sip:01634291050@88.215.XX.XXX>
Call-ID: 741fb211a7b21b98d9303b8ae3ce4aff
CSeq: 1121788515 INVITE
Content-Length: 0
805664575mS CMExtnEvt: v=(null) State, new=Idle old=Idle,0,0,Extn1305: DSS Emulation DefinityCPark Key Pressed 2
805664576mS CD: CALL: 0.25900.0 BState=Ringing Cut=3 Music=0.0 Aend="MainFax(3011)" (0.1) Bend="Line 17" [Line 17] (0.0) CalledNum=01634291050@88.215.XX.XXX () CallingNum=3011 (MainFax) Internal=0 Time=8135 AState=Dialled
805664785mS CMCallEvt: 0.25903.0 -1 BaseEP: NEW CMEndpoint f51fa990 TOTAL NOW=5 CALL_LIST=2
805664786mS CMCallEvt: 0.25903.0 -1 Extn1305.-1: NEW CMExtnEndpoint f51fa990, Name=Extn1305, Extn=1305, Phys Extn=1305
805664786mS CMCallEvt: CREATE CALL:3147 (f51f31f8)
805664786mS CMCallEvt: 0.25904.0 -1 BaseEP: NEW CMEndpoint f51860c8 TOTAL NOW=6 CALL_LIST=2
805664788mS CMExtnEvt: Extn1305: CMExtnHandler::SetCurrent( id: 0->25903 )
805664789mS CMExtnRx: v=1305, p1=0
CMSetup
Line: type=IPLine 250 Call: lid=257 id=25903 in=0
Called[] Type=Default (100) Reason=CMDRdirect Calling[1305] Type=Internal Plan=Default
BC: CMTC=Speech CMTM=Circuit CMTR=64 CMST=Default CMU1=ALaw
IE CMIECallingPartyName (110)(Type=CMNameDefault) name=Extn1305
IE CMIECallingPartyKName (226)(Type=CMNameDefault) name=Tony B
IE CMIEFastStartInfoData (6) 10 item(s)
805664789mS CMCallEvt: 257.25903.0 3147 Extn1305.0: StateChange: END=A CMCSIdle->CMCSDialInitiated
805664790mS CMExtnEvt: v=6 State, new=Dialling old=Idle,0,0,Extn1305
805664792mS CMTARGET: 257.25903.0 3147 Extn1305.0: LOOKUP CALL ROUTE: type=100 called_party= sub= calling=1305 dir=out complete=0 ses=0
805664792mS CMTARGET: 257.25903.0 3147 Extn1305.0: ADD TARGET (N): number= type=100 depth=1 nobar=1 setorig=1 ses=0
805664792mS CMCallEvt: 257.25903.0 3147 Extn1305.0: StateChange: END=A CMCSDialInitiated->CMCSDialling
805664795mS CMExtnTx: v=1305, p1=0
CMFacility
Line: type=IPLine 250 Call: lid=257 id=25903 in=0
IE CMIEFastStartInfoData (6) 2 item(s)
IE CMIESecurityData (253) 2 item(s)
Timed: 05/07/13 14:47
805664796mS CMExtnTx: v=1305, p1=8006
CMFacility
Line: type=IPLine 250 Call: lid=257 id=6 in=1
IE CMIEFastStartInfoData (6) 2 item(s)
805664796mS CMExtnTx: v=1305, p1=0
CMSetupAck
Line: type=IPLine 250 Call: lid=257 id=25903 in=0
Timed: 05/07/13 14:47
805664797mS CD: CALL: 257.25903.0 BState=Idle Cut=1 Music=3.0 Aend="Extn1305(1305)" (0.0) Bend="" [] (0.0) CalledNum= () CallingNum=1305 (Extn1305) Internal=1 Time=11 AState=DialInitiated
805664798mS H323Evt: SetOperational 6015 10.170.xxx.xxx:0 to 0
805664798mS CMMap: PCG::AddToneGenerator g D1[1] for cp[481]b0r1 append pcp[482]b0r1 (total 1)
805664798mS CMMap: PlatformConnectionAudioSAP::ConnectVoice pcp[482]b0r1 Configure 0.0
805664798mS CMMap: PlatformConnectionAudioSAP::ConnectVoice pcp[482]b0r1 ConnectIndication 0.0
805664799mS CMMap: a=0.0 b=0.0 pcp[481]b0r1 RTPD1
805664799mS H323Evt: SetOperational 6015 10.170.xxx.xxx:49154 to 1
805665490mS CMExtnEvt: Extn1308: No user activity
805665792mS H323Evt: RTP(50t): 10.170.xxx.xxx/49154 10.170.113.14/51928 CODEC=Alaw64K(4) PKTSZ=160 RFC2833=off AGE=994 SENT=50 (avg size=160) RECV=38 (avg size=160)
805666606mS CMExtnEvt: v=(null) State, new=Idle old=Idle,0,0,Extn1305: DSS Emulation DefinityCPark Key Pressed 2
805667095mS CMExtnEvt: Extn1305: ProcessShortCode feature=UnParkCall id=1
805667096mS CMExtnEvt: Extn1305: UnParkCall pickup=0.25899.0 3145 PARK:1 OnCurrent=1
805667096mS CMCallEvt: 257.25903.0 3147 Extn1305.0: Pickup 0.25899.0 3145 PARK:1 state CMCSDialling
805667096mS CMLOGGING: CALL:2013/07/0514:47,00:00:00,000,,O,,,,,,1,,""n/a,0
805667097mS CD: CALL: 257.25903.0 BState=Idle Cut=1 Music=0.0 Aend="" (0.0) Bend="" [] (0.0) CalledNum= () CallingNum= () Internal=1 Time=2311 AState=Idle
805667097mS CD: CALL: 257.25903.0 Deleted
805667097mS CMCallEvt: 0.25904.0 -1 BaseEP: DELETE CMEndpoint f51860c8 TOTAL NOW=5 CALL_LIST=2
805667097mS CMCallEvt: END CALL:3147 (f51f31f8)
805667098mS CMCallEvt: 257.25903.0 -1 Extn1305.0: StateChange: END=X CMCSDialling->CMCSOGConnReq
805667099mS CMExtnTx: v=1305, p1=0
CMFacility
Line: type=IPLine 250 Call: lid=257 id=25903 in=0
IE CMIEFastStartInfoData (6) 2 item(s)
Timed: 05/07/13 14:47
805667099mS CMExtnTx: v=1305, p1=8006
CMFacility
Line: type=IPLine 250 Call: lid=257 id=6 in=1
IE CMIEFastStartInfoData (6) 2 item(s)
805667100mS CMExtnEvt: v=6 State, new=Connected old=Dialling,0,0,Extn1305
805667101mS CMExtnTx: v=1305, p1=0
CMConnect
Line: type=IPLine 250 Call: lid=257 id=25903 in=0
Timed: 05/07/13 14:47
805667101mS CMExtnRx: v=1305, p1=0
CMConnectAck
Line: type=IPLine 250 Call: lid=257 id=25903 in=0
805667101mS CMCallEvt: 257.25903.0 -1 Extn1305.0: PickupProcessInboundMsg CMConnectAck
805667102mS CMCallEvt: 257.25903.0 -1 Extn1305.0: Pickup Complete
805667102mS PRN: CDR - ResetQueueSize=1500
805667103mS PRN: CDR - TCPSend maxqueuesize=1500 framecount=1500 operational=0
805667103mS ERR: CDRServer discarding - framecount=1500
805667103mS CMCallEvt: 1305: Pickup Complete CALL: (AEND=01634290879@88.215.XX.XXX BEND=1) ss_pickup 0
805667103mS CMCallEvt: 0.25899.0 3145 PARK:1: CallLost (Park @1) cause=CMCausePickup
805667109mS CMCallEvt: 0.25899.0 -1 PARK:1: StateChange: END=X CMCSConnected->CMCSDelete
805667112mS CMCallEvt: 257.25903.0 3145 Extn1305.0: StateChange: END=B CMCSOGConnReq->CMCSConnected
805667112mS CMTARGET: 257.25903.0 3145 Extn1305.0: ~CMTargetHandler f51c1c98 ep f51fa990
805667114mS CMExtnTx: v=1305, p1=0
CMFacility
Line: type=IPLine 250 Call: lid=257 id=25903 in=0
IE CMIERespondingPartyNumber (230)(P:100 S:100 T:0 N:100 R:4) number=01634290879@88.215.XX.XXX
IE CMIEDeviceDetail (231) LOCALE=eng HW=15 VER=8 class=CMDeviceSIPTrunk type=0 number=17 channel=3 rx_gain=32 tx_gain=32 ep_callid=25887 ipaddr=10.170.xxx.xxx apps=0
IE CMIERedirectingPartyName (232)(Type=CMNameDefault) name=Extn1308
IE CMIERedirectingPartyKName (233)(Type=CMNameDefault) name=Steve
IE CMIERedirectingPartyNumber (234)(P:100 S:100 T:101 N:100 R:4) number=1308
Tag type=Text flags=0x1 [Main XXXXXXXXXXXXNo.] [0x4d 0x61 0x69 0x6e 0x20 0x54 0x50 0x53 0x20 0x43 0x72 0x61 0x77 0x6c 0x65 0x79 0x20 0x4e 0x6f 0x00 ]
Timed: 05/07/13 14:47
805667118mS CMExtnTx: v=1305, p1=0
CMFacility
Line: type=IPLine 250 Call: lid=257 id=25903 in=0
IE CMIEFastStartInfoData (6) 2 item(s)
Timed: 05/07/13 14:47
805667119mS CMExtnTx: v=1305, p1=8006
CMFacility
Line: type=IPLine 250 Call: lid=257 id=6 in=1
IE CMIEFastStartInfoData (6) 2 item(s)
805667120mS CMLineTx: v=0
CMFacility
Line: type=SIPLine 17 Call: lid=17 id=25887 in=1
805667122mS CMExtnTx: v=1305, p1=0
CMFacility
Line: type=IPLine 250 Call: lid=257 id=25903 in=0
Timed: 05/07/13 14:47
805667122mS CMExtnTx: v=1305, p1=0
CMFacility
Line: type=IPLine 250 Call: lid=257 id=25903 in=0
IE CMIERespondingPartyNumber (230)(P:100 S:100 T:0 N:100 R:4) number=01634290879@88.215.XX.XXX
IE CMIEDeviceDetail (231) LOCALE=eng HW=15 VER=8 class=CMDeviceSIPTrunk type=0 number=17 channel=3 rx_gain=32 tx_gain=32 ep_callid=25887 ipaddr=10.170.xxx.xxx apps=0
IE CMIERedirectingPartyName (232)(Type=CMNameDefault) name=Extn1308
IE CMIERedirectingPartyKName (233)(Type=CMNameDefault) name=Steve
IE CMIERedirectingPartyNumber (234)(P:100 S:100 T:101 N:100 R:4) number=1308
IE CMIESupplementaryService (3)
Interpretation APDU
rejectAnyUnrecognisedInvokePdu
CallTransferComplete.Invoke.CodePageUnknown
invokeId 18666
redirection name '' redirection number '01634290879' primary end answered
Tag type=Text flags=0x1 [Main XXXXXXXXXXXXNo.] [0x4d 0x61 0x69 0x6e 0x20 0x54 0x50 0x53 0x20 0x43 0x72 0x61 0x77 0x6c 0x65 0x79 0x20 0x4e 0x6f 0x00 ]
Timed: 05/07/13 14:47
805667123mS CMLineTx: v=0
CMFacility
Line: type=SIPLine 17 Call: lid=17 id=25887 in=1
Called[] Type=Default (100) Reason=CMDRdirect Calling[1305] Type=Internal Plan=Default
IE CMIESupplementaryService (3)
Network Facility Extension
sourceEntity: 0
destinationEntity: 0
Interpretation APDU
discardAnyUnrecognisedInvokePdu
RetrieveNotific.Invoke.CodePageISO8859-1
invokeId 18667
IE CMIERespondingPartyName (228)(Type=CMNameDefault) name=Extn1305
IE CMIERespondingPartyKName (229)(Type=CMNameDefault) name=Tony B
IE CMIERespondingPartyNumber (230)(P:100 S:100 T:101 N:100 R:4) number=1305
IE CMIEDeviceDetail (231) LOCALE=eng HW=15 VER=8 class=CMDeviceH323Phone type=88 number=8006 channel=0 rx_gain=32 tx_gain=32 ep_callid=25903 ipaddr=10.170.xxx.xxx apps=0
IE CMIECallingPartyName (110)(Type=CMNameDefault) name=Extn1305
IE CMIECallingPartyKName (226)(Type=CMNameDefault) name=Tony B
Tag type=Text flags=0x1 [Main XXXXXXXXXXXXNo.] [0x4d 0x61 0x69 0x6e 0x20 0x54 0x50 0x53 0x20 0x43 0x72 0x61 0x77 0x6c 0x65 0x79 0x20 0x4e 0x6f 0x00 ]
805667124mS CMLineTx: v=0
CMFacility
Line: type=SIPLine 17 Call: lid=17 id=25887 in=1
IE CMIERespondingPartyName (228)(Type=CMNameDefault) name=Extn1305
IE CMIERespondingPartyKName (229)(Type=CMNameDefault) name=Tony B
IE CMIERespondingPartyNumber (230)(P:100 S:100 T:101 N:100 R:4) number=1305
IE CMIEDeviceDetail (231) LOCALE=eng HW=15 VER=8 class=CMDeviceH323Phone type=88 number=8006 channel=0 rx_gain=32 tx_gain=32 ep_callid=25903 ipaddr=10.170.xxx.xxx apps=0
805667125mS CMCallEvt: 0.25899.0 -1 BaseEP: DELETE CMEndpoint f515fbc8 TOTAL NOW=4 CALL_LIST=2
805667125mS CD: CALL: 17.25887.1 BState=Connected Cut=3 Music=0.0 Aend="Line 17" (0.0) Bend="" [Extn1305(1305)] (0.0) CalledNum=1305 (Extn1305) CallingNum=01634290879@88.215.XX.XXX () Internal=0 Time=138237 AState=Connected
805667127mS CMMap: a=0.0 b=0.0 pcp[481]b0r1 RTPD0
805667127mS H323Evt: SetOperational 6015 10.170.xxx.xxx:49154 to 0
805667127mS CMMap: PCG::MapBChan pcp[481]b0r1 cp_b 0 other_cp_b 0 type CGTypeSimple
805667128mS CMMap: a=0.0 b=0.0 pcp[471]b0r1 RTPH0
805667128mS H323Evt: SetOperational 6013 10.170.xxx.xxx:49158 to 0
805667128mS CMMap: PCG::MapBChan pcp[471]b0r1 cp_b 0 other_cp_b 0 type CGTypeSimple
805667128mS CMMap: PCG::MapBChan cp rtp_relay_id 0 cp_other rtp_relay_id 0 , cp use_reserved_codec 0, cp_other use_reserved_codec 0
805667128mS CMMap: PCG::MapBChan cp RTP local 10.170.xxx.xxx:49158 remote 88.215.XX.XXX:12890 , cp_other RTP local: 10.170.xxx.xxx:49154 remote 10.170.113.14:51928
805667128mS CMMap: PCG::MapBChan cp oob 0 rfc_2833 1 , cp_other oob 1, rfc_2833 0
805667129mS CMMap: PCG::MapBChan rtpRelay Open got rtpRelay ID: 1
805667129mS CMMap: PCG::MapBChan rtpRelay Configure success
805667129mS H323Evt: SetOperational 6013 10.170.xxx.xxx:49158 to 1
805667129mS H323Evt: SetOperational 6015 10.170.xxx.xxx:49154 to 1
805667402mS SIP Rx: UDP 88.215.XX.XXX:5060 -> 10.170.xxx.xxx:5060
SIP/2.0 500 Server Internal Error
Via: SIP/2.0/UDP 10.170.xxx.xxx:5060;rport=5060;received=10.170.xxx.xxx;branch=z9hG4bKa5308a8cf38a8b7fe27a48f355d32cd1
To: <sip:01634291050@88.215.XX.XXX>;tag=3582020870-605855
From: "Main Fax" <sip:01293225101@10.170.xxx.xxx>;tag=98010bfdc0eddc1d
Call-ID: 741fb211a7b21b98d9303b8ae3ce4aff
CSeq: 1121788515 INVITE
Allow: CANCEL, ACK, INVITE, BYE, OPTIONS, REGISTER, NOTIFY, INFO, REFER, SUBSCRIBE, PRACK, UPDATE, MESSAGE, PUBLISH
Contact: <sip:01634291050@88.215.XX.XXX:5060>
Content-Length: 0