Skip to end of metadata
Go to start of metadata

You are viewing an old version of this page. View the current version.

Compare with Current View Page History

Version 1 Current »

Call Trace - 180 Ringing (F-6480)

In the call trace below, the 2020 IMG receives a 180 Ringing message with SDP from egress or B leg of a call. The 180 Ringing Behavior field is set to 180 Ringing. The 180 Ringing message is propagated and regenerated on the ingress or A leg of the call as a 180 Ringing with ring tone but without SDP.

07:05:46.836 CALL(SIP) (00:00013:00) RCVD INVITE W/SDP from 10.129.47.141:5060 udp CSeq:1
07:05:46.836 CALL(SIP) (00:00013:00)      with Via sent-by: 10.129.47.141
07:05:46.836 CALL(SIP) (00:00013:00)      Call-id: 1-5160@10.129.47.141
07:05:46.836 CALL(SIP) (00:00013:00)      and Msg Size: 534
07:05:46.836 CALL(SIP) (00:00013:00)
                        ---> [10.129.47.141, 5060]
                       INVITE sip:50885968@10.129.47.177:5060 SIP/2.0\r\n
                       Via: SIP/2.0/UDP 10.129.47.141:5060;branch=z9hG4bK-5160-1-0\r\n
                       From: sipp <sip:sipp@10.129.47.141:5060>;tag=5160SIPpTag001\r\n
                       To: sut <sip:50885968@10.129.47.177:5060>\r\n
                       Call-ID: 1-5160@10.129.47.141\r\n
                       CSeq: 1 INVITE\r\n
                       Contact: sip:sipp@10.129.47.141:5060\r\n
                       Max-Forwards: 70\r\n
                       Subject: Performance Test\r\n
                       Content-Type: application/sdp\r\n
                       Content-Length:   135\r\n
                       \r\n
                       v=0\r\n
                       o=user1 53655765 2353687637 IN IP4 10.129.47.141\r\n
                       s=-\r\n
                       c=IN IP4 10.129.47.141\r\n
                       t=0 0\r\n
                       m=audio 6001 RTP/AVP 0\r\n
                       a=rtpmap:0 PCMU/8000
07:05:46.836 CALL(SIP) (00:00013:00) SENT 100 Trying to 10.129.47.141:5060
07:05:46.836 CALL(SIP) (00:00013:00)
                        <--- [10.129.47.141, 5060 <- 10.129.47.177, 5060]
                       SIP/2.0 100 Trying\r\n
                       Via: SIP/2.0/UDP 10.129.47.141:5060;branch=z9hG4bK-5160-1-0;received=10.129.47.141\r\n
                       Call-ID: 1-5160@10.129.47.141\r\n
                       From: sipp <sip:sipp@10.129.47.141:5060>;tag=5160SIPpTag001\r\n
                       To: sut <sip:50885968@10.129.47.177:5060>\r\n
                       CSeq: 1 INVITE\r\n
                       Content-Length: 0\r\n
                       \r\n
                        
07:05:46.836 CALL(SIP) (00:00013:00) SENT Route Control to L4
07:05:46.836 CALL(L4)  (00:00013:00) RCVD Route Control from SIP
07:05:46.836 CALL(L4)  (00:00013:00) Accessing Route Table 2(m)
07:05:46.836 CALL(L4)  (00:00013:00) Accessing Resource Table 149
07:05:46.836 CALL(L4)  (00:00013:00) Hunting Algorithm is Round Robin
07:05:46.836 CALL(L4)  (00:00013:00) SENT Route Control Ack to SIP
07:05:46.836 CALL(SIP) (00:00013:00) RCVD Route Control Ack from L4
07:05:46.836 CALL(SIP) (00:00013:00) Session Group Profile ID is 1
07:05:46.836 CALL(SIP) (00:00013:00) SENT Route Control to L4
07:05:46.836 CALL(L4)  (00:00013:00) RCVD Route Control from SIP
07:05:46.836 CALL(L4)  (00:00013:00) Accessing IP Bearer Profiles
07:05:46.836 CALL(L4)  (00:00013:00) Profile Id 1 (RG 769)
07:05:46.836 CALL(SIP) (00:00013:00) RCVD Route Control Ack from L4
07:05:46.836 CALL(SIP) (00:00013:00) Checking if GW 1024(10.129.47.141:5060) is in blocking mode (0)
07:05:46.836 CALL(SIP) (00:00013:00) m line (audio) codec list:  0
07:05:46.836 CALL(SIP) (00:00013:00) RTP Type: 0, name: PCMU, clk: 8000
07:05:46.836 CALL(SIP) (00:00013:00) CODEC Negotiation Priority LOCAL
07:05:46.836 CALL(SIP) (00:00013:00) SRTP configuration Disabled
07:05:46.836 CALL(SIP) (00:00013:00) SDP Audio Codec Overlap Success
07:05:46.836 CALL(SIP) (00:00013:00) Local Media Capability is Audio Only
07:05:46.836 CALL(SIP) (00:00013:00) SENT iL3-L3 Reserve Resource Request to VPPL
07:05:46.836 CALL(VPP) (00:00013:00) RCVD Reserve Resource [its 14] from L3P
07:05:46.836 CALL(VPP) (00:00013:00) SENT Reserve Resource Request to CM
07:05:46.836 CALL(XCM) (00:00013:00) LTS:3470 Processing RESERVE request for xCM_PACKET_AUDIO_CHANNEL
07:05:46.836 CALL(XCM) (00:00013:00) SENT MEDAUDIO_MODM_CHAN_RESERVE_REQ chanType 1 groupId 0x1
07:05:46.836 CALL(XCM) (00:00013:00) LTS:3470 RCV :0x2f01(MEDAUDIO_MODM_CHAN_RESERVE_RESP) in state:xCM_CHANNEL_RESERVING
07:05:46.836 CALL(XCM) (00:00013:00) Sending message:0x2b17(XCM_CHANNEL_RESERVE_RSP), result=0x0
07:05:46.836 CALL(VPP) (00:00013:00) RCVD Reserve Resp from CM
07:05:46.836 CALL(VPP) (00:00013:00) SENT Reserve ACK (toPvid: x66) to L3P
07:05:46.836 CALL(SIP) (00:00013:00) RCVD Reserve Resource ACK from VPPL
07:05:46.836 CALL(SIP) (00:00013:00) 1: CPC (Default)
07:05:46.836 CALL(SIP) (00:00013:00) Leg 0 associated with hndl(21975), LTS(3470)(span 8208 chan 14)
07:05:46.836 CALL(SIP) (00:00013:00) SENT Setup to L4
07:05:46.846 CALL(L4)  (00:00013:00) RCVD Setup Ind  from SIP
07:05:46.846 CALL(L4)  (00:00013:00)
07:05:46.846 CALL(L4)  (00:00013:00) SENT RFS to GCL
07:05:46.846 CALL(GCL) (00:00013:00) RCVD RFS DN=[50885968] ANI=[] GN=[] from L4
07:05:46.846 CALL(GCL) (00:00013:00) DN  NOA=[3]
07:05:46.846 CALL(GCL) (00:00013:00) Incoming Channel Group = 0 [SIP1]
07:05:46.846 CALL(L4)  (00:00013:00) RCVD RFS response  from GCL
07:05:46.846 CALL(GCL) (00:00013:00) SENT Make Call Request to GCL
07:05:46.846 CALL(GCL) (00:00013:01) SENT Route Control to L4
07:05:46.846 CALL(L4)  (00:00013:00) RCVD Route Control from GCL
07:05:46.846 CALL(L4)  (00:00013:00) Accessing Route Table 5
07:05:46.846 CALL(GCL) (00:00013:01) RCVD Route Control Ack (Mid Stream Router) from L4
07:05:46.846 CALL(GCL) (00:00013:01) Outgoing Channel Group = 1 [SIP2]
07:05:46.846 CALL(GCL) (00:00013:01) SENT Route Control to L4
07:05:46.846 CALL(L4)  (00:00013:01) RCVD Route Control from GCL
07:05:46.846 CALL(L4)  (00:00013:01) Accessing Resource Table 149
07:05:46.846 CALL(L4)  (00:00013:01) Resource Group ID is 1
07:05:46.846 CALL(L4)  (00:00013:01) Hunting Algorithm is Round Robin
07:05:46.856 CALL(GCL) (00:00013:01) RCVD CPE of ADDRESS INFO from L4
07:05:46.856 CALL(GCL) (00:00013:01) Leg 1 associated with LTS(3471)(span 8208 chan 15)
07:05:46.856 CALL(L4)  (00:00013:01) SENT Outseize Ctrl to SIP
07:05:46.856 CALL(SIP) (00:00013:01) RCVD Outseize Ctrl from L4
07:05:46.856 CALL(SIP) (00:00013:01) SENT Route Control to L4
07:05:46.856 CALL(L4)  (00:00013:01) RCVD Route Control from SIP
07:05:46.856 CALL(L4)  (00:00013:01) Accessing GatewayId to IP Tables
07:05:46.856 CALL(L4)  (00:00013:01) Gateway ID is 1025
07:05:46.856 CALL(SIP) (00:00013:01) RCVD Route Control Ack from L4
07:05:46.856 CALL(SIP) (00:00013:01) Session Group Profile ID is 1
07:05:46.856 CALL(SIP) (00:00013:01) SENT Route Control to L4
07:05:46.856 CALL(L4)  (00:00013:01) RCVD Route Control from SIP
07:05:46.856 CALL(L4)  (00:00013:01) Accessing IP Bearer Profiles
07:05:46.856 CALL(L4)  (00:00013:01) Profile Id 1 (RG 769)
07:05:46.856 CALL(SIP) (00:00013:01) RCVD Route Control Ack from L4
07:05:46.856 CALL(SIP) (00:00013:01) Remote Media Capability is audio Only
07:05:46.856 CALL(SIP) (00:00013:01) Local Media Capability is Audio Only
07:05:46.856 CALL(SIP) (00:00013:01) SENT iL3-L3 Reserve Resource Request to VPPL
07:05:46.856 CALL(VPP) (00:00013:01) RCVD Reserve Resource [its 15] from L3P
07:05:46.856 CALL(VPP) (00:00013:01) SENT Reserve Resource Request to CM
07:05:46.856 CALL(XCM) (00:00013:01) LTS:3471 Processing RESERVE request for xCM_PACKET_AUDIO_CHANNEL
07:05:46.856 CALL(XCM) (00:00013:01) SENT MEDAUDIO_MODM_CHAN_RESERVE_REQ chanType 1 groupId 0x1
07:05:46.856 CALL(XCM) (00:00013:01) LTS:3471 RCV :0x2f01(MEDAUDIO_MODM_CHAN_RESERVE_RESP) in state:xCM_CHANNEL_RESERVING
07:05:46.856 CALL(XCM) (00:00013:01) Sending message:0x2b17(XCM_CHANNEL_RESERVE_RSP), result=0x0
07:05:46.856 CALL(VPP) (00:00013:01) RCVD Reserve Resp from CM
07:05:46.856 CALL(VPP) (00:00013:01) SENT Reserve ACK (toPvid: x66) to L3P
07:05:46.856 CALL(SIP) (00:00013:01) RCVD Reserve Resource ACK from VPPL
07:05:46.856 CALL(SIP) (00:00013:01) REM TP port=6060 transport:0
07:05:46.856 CALL(SIP) (00:00013:01) Remote media capabilities:Audio local media capabilities:Audio
07:05:46.856 CALL(SIP) (00:00013:01) SENT INVITE W/SDP to 10.129.47.141:6060 Cseq:1
07:05:46.856 CALL(SIP) (00:00013:01)      with R-URI: 10.129.47.141:6060 UDP
07:05:46.856 CALL(SIP) (00:00013:01)      and Call-id: 4039-d8f-91020127546-Node0-0-10.129.47.177
07:05:46.856 CALL(SIP) (00:00013:01)
                        <--- [10.129.47.141, 6060 <- 10.129.47.177, 5060]
                       INVITE sip:50885968@10.129.47.141:6060 SIP/2.0\r\n
                       Via: SIP/2.0/UDP 10.129.47.177:5060;rport;branch=z9hG4bK-16b7-1349852746-21974-31\r\n
                       Call-ID: 4039-d8f-91020127546-Node0-0-10.129.47.177\r\n
                        
                       CSeq: 1 INVITE\r\n
                       Max-Forwards: 70\r\n
                       To: "sut"<sip:50885968@10.129.47.141:6060>\r\n
                       From: "unavailable"<sip:unavailable@10.129.47.177>;tag=58e8025a0fa07a00f9bd9fc91ed98963caff8e95\r\n
                       User-Agent: Dialogic-SIP/2.2.0.27 Node0 0\r\n
                       Privacy: none\r\n
                       Contact: <sip:unavailable@10.129.47.177:5060>\r\n
                       Allow: INVITE, BYE, REGISTER, ACK, OPTIONS, CANCEL, SUBS
                       CRIBE, NOTIFY, INFO, REFER, UPDATE\r\n
                       Supported: path, replaces, timer, tdialog\r\n
                       Session-Expires: 1800\r\n
                       Expires: 300\r\n
                       Organization: Dialogic\r\n
                       Content-Type: application/sdp\r\n
                       Content-Length: 168\r\n
                       \r\n
                       v=0\r\n
                       o=Dialogic_SDP 25 0 IN IP4 10.129.47.177\r\n
                       s=Dialogic-SIP\r\n
                       c=IN IP4 10.129.47.178\r\n
                       t=0 0\r\n
                       m=audio 12216 RTP/AVP 0\r\n
                       a=rtpmap:0 PCMU/8000\r\n
                       a=silenceSupp:off - - - -\r\n

Relevant section

07:05:46.876 CALL(SIP) (00:00013:01) RCVD 180 Ringing W/SDP from 10.129.47.141:6060 udp CSeq:1 Msg Size:577
07:05:46.876 CALL(SIP) (00:00013:01)
                        ---> [10.129.47.141, 6060 -> 10.129.47.177, 5060]
                       SIP/2.0 180 Ringing\r\n
                       Via: SIP/2.0/UDP 10.129.47.177:5060;rport;branch=z9hG4bK-16b7-1349852746-21974-31\r\n
                       From: "unavailable"<sip:unavailable@10.129.47.177>;tag=58e8025a0fa07a00f9bd9fc91ed98963caff8e95\r\n
                       To: "sut"<sip:50885968@10.129.47.141:6060>;tag=4868SIPpTag011\r\n
                       Call-ID: 4039-d8f-91020127546-Node0-0-10.129.47.177\r\n
                        
                       CSeq: 1 INVITE\r\n
                       Contact: <sip:10.129.47.141:6060;transport=UDP>\r\n
                       Content-Type: application/sdp\r\n
                       Content-Length:   139\r\n
                       \r\n
                       v=0\r\n
                       o=user1 53655765 2353687637 IN IP4 10.129.47.141\r\n
                       s=-\r\n
                       c=IN IP4 10.129.47.141\r\n
                       t=0 0\r\n
                       m=audio 6000 RTP/AVP 0\r\n
                       a=rtpmap:0 PCMU/8000\r\n
                       \r\n
                        
07:05:46.876 CALL(SIP) (00:00013:01) SENT Outseize Ack to L4
07:05:46.876 CALL(SIP) (00:00013:01) 180 Ringing Behavior : Send 180 Ringing
07:05:46.876 CALL(SIP) (00:00013:01) SENT Alerting to L4
07:05:46.876 CALL(SIP) (00:00013:01) RCVD 200 OK INVITE W/SDP from 10.129.47.141:6060 udp CSeq:1 Msg Size:568
07:05:46.876 CALL(SIP) (00:00013:01)
                        ---> [10.129.47.141, 6060 -> 10.129.47.177, 5060]
                       SIP/2.0 200 OK\r\n
                       Via: SIP/2.0/UDP 10.129.47.177:5060;rport;branch=z9hG4bK-16b7-1349852746-21974-31\r\n
                       From: "unavailable"<sip:unavailable@10.129.47.177>;tag=58e8025a0fa07a00f9bd9fc91ed98963caff8e95\r\n
                       To: "sut"<sip:50885968@10.129.47.141:6060>;tag=4868SIPpTag011\r\n
                       Call-ID: 4039-d8f-91020127546-Node0-0-10.129.47.177\r\n
                        
                       CSeq: 1 INVITE\r\n
                       Contact: <sip:10.129.47.141:6060;transport=UDP>\r\n
                       Content-Type: application/sdp\r\n
                       Content-Length:   135\r\n
                       \r\n
                       v=0\r\n
                       o=user1 53655765 2353687637 IN IP4 10.129.47.141\r\n
                       s=-\r\n
                       c=IN IP4 10.129.47.141\r\n
                       t=0 0\r\n
                       m=audio 6000 RTP/AVP 0\r\n
                       a=rtpmap:0 PCMU/8000
07:05:46.876 CALL(SIP) (00:00013:01) Session Refresh is not Needed
07:05:46.876 CALL(SIP) (00:00013:01) SDP Audio Codec Overlap Success
07:05:46.876 CALL(SIP) (00:00013:01) SENT Connect to L4
07:05:46.876 CALL(SIP) (00:00013:01) SENT ACK WO/SDP to 10.129.47.141:6060 Cseq:1
07:05:46.876 CALL(SIP) (00:00013:01)      with R-URI: 10.129.47.141:6060 UDP
07:05:46.876 CALL(SIP) (00:00013:01)
                        <--- [10.129.47.141, 6060 <- 10.129.47.177, 5060]
                       ACK sip:10.129.47.141:6060 SIP/2.0\r\n
                       Via: SIP/2.0/UDP 10.129.47.177:5060;rport;branch=z9hG4bK-e3a-1349852746-21974-31\r\n
                       Call-ID: 4039-d8f-91020127546-Node0-0-10.129.47.177\r\n
                        
                       CSeq: 1 ACK\r\n
                       Max-Forwards: 70\r\n
                       To: <sip:50885968@10.129.47.141:6060>;tag=4868SIPpTag011\r\n
                       From: <sip:unavailable@10.129.47.177>;tag=58e8025a0fa07a00f9bd9fc91ed98963caff8e95\r\n
                       User-Agent: Dialogic-SIP/2.2.0.27 Node0 0\r\n
                       Content-Length: 0\r\n
                       \r\n
                        
07:05:46.876 CALL(SIP) (00:00013:01) SENT CDR Msg Event to L4
07:05:46.876 CALL(SIP) (00:00013:01) Set audio media src IP 10.129.47.178:12216
07:05:46.876 CALL(SIP) (00:00013:01) Set audio media dst IP 10.129.47.141:6000
07:05:46.876 CALL(SIP) (00:00013:01) CODEC Negotiation Priority LOCAL
07:05:46.876 CALL(SIP) (00:00013:01) Set media PLD Size 20
07:05:46.876 CALL(SIP) (00:00013:01) Set media PLD ID 2
07:05:46.876 CALL(SIP) (00:00013:01) RFC 2833 DTMF Relay Disabled,method=0
07:05:46.876 CALL(SIP) (00:00013:01) Set Fax Type to Bypass
07:05:46.876 CALL(SIP) (00:00013:01) Source Port Validation : Enabled
07:05:46.876 CALL(SIP) (00:00013:01) Set media dst IP 10.129.47.141:(rtp:6000)
07:05:46.876 CALL(SIP) (00:00013:01) Set media PLD ID 2
07:05:46.876 CALL(SIP) (00:00013:01) SENT iL3-L3 Outseize Ctrl to VPPL
07:05:46.876 CALL(L4)  (00:00013:01) RCVD Outseize ACK  from SIP
07:05:46.876 CALL(L4)  (00:00013:01) Set Call Answer Timeout : 180 sec
07:05:46.876 CALL(L4)  (00:00013:01) RVCD Alerting  from SIP
07:05:46.876 CALL(L4)  (00:00013:01) RCVD Connect  from SIP
07:05:46.876 CALL(L4)  (00:00013:01) SENT CDR Msg Event to GCL
07:05:46.876 CALL(GCL) (00:00013:01) RCVD CDR Msg Event from L4
07:05:46.876 CALL(GCL) (00:00013:00) SENT Connect w/Pad Response to L4
07:05:46.876 CALL(L4)  (00:00013:01) SENT Alerting to L4
07:05:46.876 CALL(L4)  (00:00013:01) Start Call Answer Timer (from L3 config): 180 secs
07:05:46.876 CALL(L4)  (00:00013:01) SENT CPE of ANSWER  to GCL
07:05:46.876 CALL(L4)  (00:00013:00) SENT Alerting to SIP
07:05:46.876 CALL(L4)  (00:00013:00) SENT Conn 1Way to xCM r_ts=0xd8f,l_ts=0xd8e
07:05:46.876 CALL(L4)  (00:00013:00) SENT Channel Connect Req to xCM
07:05:46.876 CALL(L4)  (00:00013:01) SENT Conn 1Way to xCM r_ts=0xd8e,l_ts=0xd8f
07:05:46.876 CALL(L4)  (00:00013:01) SENT Channel Connect Req to xCM
07:05:46.876 CALL(VPP) (00:00013:01) RCVD Outseize [its 15] from L3P
07:05:46.876 CALL(SIP) (00:00013:01) RCVD Host Connect from L4
07:05:46.876 CALL(VPP) (00:00013:01) SENT Channel Open Request to CM
07:05:46.876 CALL(SIP) (00:00013:00) RCVD Alerting from L4
07:05:46.876 CALL(SIP) (00:00013:00) Call Answer Timeout from L4 : 180(0) secs
07:05:46.876 CALL(XCM) (00:00013:00) XCM CONNECT request, channel in state xCM_CHANNEL_RESERVED, not ready, Postponing.
07:05:46.876 CALL(XCM) (00:00013:01) XCM CONNECT request, channel in state xCM_CHANNEL_RESERVED, not ready, Postponing.
07:05:46.876 CALL(XCM) (00:00013:01) LTS:3471 Processing OPEN request
07:05:46.876 CALL(XCM) (00:00013:01) SENT MEDAUDIO_MODM_CHAN_OPEN_REQ
07:05:46.876 CALL(AUD) (00:00013:01) RCVD OPEN REQ [ResID x1001041A; CID 1050; TransID 945254592]
07:05:46.876 CALL(SIP) (00:00013:00) Unsupported Header Relaying Disabled
07:05:46.876 CALL(SIP) (00:00013:00) SENT 180 Ringing WO/SDP to 10.129.47.141:5060 UDP
07:05:46.876 CALL(GCL) (00:00013:01) RCVD CPE of ANSWER  from L4
07:05:46.876 CALL(GCL) (00:00013:01) SENT Call Answered to GCL

Relevant section

07:05:46.876 CALL(SIP) (00:00013:00)
                        <--- [10.129.47.141, 5060 <- 10.129.47.177, 5060]
                       SIP/2.0 180 Ringing\r\n
                       Via: SIP/2.0/UDP 10.129.47.141:5060;branch=z9hG4bK-5160-
                       1-0;received=10.129.47.141\r\n
                       Call-ID: 1-5160@10.129.47.141\r\n
                       From: sipp <sip:sipp@10.129.47.141:5060>;tag=5160SIPpTag001\r\n
                       To: sut <sip:50885968@10.129.47.177:5060>;tag=e999eea9c63cb956897429d824080c90fd6bb0eb\r\n
                       Contact: <sip:50885968@10.129.47.177:5060>\r\n
                       CSeq: 1 INVITE\r\n
                       Allow: OPTIONS, CANCEL, UPDATE\r\n
                       Privacy: none\r\n
                       Server: Dialogic-SIP/2.2.0.27 Node0 0\r\n
                       Content-Length: 0\r\n
                       \r\n

07:05:46.876 CALL(GCL) (00:00013:00) SENT CPE of ANSWER  to L4
07:05:46.876 CALL(L4)  (00:00013:00) RCVD CPE of ANSWER from GCL
07:05:46.876 CALL(L4)  (00:00013:00) SENT Connect to SIP
07:05:46.876 CALL(SIP) (00:00013:00) RCVD Connect from L4
07:05:46.876 CALL(L4)  (00:00013:01) SENT Connect to SIP
07:05:46.876 CALL(SIP) (00:00013:00) Set audio media src IP 10.129.47.178:12208
07:05:46.876 CALL(SIP) (00:00013:00) Set audio media dst IP 10.129.47.141:6001
07:05:46.876 CALL(SIP) (00:00013:00) CODEC Negotiation Priority LOCAL
07:05:46.876 CALL(SIP) (00:00013:00) Set media PLD Size 20
07:05:46.876 CALL(SIP) (00:00013:00) Set media PLD ID 2
07:05:46.876 CALL(SIP) (00:00013:00) RFC 2833 DTMF Relay Disabled,method=0
07:05:46.876 CALL(SIP) (00:00013:00) Set Fax Type to Bypass
07:05:46.876 CALL(SIP) (00:00013:00) Source Port Validation : Enabled
07:05:46.876 CALL(SIP) (00:00013:00) Set media dst IP 10.129.47.141:(rtp:6001)
07:05:46.876 CALL(SIP) (00:00013:00) Set media PLD ID 2
07:05:46.876 CALL(SIP) (00:00013:00) SENT iL3-L3 Outseize Ctrl to VPPL
07:05:46.876 CALL(SIP) (00:00013:01) RCVD Connect from L4
07:05:46.876 CALL(VPP) (00:00013:00) RCVD Outseize [its 14] from L3P
07:05:46.876 CALL(VPP) (00:00013:00) SENT Channel Open Request to CM
07:05:46.876 CALL(XCM) (00:00013:00) LTS:3470 Processing OPEN request
07:05:46.876 CALL(XCM) (00:00013:00) SENT MEDAUDIO_MODM_CHAN_OPEN_REQ
07:05:46.876 CALL(AUD) (00:00013:00) RCVD OPEN REQ [ResID x100103F0; CID 1008; TransID 945235200]
07:05:46.926 CALL(AUD) (00:00013:00) SENT OPEN RESP [ResID x100103F0; CID 1008; TransID 945235200, SUCCESS]
07:05:46.926 CALL(AUD) (00:00013:01) SENT OPEN RESP [ResID x1001041A; CID 1050; TransID 945254592, SUCCESS]
07:05:46.926 CALL(XCM) (00:00013:00) LTS:3470 RCV :0x2f05(MEDAUDIO_MODM_CHAN_OPEN_RESP) in state:xCM_CHANNEL_OPENING
07:05:46.926 CALL(XCM) (00:00013:00) Sending message:0x2b19(XCM_CHANNEL_OPEN_RSP), result=0x0
07:05:46.926 CALL(XCM) (00:00013:00) XCM CONNECT, channels not ready, Postponing.
07:05:46.926 CALL(XCM) (00:00013:01) LTS:3471 RCV :0x2f05(MEDAUDIO_MODM_CHAN_OPEN_RESP) in state:xCM_CHANNEL_OPENING
07:05:46.926 CALL(XCM) (00:00013:01) Sending message:0x2b19(XCM_CHANNEL_OPEN_RSP), result=0x0
07:05:46.926 CALL(XCM) (00:00013:01) XCM CONNECT, channels not ready, Postponing.
07:05:46.926 CALL(VPP) (00:00013:00) RCVD Open Resp from CM
07:05:46.926 CALL(VPP) (00:00013:00) SENT Event Register Request to CM
07:05:46.926 CALL(VPP) (00:00013:01) RCVD Open Resp from CM
07:05:46.926 CALL(VPP) (00:00013:01) SENT Event Register Request to CM
07:05:46.926 CALL(VPP) (00:00013:00) RCVD Event Register Resp from CM
07:05:46.926 CALL(VPP) (00:00013:00) SENT Channel Configure Request to CM
07:05:46.926 CALL(VPP) (00:00013:01) RCVD Event Register Resp from CM
07:05:46.926 CALL(VPP) (00:00013:01) SENT Channel Configure Request to CM
07:05:46.926 CALL(XCM) (00:00013:00) LTS:3470 Processing CONFIG request
07:05:46.926 CALL(XCM) (00:00013:00) SENT MEDAUDIO_MODM_CHAN_CONFIG_REQ
07:05:46.926 CALL(XCM) (00:00013:01) LTS:3471 Processing CONFIG request
07:05:46.926 CALL(XCM) (00:00013:01) SENT MEDAUDIO_MODM_CHAN_CONFIG_REQ
07:05:46.926 CALL(AUD) (00:00013:00) RCVD CONFIG REQ [ResID x100103F0; CID 1008; TransID 1245624032]
07:05:46.926 CALL(AUD) (00:00013:00) VoIP Codec is G711Mulaw (PT=0); Payload Size is 20 ms
07:05:46.926 CALL(AUD) (00:00013:01) RCVD CONFIG REQ [ResID x1001041A; CID 1050; TransID 1245903680]
07:05:46.926 CALL(AUD) (00:00013:01) VoIP Codec is G711Mulaw (PT=0); Payload Size is 20 ms
07:05:47.026 CALL(AUD) (00:00013:00) Silence Suppression has been DISABLED
07:05:47.026 CALL(AUD) (00:00013:00) Echo Cancellation has been ENABLED
07:05:47.026 CALL(AUD) (00:00013:00) RTP Redundancy has been DISABLED
07:05:47.026 CALL(AUD) (00:00013:00) DTMF Relay (RFC2833) has been DISABLED
07:05:47.026 CALL(AUD) (00:00013:00) Media Inactivity Detection is DISABLED
07:05:47.026 CALL(AUD) (00:00013:01) Silence Suppression has been DISABLED
07:05:47.026 CALL(AUD) (00:00013:01) Echo Cancellation has been ENABLED
07:05:47.026 CALL(AUD) (00:00013:01) RTP Redundancy has been DISABLED
07:05:47.026 CALL(AUD) (00:00013:01) DTMF Relay (RFC2833) has been DISABLED
07:05:47.026 CALL(AUD) (00:00013:01) Media Inactivity Detection is DISABLED
07:05:47.066 CALL(AUD) (00:00013:01) SENT CONFIG RESP [ResID x1001041A; CID 1050; TransID 1245903680, SUCCESS]
07:05:47.066 CALL(AUD) (00:00013:00) SENT CONFIG RESP [ResID x100103F0; CID 1008; TransID 1245624032, SUCCESS]
07:05:47.066 CALL(XCM) (00:00013:01) LTS:3471 RCV :0x2f0d(MEDAUDIO_MODM_CHAN_CONFIG_RESP) in state:xCM_CHANNEL_CONFIGURING
07:05:47.066 CALL(XCM) (00:00013:01) SENT MEDAUDIO_MODM_CHAN_ACTIVATE_REQ
07:05:47.066 CALL(XCM) (00:00013:00) LTS:3470 RCV :0x2f0d(MEDAUDIO_MODM_CHAN_CONFIG_RESP) in state:xCM_CHANNEL_CONFIGURING
07:05:47.066 CALL(XCM) (00:00013:00) SENT MEDAUDIO_MODM_CHAN_ACTIVATE_REQ
07:05:47.066 CALL(AUD) (00:00013:01) RCVD ACTIVATE REQ [ResID x1001041A; CID 1050; TransID 1245903680]
07:05:47.066 CALL(AUD) (00:00013:01) Initial MID is DISABLED
07:05:47.066 CALL(AUD) (00:00013:00) RCVD ACTIVATE REQ [ResID x100103F0; CID 1008; TransID 1245624032]
07:05:47.066 CALL(AUD) (00:00013:00) Initial MID is DISABLED
07:05:47.106 CALL(AUD) (00:00013:00) SENT ACTIVATE RESP [ResID x100103F0; CID 1008; TransID 1245624032, SUCCESS]
07:05:47.106 CALL(AUD) (00:00013:01) SENT ACTIVATE RESP [ResID x1001041A; CID 1050; TransID 1245903680, SUCCESS]
07:05:47.106 CALL(XCM) (00:00013:00) LTS:3470 RCV :0x2f09(MEDAUDIO_MODM_CHAN_ACTIVATE_RESP) in state:xCM_CHANNEL_CONFIGURING
07:05:47.106 CALL(XCM) (00:00013:00) Sending message:0x2b1d(XCM_CHANNEL_CONFIG_RSP), result=0x0
07:05:47.106 CALL(XCM) (00:00013:00) XCM CONNECT, channels now ready! Proceeding!
07:05:47.106 CALL(XCM) (00:00013:00) TSI connect audio channel: localGTS(xec00), remoteGTS(xec2a)
07:05:47.106 CALL(XCM) (00:00013:00) Sending message:0x2b28(XCM_CHANNEL_CONNECT_RSP), result=0x0
07:05:47.106 CALL(XCM) (00:00013:01) LTS:3471 RCV :0x2f09(MEDAUDIO_MODM_CHAN_ACTIVATE_RESP) in state:xCM_CHANNEL_CONFIGURING
07:05:47.106 CALL(XCM) (00:00013:01) Sending message:0x2b1d(XCM_CHANNEL_CONFIG_RSP), result=0x0
07:05:47.106 CALL(XCM) (00:00013:01) XCM CONNECT, channels now ready! Proceeding!
07:05:47.106 CALL(L4)  (00:00013:00) RVCD Channel Connect Rsp  from xCM
07:05:47.106 CALL(XCM) (00:00013:01) TSI connect audio channel: localGTS(xec2a), remoteGTS(xec00)
07:05:47.106 CALL(XCM) (00:00013:01) Sending message:0x2b28(XCM_CHANNEL_CONNECT_RSP), result=0x0
07:05:47.106 CALL(L4)  (00:00013:01) RVCD Channel Connect Rsp  from xCM
07:05:47.106 CALL(VPP) (00:00013:00) RCVD Channel Cfg Resp from CM
07:05:47.106 CALL(VPP) (00:00013:00) SENT Outseize ACK (toPvid: x66) to L3P
07:05:47.106 CALL(VPP) (00:00013:00) SENT CutThru to SIP
07:05:47.106 CALL(VPP) (00:00013:00) SENT Connect to SIP
07:05:47.106 CALL(VPP) (00:00013:01) RCVD Channel Cfg Resp from CM
07:05:47.106 CALL(VPP) (00:00013:01) SENT Outseize ACK (toPvid: x66) to L3P
07:05:47.106 CALL(VPP) (00:00013:01) SENT CutThru to SIP
07:05:47.106 CALL(SIP) (00:00013:00) RCVD Outseize Ack from VPPL
07:05:47.106 CALL(SIP) (00:00013:00) Unsupported Header Relaying Disabled
07:05:47.106 CALL(SIP) (00:00013:00) Session Refresh is not Needed
07:05:47.106 CALL(SIP) (00:00013:00) SENT 200 OK INVITE W/SDP to 10.129.47.141:5060 UDP
07:05:47.106 CALL(SIP) (00:00013:00)
                        <--- [10.129.47.141, 5060 <- 10.129.47.177, 5060]
                       SIP/2.0 200 OK\r\n
                       Via: SIP/2.0/UDP 10.129.47.141:5060;branch=z9hG4bK-5160-1-0;received=10.129.47.141\r\n
                       Call-ID: 1-5160@10.129.47.141\r\n
                       From: sipp <sip:sipp@10.129.47.141:5060>;tag=5160SIPpTag001\r\n
                       To: sut <sip:50885968@10.129.47.177:5060>;tag=e999eea9c63cb956897429d824080c90fd6bb0eb\r\n
                       Contact: <sip:50885968@10.129.47.177:5060>\r\n
                       CSeq: 1 INVITE\r\n
                       Server: Dialogic-SIP/2.2.0.27 Node0 0\r\n
                       Allow: INVITE, BYE, REGISTER, ACK, OPTIONS, CANCEL, SUBS
                       CRIBE, NOTIFY, INFO, REFER, UPDATE\r\n
                       Supported: path, replaces, timer, tdialog\r\n
                       Accept: application/sdp, application/dtmf-relay, text/plain\r\n
                       Content-Type: application/sdp\r\n
                       Content-Length: 180\r\n
                       \r\n
                       v=0\r\n
                       o=Dialogic_SDP 24 0 IN IP4 10.129.47.177\r\n
                       s=Dialogic-SIP\r\n
                       c=IN IP4 10.129.47.178\r\n
                       t=0 0\r\n
                       m=audio 12208 RTP/AVP 0\r\n
                       a=rtpmap:0 PCMU/8000\r\n
                       a=silenceSupp:off - - - -\r\n
                       a=ptime:20\r\n
                        
07:05:47.106 CALL(SIP) (00:00013:00) RCVD Cut Thru from VPPL
07:05:47.106 CALL(SIP) (00:00013:00) RCVD Connect from VPPL
07:05:47.106 CALL(SIP) (00:00013:01) RCVD Outseize Ack from VPPL
07:05:47.106 CALL(SIP) (00:00013:01) RCVD Connect from L4
07:05:47.106 CALL(SIP) (00:00013:01) RCVD Cut Thru from VPPL
07:05:47.106 CALL(VPP) (00:00013:01) SENT Connect to SIP
07:05:47.106 CALL(SIP) (00:00013:01) RCVD Connect from VPPL
07:05:47.116 CALL(SIP) (00:00013:00) RCVD ACK from 10.129.47.141:5060 udp CSeq:1 Msg Size:403
07:05:47.116 CALL(SIP) (00:00013:00)      with Via sent-by: 10.129.47.141 udp
07:05:47.116 CALL(SIP) (00:00013:00)
                        ---> [10.129.47.141, 5060]
                       ACK sip:50885968@10.129.47.177:5060 SIP/2.0\r\n
                       Via: SIP/2.0/UDP 10.129.47.141:5060;branch=z9hG4bK-5160-1-5\r\n
                       From: sipp <sip:sipp@10.129.47.141:5060>;tag=5160SIPpTag001\r\n
                       To: sut <sip:50885968@10.129.47.177:5060>;tag=e999eea9c63cb956897429d824080c90fd6bb0eb\r\n
                       Call-ID: 1-5160@10.129.47.141\r\n
                       CSeq: 1 ACK\r\n
                       Contact: sip:sipp@10.129.47.141:5060\r\n
                       Max-Forwards: 70\r\n
                       Subject: Performance Test\r\n
                       Content-Length: 0\r\n
                       \r\n
                        
07:06:07.116 CALL(SIP) (00:00013:00) RCVD BYE from 10.129.47.141:5060 udp CSeq:2 Msg Size:403
07:06:07.116 CALL(SIP) (00:00013:00)      with Via sent-by: 10.129.47.141 UDP
07:06:07.116 CALL(SIP) (00:00013:00)
                        ---> [10.129.47.141, 5060]
                       BYE sip:50885968@10.129.47.177:5060 SIP/2.0\r\n
                       Via: SIP/2.0/UDP 10.129.47.141:5060;branch=z9hG4bK-5160-1-7\r\n
                       From: sipp <sip:sipp@10.129.47.141:5060>;tag=5160SIPpTag001\r\n
                       To: sut <sip:50885968@10.129.47.177:5060>;tag=e999eea9c63cb956897429d824080c90fd6bb0eb\r\n
                       Call-ID: 1-5160@10.129.47.141\r\n
                       CSeq: 2 BYE\r\n
                       Contact: sip:sipp@10.129.47.141:5060\r\n
                       Max-Forwards: 70\r\n
                       Subject: Performance Test\r\n
                       Content-Length: 0\r\n
                       \r\n
                        
07:06:07.116 CALL(SIP) (00:00013:00) SENT iL3-L3 Clear Req to VPPL
07:06:07.116 CALL(VPP) (00:00013:00) RCVD Clear Request [its 14] from L3P
07:06:07.116 CALL(VPP) (00:00013:00) SENT Channel Close Request to CM
07:06:07.116 CALL(XCM) (00:00013:00) LTS:3470 Processing CLOSE request
07:06:07.116 CALL(XCM) (00:00013:00) SENT MEDAUDIO_MODM_CHAN_CLOSE_REQ
07:06:07.116 CALL(AUD) (00:00013:00) RCVD CLOSE REQ [ResID x100103F0; CID 1008; TransID 1245624032]
07:06:07.136 CALL(AUD) (00:00013:00) RTCP STATS: TxPackets=1003; RxPackets=0; lostPackets=0
07:06:07.136 CALL(AUD) (00:00013:00) SENT CLOSE RESP [ResID x100103F0; CID 1008; TransID 1245624032, SUCCESS]
07:06:07.136 CALL(XCM) (00:00013:00) LTS:3470 RCV :0x2f07(MEDAUDIO_MODM_CHAN_CLOSE_RESP) in state:xCM_CHANNEL_CLOSING
07:06:07.136 CALL(XCM) (00:00013:00) Sending message:0x2b1a(XCM_CHANNEL_CLOSE_RSP), result=0x0
07:06:07.136 CALL(VPP) (00:00013:00) RCVD Close Resp from CM
07:06:07.136 CALL(VPP) (00:00013:00) SENT Event DeRegister Request to CM
07:06:07.136 CALL(VPP) (00:00013:00) RCVD Event DeRegister Resp from CM
07:06:07.136 CALL(VPP) (00:00013:00) SENT ClearReq no data to SIP
07:06:07.136 CALL(SIP) (00:00013:00) RCVD Clear Req from VPPL
07:06:07.136 CALL(SIP) (00:00013:00) SENT iL3-L3 Unreserve Resource Request to VPPL
07:06:07.136 CALL(VPP) (00:00013:00) RCVD UnReserve Resource [its 14] from L3P
07:06:07.136 CALL(VPP) (00:00013:00) SENT UnReserve Resource Request to CM
07:06:07.136 CALL(XCM) (00:00013:00) LTS:3470 Processing UNRESERVE request
07:06:07.136 CALL(XCM) (00:00013:00) SENT MEDAUDIO_MODM_CHAN_UNRESERVE_REQ
07:06:07.136 CALL(XCM) (00:00013:00) Sending message:0x2b18(XCM_CHANNEL_UNRESERVE_RSP), result=0x0
07:06:07.136 CALL(AUD) (00:00013:00) RCVD UNRESERVE REQ [ResID x100103F0; CID 1008; TransID 945212576]
07:06:07.136 CALL(AUD) (00:00013:00) SENT UNRESERVE RESP [ResID x100103F0; CID 1008; TransID 945212576, SUCCESS]
07:06:07.136 CALL(VPP) (00:00013:00) RCVD UnReserve Resp from CM
07:06:07.136 CALL(VPP) (00:00013:00) SENT Unreserve ACK (toPvid: x66) to L3P
07:06:07.136 CALL(SIP) (00:00013:00) RCVD Unreserve Resource ACK from VPPL
07:06:07.136 CALL(SIP) (00:00013:00) SENT Clear Request to L4
07:06:07.136 CALL(SIP) (00:00013:00) Unsupported Header Relaying Disabled
07:06:07.136 CALL(SIP) (00:00013:00) SENT 200 OK BYE to 10.129.47.141:5060 UDP
07:06:07.136 CALL(SIP) (00:00013:00)
                        <--- [10.129.47.141, 5060 <- 10.129.47.177, 5060]
                       SIP/2.0 200 OK\r\n
                       Via: SIP/2.0/UDP 10.129.47.141:5060;branch=z9hG4bK-5160-1-7;received=10.129.47.141\r\n
                       Call-ID: 1-5160@10.129.47.141\r\n
                       From: sipp <sip:sipp@10.129.47.141:5060>;tag=5160SIPpTag001\r\n
                       To: sut <sip:50885968@10.129.47.177:5060>;tag=e999eea9c63cb956897429d824080c90fd6bb0eb\r\n
                       CSeq: 2 BYE\r\n
                       Server: Dialogic-SIP/2.2.0.27 Node0 0\r\n
                       Content-Length: 0\r\n
                       \r\n
                        
07:06:07.136 CALL(L4)  (00:00013:00) RCVD Clear request  from SIP
07:06:07.136 CALL(L4)  (00:00013:00) SENT Disconnect to xCM r_ts=0xd8f,l_ts=0xd8e
07:06:07.136 CALL(L4)  (00:00013:00) SENT Channel Disconnect Req to xCM
07:06:07.136 CALL(L4)  (00:00013:01) SENT Disconnect to xCM r_ts=0xd8e,l_ts=0xd8f
07:06:07.136 CALL(L4)  (00:00013:01) SENT Channel Disconnect Req to xCM
07:06:07.136 CALL(L4)  (00:00013:00) SENT Channel Release w/data to GCL
07:06:07.136 CALL(GCL) (00:00013:00) RCVD Channel Released w/data, cause=16 from L4
07:06:07.136 CALL(GCL) (00:00013:00) Call Duration(sec): 21
07:06:07.136 CALL(GCL) (00:00013:00) SENT Clear Call Request to GCL
07:06:07.136 CALL(GCL) (00:00013:01) SENT Clear Response, cause=16 to L4
07:06:07.136 CALL(L4)  (00:00013:01) RCVD Clear, cause=16 from GCL
07:06:07.136 CALL(L4)  (00:00013:01) SENT Clear Request, cause=16 to SIP
07:06:07.136 CALL(SIP) (00:00013:01) RCVD Clear Request from L4
07:06:07.136 CALL(XCM) (00:00013:01) LTS:3471 Processing DISCONNECT request
07:06:07.136 CALL(XCM) (00:00013:01) TSI disconnect audio channel: localGTS(xec2a), remoteGTS(xec00)
07:06:07.136 CALL(XCM) (00:00013:01) Sending message:0x2b29(XCM_CHANNEL_DISCONNECT_RSP), result=0x0
07:06:07.136 CALL(L4)  (00:00013:00) RVCD Channel Disconnect Rsp  from xCM
07:06:07.136 CALL(SIP) (00:00013:01) Unsupported Header Relaying Disabled
07:06:07.136 CALL(L4)  (00:00013:01) RVCD Channel Disconnect Rsp  from xCM
07:06:07.136 CALL(SIP) (00:00013:01) Reason Hdr: "Normal call clearing"
07:06:07.136 CALL(SIP) (00:00013:01) SENT BYE to 10.129.47.141:6060 Cseq:2
07:06:07.136 CALL(SIP) (00:00013:01)      with R-URI: 10.129.47.141:6060 UDP
07:06:07.136 CALL(SIP) (00:00013:01)
                        <--- [10.129.47.141, 6060 <- 10.129.47.177, 5060]
                       BYE sip:10.129.47.141:6060 SIP/2.0\r\n
                       Via: SIP/2.0/UDP 10.129.47.177:5060;rport;branch=z9hG4bK-102f-1349852767-21974-31\r\n
                       Call-ID: 4039-d8f-91020127546-Node0-0-10.129.47.177\r\n
                        
                       CSeq: 2 BYE\r\n
                       Max-Forwards: 70\r\n
                       To: "sut"<sip:50885968@10.129.47.141:6060>;tag=4868SIPpTag011\r\n
                       From: <sip:unavailable@10.129.47.177>;tag=58e8025a0fa07a00f9bd9fc91ed98963caff8e95\r\n
                       User-Agent: Dialogic-SIP/2.2.0.27 Node0 0\r\n
                       Reason: SIP ;cause=16 ;text="Normal call clearing"\r\n
                       Privacy: none\r\n
                       Content-Length: 0\r\n
                       \r\n
                        
07:06:07.156 CALL(SIP) (00:00013:01) RCVD 200 OK BYE from 10.129.47.141:6060 udp CSeq:2 Msg Size:382
07:06:07.156 CALL(SIP) (00:00013:01)
                        ---> [10.129.47.141, 6060 -> 10.129.47.177, 5060]
                       SIP/2.0 200 OK\r\n
                       Via: SIP/2.0/UDP 10.129.47.177:5060;rport;branch=z9hG4bK-102f-1349852767-21974-31\r\n
                       From: <sip:unavailable@10.129.47.177>;tag=58e8025a0fa07a00f9bd9fc91ed98963caff8e95\r\n
                       To: "sut"<sip:50885968@10.129.47.141:6060>;tag=4868SIPpTag011\r\n
                       Call-ID: 4039-d8f-91020127546-Node0-0-10.129.47.177\r\n
                        
                       CSeq: 2 BYE\r\n
                       Contact: <sip:10.129.47.141:6060;transport=UDP>\r\n
                       Content-Length: 0\r\n
                       \r\n
                        
07:06:07.156 CALL(SIP) (00:00013:01) SENT iL3-L3 Clear Req to VPPL
07:06:07.156 CALL(VPP) (00:00013:01) RCVD Clear Request [its 15] from L3P
07:06:07.156 CALL(VPP) (00:00013:01) SENT Channel Close Request to CM
07:06:07.156 CALL(XCM) (00:00013:01) LTS:3471 Processing CLOSE request
07:06:07.156 CALL(XCM) (00:00013:01) SENT MEDAUDIO_MODM_CHAN_CLOSE_REQ
07:06:07.156 CALL(AUD) (00:00013:01) RCVD CLOSE REQ [ResID x1001041A; CID 1050; TransID 945235200]
07:06:07.186 CALL(AUD) (00:00013:01) RTCP STATS: TxPackets=1005; RxPackets=0; lostPackets=0
07:06:07.186 CALL(AUD) (00:00013:01) SENT CLOSE RESP [ResID x1001041A; CID 1050; TransID 945235200, SUCCESS]
07:06:07.186 CALL(XCM) (00:00013:01) LTS:3471 RCV :0x2f07(MEDAUDIO_MODM_CHAN_CLOSE_RESP) in state:xCM_CHANNEL_CLOSING
07:06:07.186 CALL(XCM) (00:00013:01) Sending message:0x2b1a(XCM_CHANNEL_CLOSE_RSP), result=0x0
07:06:07.186 CALL(VPP) (00:00013:01) RCVD Close Resp from CM
07:06:07.186 CALL(VPP) (00:00013:01) SENT Event DeRegister Request to CM
07:06:07.186 CALL(VPP) (00:00013:01) RCVD Event DeRegister Resp from CM
07:06:07.186 CALL(VPP) (00:00013:01) SENT ClearReq no data to SIP
07:06:07.186 CALL(SIP) (00:00013:01) RCVD Clear Req from VPPL
07:06:07.186 CALL(SIP) (00:00013:01) SENT iL3-L3 Unreserve Resource Request to VPPL
07:06:07.186 CALL(VPP) (00:00013:01) RCVD UnReserve Resource [its 15] from L3P
07:06:07.186 CALL(VPP) (00:00013:01) SENT UnReserve Resource Request to CM
07:06:07.186 CALL(XCM) (00:00013:01) LTS:3471 Processing UNRESERVE request
07:06:07.186 CALL(XCM) (00:00013:01) SENT MEDAUDIO_MODM_CHAN_UNRESERVE_REQ
07:06:07.186 CALL(XCM) (00:00013:01) Sending message:0x2b18(XCM_CHANNEL_UNRESERVE_RSP), result=0x0
07:06:07.186 CALL(AUD) (00:00013:01) RCVD UNRESERVE REQ [ResID x1001041A; CID 1050; TransID 1401455504]
07:06:07.186 CALL(AUD) (00:00013:01) SENT UNRESERVE RESP [ResID x1001041A; CID 1050; TransID 1401455504, SUCCESS]
07:06:07.186 CALL(VPP) (00:00013:01) RCVD UnReserve Resp from CM
07:06:07.186 CALL(VPP) (00:00013:01) SENT Unreserve ACK (toPvid: x66) to L3P
07:06:07.186 CALL(SIP) (00:00013:01) RCVD Unreserve Resource ACK from VPPL
07:06:07.186 CALL(SIP) (00:00013:01) SENT Clear Request to L4
07:06:07.186 CALL(L4)  (00:00013:01) RCVD Clear request  from SIP
07:06:07.186 CALL(L4)  (00:00013:01) SENT Channel Release w/data to GCL
07:06:07.186 CALL(GCL) (00:00013:01) RCVD Channel Released w/data, cause=16 from L4
07:06:07.186 CALL(GCL) (00:00013:01) Call Duration(sec): 21
  • No labels

Return to Documentation Home I Return to Sangoma Support