05-25-2016 03:37 AM - edited 03-17-2019 07:01 AM
I have a Lab Setup that
Outbound calls are working 100%
Inbound calls fail after roughly 6 seconds, for that time period
I suspect
but
I have a provided a copy of my config, also love to know of any best practises anyone can recommend.
Building configuration...
Current configuration : 3696 bytes
!
! Last configuration change at 12:20:22 UTC Tue May
version 15.1
service timestamps debug
service timestamps log
no service password-encryption
!
hostname Cisco2811
!
boot-start-marker
boot system flash:c2800nm-adventerprisek9_ivs_li-mz.151-4.M10.bin
boot-end-marker
!
!
! card type command needed for slot/
enable secret 5
!
no aaa new-model
!
!
dot11
!
!
!
!
!
no ipv6
!
multilink bundle-name authenticated
!
!
!
!
!
!
!
voice service
ipv4 103.193.166.0 255.255.255.0
ipv4 192.168.0.9
ipv4 103.193.166.37
ipv4
allow-connections h323 to h323
allow-connections h323 to sip
allow-connections sip to h323
allow-connections sip to sip
sip
!
voice class codec 1
codec preference 1 g729r8
codec preference 2 g711alaw
codec preference 3 g711ulaw
!
!
!
!
voice translation-rule 1
rule 1 /03......../ /104xxxx/
!
!
voice translation-profile SIPout
translate calling 1
!
!
voice-card 0
!
crypto
!
!
!
!
license
archive
log config
username
!
redundancy
!
!
!
!
!
!
!
!
!
!
interface FastEthernet0/0
no
duplex auto
speed auto
!
interface FastEthernet0/1
duplex auto
speed auto
!
no
no
!
!
!
!
!
!
!
!
!
control-plane
!
!
!
!
!
!
bind interface FastEthernet0/1
associate ccm 1 priority 1
associate profile 1 register CUBEXCODE_1
keepalive timeout 10
switchback method graceful
switchback interval 1
!
codec g711ulaw
codec g711alaw
codec g729ar8
codec g729abr8
codec g722-64
maximum sessions 5
associate application SCCP
!
dial-peer voice 1
description ***outbound
translation-profile outgoing SIPout
preference 2
destination-pattern .T
session protocol sipv2
session target dns:sip.telecube.com.au
no
!
dial-peer voice 2
description inbound from CUCM
preference 1
destination-pattern 035915940.
session protocol sipv2
session target ipv4:192.168.0.9
no
!
!
sip-
credentials username 104xxxx password 7
authentication username 104xxxx password 7
retry invite 2
retry response 3
retry bye 3
retry
retry register 2
timers
registrar dns:sip.telecube.com.au expires 3600
sip-server dns:sip.telecube.com.au
!
!
!
gatekeeper
shutdown
!
!
telephony-service
sdspfarm units 1
max-
max-
max-conferences 8 gain -6
transfer-system full-consult
!
!
!
line con 0
line aux 0
line
password cisco
login
transport input all
!
scheduler allocate 20000 1000
end
DEBUG
also could you please outline the error in the logs just
*May 25 10:50:30.957: //-1/xxxxxxxxxxxx/SIP/Msg/ccsipDisplayMsg:
Received:
INVITE sip:0359159401@103.193.166.11 SIP/2.0
Record-Route: <sip:103.193.166.11;lr;did=e74.b69b5224>
Via: SIP/2.0/UDP 103.193.166.11:5060;branch=z9hG4bKe43e.1bfaf007.0
Via: SIP/2.0/UDP 103.193.166.37:5060;received=103.193.166.37;branch=z9hG4bK33433ef2;rport=5060
Max-Forwards: 69
From: "61418656729" <sip:0418656729@103.193.166.37>;tag=as75513f08
To: <sip:0359159401@103.193.166.11>
Contact: <sip:0418656729@103.193.166.37:5060>
Call-ID: 14d4c315453e08912a0a7b9a04cd0024@103.193.166.37:5060
CSeq: 102 INVITE
User-Agent: Asterisk (Telecube) PBX
Date: Wed, 25 May 2016 10:29:19 GMT
Allow: INVITE, ACK, CANCEL, OPTIONS, BYE, REFER, SUBSCRIBE, NOTIFY, INFO, PUBLISH
Supported: replaces, timer
X-Telecube-Event-Id: 1241464172158199876
X-Telecube-DID-Number: 0359159401
P-Asserted-Identity: "61418656729" <sip:0418656729@103.193.166.37>
Content-Type: application/sdp
Content-Length: 315
v=0
o=root 437668023 437668023 IN IP4 103.193.166.37
s=Asterisk (Telecube) PBX
c=IN IP4 103.193.166.37
t=0 0
m=audio 11918 RTP/AVP 0 3 8 101
a=rtpmap:0 PCMU/8000
a=rtpmap:3 GSM/8000
a=rtpmap:8 PCMA/8000
a=rtpmap:101 telephone-event/8000
a=fmtp:101 0-16
a=silenceSupp:off - - - -
a=ptime:20
a=sendrecv
*May 25 10:50:30.957: //-1/558275C9A851/SIP/State/sipSPIChangeState: 0x4BA38CD8 : State change from (STATE_NONE, SUBSTATE_NONE) to (STATE_IDLE, SUBSTATE_NONE)
*May 25 10:50:30.965: //5013/558275C9A851/SIP/Event/Session-Timer/sipSTSLMain: Event: E_STSL_SESSION_REFRESH_REQ
*May 25 10:50:30.965: //5013/558275C9A851/SIP/Event/Session-Timer/sipSTSLMain: dir:2, method:102, resp_code:0, container:4BD449D4
*May 25 10:50:30.965: //5013/558275C9A851/SIP/Event/Session-Timer/sipSTSLPrintTDContainer: Peer-Event: E_STSL_LEG_BY_LEG, SE Value:0, SE Refresher:none, Min-SE Value:1800, flags:2001
SIP: (5013) Attribute mid, level 1 instance 1 not found.
*May 25 10:50:30.969: //5013/558275C9A851/SIP/State/sipSPIChangeStreamState: Stream (callid = -1) State changed from (STREAM_DEAD) to (STREAM_ADDING)
*May 25 10:50:30.969: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: OA:cur_container:ccsip_offer_ans_main_container, cur_state:S_SIP_EARLY_DIALOG_IDLE, event:E_SIP_INVITE_SDP_RCVD
*May 25 10:50:30.969: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IWF:cur_container:sip_iwf_default_early_dialog_container, cur_state:S_SIP_IWF_SDP_IDLE, event:E_SIP_IWF_EV_RCVD_SDP
*May 25 10:50:30.969: //5013/558275C9A851/SIP/Error/sipSPI_ipip_update_codec_params_in_channelInfo:
failed to update call entry
*May 25 10:50:30.969: //5013/558275C9A851/SIP/Error/sipSPI_ipip_update_codec_params_in_channelInfo:
failed to update call entry
*May 25 10:50:30.969: //5013/558275C9A851/SIP/Error/sipSPI_ipip_update_call_entry:
failed to update call entry
*May 25 10:50:30.969: //-1/xxxxxxxxxxxx/CCAPI/cc_set_post_tagdata:
CALL_ERROR; Avlist Set Is Failed
*May 25 10:50:30.969: //-1/xxxxxxxxxxxx/SIP/Error/sipSPI_ipip_set_channel_count: Unable to set CHANNEL_COUNT for callid 5013
*May 25 10:50:30.969: //5013/558275C9A851/SIP/Error/sip_iwf_sip_copy_sdp_to_channelInfo: Channel count is not set at this point. Not SIP-SIP or SET_MODE is not done.
*May 25 10:50:30.969: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IWF:next_state:S_SIP_IWF_SDP_RCVD_AWAIT_PEER_EVENT
*May 25 10:50:30.969: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: OA:next_state:S_SIP_EARLY_DIALOG_OFFER_RCVD
*May 25 10:50:30.973: //-1/558275C9A851/CCAPI/cc_api_display_ie_subfields:
cc_api_call_setup_ind_common:
cisco-username=0418656729
----- ccCallInfo IE subfields -----
cisco-ani=0418656729
cisco-anitype=0
cisco-aniplan=0
cisco-anipi=0
cisco-anisi=0
dest=0359159401
cisco-desttype=0
cisco-destplan=0
cisco-rdie=FFFFFFFF
cisco-rdn=
cisco-rdntype=0
cisco-rdnplan=0
cisco-rdnpi=-1
cisco-rdnsi=-1
cisco-redirectreason=-1 fwd_final_type =0
final_redirectNumber =
hunt_group_timeout =0
*May 25 10:50:30.973: //-1/558275C9A851/CCAPI/cc_api_call_setup_ind_common:
Interface=0x4AC0F6C0, Call Info(
Calling Number=0418656729,(Calling Name=)(TON=Unknown, NPI=Unknown, Screening=Not Screened, Presentation=Allowed),
Called Number=0359159401(TON=Unknown, NPI=Unknown),
Calling Translated=FALSE, Subscriber Type Str=Unknown, FinalDestinationFlag=TRUE,
Incoming Dial-peer=1, Progress Indication=NULL(0), Calling IE Present=TRUE,
Source Trkgrp Route Label=, Target Trkgrp Route Label=, CLID Transparent=FALSE), Call Id=5013
*May 25 10:50:30.973: //-1/558275C9A851/CCAPI/ccCheckClipClir:
In: Calling Number=0418656729(TON=Unknown, NPI=Unknown, Screening=Not Screened, Presentation=Allowed)
*May 25 10:50:30.973: //-1/558275C9A851/CCAPI/ccCheckClipClir:
Out: Calling Number=0418656729(TON=Unknown, NPI=Unknown, Screening=Not Screened, Presentation=Allowed)
*May 25 10:50:30.977: //-1/xxxxxxxxxxxx/CCAPI/cc_get_feature_vsa:
*May 25 10:50:30.977: :cc_get_feature_vsa malloc success
*May 25 10:50:30.977: //-1/xxxxxxxxxxxx/CCAPI/cc_get_feature_vsa:
*May 25 10:50:30.977: cc_get_feature_vsa count is 1
*May 25 10:50:30.977: //-1/xxxxxxxxxxxx/CCAPI/cc_get_feature_vsa:
*May 25 10:50:30.977: :FEATURE_VSA attributes are: feature_name:0,feature_time:1292235696,feature_id:2244
*May 25 10:50:30.977: //5013/558275C9A851/CCAPI/cc_api_call_setup_ind_common:
Set Up Event Sent;
Call Info(Calling Number=0418656729(TON=Unknown, NPI=Unknown, Screening=Not Screened, Presentation=Allowed),
Called Number=0359159401(TON=Unknown, NPI=Unknown))
*May 25 10:50:30.977: //5013/558275C9A851/SIP/Event/Session-Timer/sipSTSLMain: Event: E_STSL_SESSION_REFRESH_RESP
*May 25 10:50:30.977: //5013/558275C9A851/SIP/Event/Session-Timer/sipSTSLMain: dir:1, method:102, resp_code:100, container:4BD3EFC4
*May 25 10:50:30.977: //5013/558275C9A851/SIP/State/sipSPIChangeState: 0x4BA38CD8 : State change from (STATE_IDLE, SUBSTATE_NONE) to (STATE_RECD_INVITE, SUBSTATE_NONE)
*May 25 10:50:30.981: //5013/558275C9A851/CCAPI/cc_process_call_setup_ind:
Event=0x4B6EC1F0
*May 25 10:50:30.981: //-1/xxxxxxxxxxxx/CCAPI/cc_setupind_match_search:
Try with the demoted called number 0359159401
*May 25 10:50:30.981: //5013/558275C9A851/CCAPI/ccCallSetContext:
Context=0x4D389A24
*May 25 10:50:30.981: //5013/558275C9A851/CCAPI/cc_process_call_setup_ind:
>>>>CCAPI handed cid 5013 with tag 1 to app "_ManagedAppProcess_Default"
*May 25 10:50:30.981: //5013/558275C9A851/CCAPI/ccCallProceeding:
Progress Indication=NULL(0)
*May 25 10:50:30.981: //-1/xxxxxxxxxxxx/SIP/Event/sipSPIEventInfo: Queued event from SIP SPI : SIPSPI_EV_CC_CALL_PROCEEDING
*May 25 10:50:30.985: //-1/xxxxxxxxxxxx/CCAPI/cc_validate_mlpp_info:
Unsupported MLPP Service Domain Network 0
*May 25 10:50:30.985: //-1/xxxxxxxxxxxx/CCAPI/cc_set_mlpp_info:
Invalid MLPP Information
*May 25 10:50:30.985: //-1/xxxxxxxxxxxx/CCAPI/cc_validate_mlpp_info:
Unsupported MLPP Service Domain Network 0
*May 25 10:50:30.985: //-1/xxxxxxxxxxxx/CCAPI/cc_set_mlpp_info:
Invalid MLPP Information
*May 25 10:50:30.985: //-1/xxxxxxxxxxxx/CCAPI/cc_validate_mlpp_info:
Unsupported MLPP Service Domain Network 0
*May 25 10:50:30.985: //-1/xxxxxxxxxxxx/CCAPI/cc_set_mlpp_info:
Invalid MLPP Information
*May 25 10:50:30.989: //5013/558275C9A851/CCAPI/ccCallSetupRequest:
Destination=, Calling IE Present=TRUE, Mode=0,
Outgoing Dial-peer=2, Params=0x4D37DFB4, Progress Indication=NULL(0)
*May 25 10:50:30.989: //5013/558275C9A851/CCAPI/ccCheckClipClir:
In: Calling Number=0418656729(TON=Unknown, NPI=Unknown, Screening=Not Screened, Presentation=Allowed)
*May 25 10:50:30.989: //5013/558275C9A851/CCAPI/ccCheckClipClir:
Out: Calling Number=0418656729(TON=Unknown, NPI=Unknown, Screening=Not Screened, Presentation=Allowed)
*May 25 10:50:30.989: //5013/558275C9A851/CCAPI/ccCallSetupRequest:
Destination Pattern=035915940., Called Number=0359159401, Digit Strip=FALSE
*May 25 10:50:30.989: //5013/558275C9A851/CCAPI/ccCallSetupRequest:
Calling Number=0418656729(TON=Unknown, NPI=Unknown, Screening=Not Screened, Presentation=Allowed),
Called Number=0359159401(TON=Unknown, NPI=Unknown),
Redirect Number=, Display Info=61418656729
Account Number=0418656729, Final Destination Flag=TRUE,
Guid=558275C9-219D-11E6-A851-A914AEFF3C37, Outgoing Dial-peer=2
*May 25 10:50:30.989: //5013/558275C9A851/CCAPI/cc_api_display_ie_subfields:
ccCallSetupRequest:
cisco-username=0418656729
----- ccCallInfo IE subfields -----
cisco-ani=0418656729
cisco-anitype=0
cisco-aniplan=0
cisco-anipi=0
cisco-anisi=0
dest=0359159401
cisco-desttype=0
cisco-destplan=0
cisco-rdie=FFFFFFFF
cisco-rdn=
cisco-rdntype=0
cisco-rdnplan=0
cisco-rdnpi=-1
cisco-rdnsi=-1
cisco-redirectreason=-1 fwd_final_type =0
final_redirectNumber =
hunt_group_timeout =0
*May 25 10:50:30.989: //5013/558275C9A851/CCAPI/ccIFCallSetupRequestPrivate:
Interface=0x4AC0F6C0, Interface Type=3, Destination=, Mode=0x0,
Call Params(Calling Number=0418656729,(Calling Name=61418656729)(TON=Unknown, NPI=Unknown, Screening=Not Screened, Presentation=Allowed),
Called Number=0359159401(TON=Unknown, NPI=Unknown), Calling Translated=FALSE,
Subscriber Type Str=Unknown, FinalDestinationFlag=TRUE, Outgoing Dial-peer=2, Call Count On=FALSE,
Source Trkgrp Route Label=, Target Trkgrp Route Label=, tg_label_flag=0, Application Call Id=)
*May 25 10:50:30.989: //-1/xxxxxxxxxxxx/CCAPI/cc_get_feature_vsa:
*May 25 10:50:30.989: :cc_get_feature_vsa malloc success
*May 25 10:50:30.989: //-1/xxxxxxxxxxxx/CCAPI/cc_get_feature_vsa:
*May 25 10:50:30.989: cc_get_feature_vsa count is 2
*May 25 10:50:30.989: //-1/xxxxxxxxxxxx/CCAPI/cc_get_feature_vsa:
*May 25 10:50:30.989: :FEATURE_VSA attributes are: feature_name:0,feature_time:1292237040,feature_id:2245
*May 25 10:50:30.993: //5014/000000000000/SIP/State/sipSPIChangeState: 0x4BA76A80 : State change from (STATE_NONE, SUBSTATE_NONE) to (STATE_IDLE, SUBSTATE_NONE)
*May 25 10:50:30.993: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:cur_container:sip_iwf_default_early_dialog_container, cur_state:S_SIP_IWF_SDP_IDLE, event:E_SIP_IWF_EV_SET_MODE
*May 25 10:50:30.993: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:new_container:sip_iwf_main_container
*May 25 10:50:30.993: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:new_container:sip_iwf_sip_early_dialog_container
*May 25 10:50:30.993: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:next_state:CNFSM_NO_STATE_CHANGE
*May 25 10:50:30.993: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:cur_container:sip_iwf_sip_early_dialog_container, cur_state:S_SIP_IWF_SDP_IDLE, event:E_SIP_IWF_EV_SET_FLOW_MODE
*May 25 10:50:30.993: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:new_container:sip_iwf_main_container
*May 25 10:50:30.993: //-1/xxxxxxxxxxxx/SIP/Event/sipSPIEventInfo: Queued event from SIP SPI : SIPSPI_EV_CC_CALL_SETUP
*May 25 10:50:30.993: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IWF:cur_container:sip_iwf_default_early_dialog_container, cur_state:S_SIP_IWF_SDP_RCVD_AWAIT_PEER_EVENT, event:E_SIP_IWF_EV_SET_MODE
*May 25 10:50:30.993: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IWF:new_container:sip_iwf_main_container
*May 25 10:50:30.993: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IWF:new_container:sip_iwf_sip_early_dialog_container
*May 25 10:50:30.993: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IWF:next_state:CNFSM_NO_STATE_CHANGE
*May 25 10:50:30.993: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IWF:cur_container:sip_iwf_sip_early_dialog_container, cur_state:S_SIP_IWF_SDP_RCVD_AWAIT_PEER_EVENT, event:E_SIP_IWF_EV_SET_FLOW_MODE
*May 25 10:50:30.993: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IWF:new_container:sip_iwf_main_container
*May 25 10:50:30.993: //5014/558275C9A851/CCAPI/ccIFCallSetupRequestPrivate:
SPI Call Setup Request Is Success; Interface Type=3, FlowMode=1
*May 25 10:50:30.993: //5014/558275C9A851/CCAPI/ccCallSetContext:
Context=0x4D37DF64
*May 25 10:50:30.993: //5013/558275C9A851/CCAPI/ccSaveDialpeerTag:
Outgoing Dial-peer=2
*May 25 10:50:30.997: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:cur_container:sip_iwf_sip_early_dialog_container, cur_state:S_SIP_IWF_SDP_IDLE, event:E_SIP_IWF_EV_INIT_CALL_SETUP
*May 25 10:50:30.997: //5014/000000000000/SIP/Error/sip_iwf_sip_copy_channelInfo_to_sdp: We are either escalating, orno stream found for this m-line index:1
*May 25 10:50:30.997: //5014/000000000000/SIP/Error/sip_iwf_sip_copy_channelInfo_to_sdp: We are either escalating, orno stream found for this m-line index:1
*May 25 10:50:30.997: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IPIPMS:cur_container:ccsip_ipip_media_service_main_container, cur_state:S_IPIP_MEDIA_SERV_STATE_IDLE, event:E_IPIP_MEDIA_SERV_EV_PEER_CHNL_IND
*May 25 10:50:30.997: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IPIPMS:next_state:S_IPIP_MEDIA_SERV_STATE_INIT_XCODER_RESERVED
*May 25 10:50:30.997: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IPIPMS:next_state:S_IPIP_MEDIA_SERV_STATE_IDLE
*May 25 10:50:30.997: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:next_state:CNFSM_NO_STATE_CHANGE
*May 25 10:50:31.001: //5014/558275C9A851/CCAPI/cc_api_call_proceeding:
Interface=0x4AC0F6C0, Progress Indication=NULL(0)
*May 25 10:50:31.001: //5014/000000000000/SIP/Event/Session-Timer/sipSTSLMain: Event: E_STSL_SESSION_REFRESH_REQ
*May 25 10:50:31.001: //5014/000000000000/SIP/Event/Session-Timer/sipSTSLMain: dir:1, method:102, resp_code:0, container:4BD3C7E4
*May 25 10:50:31.001: //5014/000000000000/SIP/Event/Session-Timer/sipSTSLPrintTDContainer: Peer-Event: E_STSL_LEG_BY_LEG, SE Value:0, SE Refresher:none, Min-SE Value:1800, flags:2001
*May 25 10:50:31.001: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: OA:cur_container:ccsip_offer_ans_main_container, cur_state:S_SIP_EARLY_DIALOG_IDLE, event:E_SIP_INVITE_SDP_SENT
*May 25 10:50:31.001: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:cur_container:sip_iwf_sip_early_dialog_container, cur_state:S_SIP_IWF_SDP_IDLE, event:E_SIP_IWF_EV_SENT_SDP
*May 25 10:50:31.005: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:next_state:S_SIP_IWF_SDP_SENT_AWAIT_SDP
*May 25 10:50:31.005: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: OA:next_state:S_SIP_EARLY_DIALOG_OFFER_SENT
*May 25 10:50:31.005: //5014/000000000000/SIP/Event/sipSPICreateRpid: Received Octet3A=0x80 -> Setting ;screen=no ;privacy=off
SIP: (5014) Group (a= group line) attribute, level 65535 instance 1 not found.
*May 25 10:50:31.005: //5014/000000000000/SIP/State/sipSPIChangeState: 0x4BA76A80 : State change from (STATE_IDLE, SUBSTATE_NONE) to (STATE_SENT_INVITE, SUBSTATE_NONE)
*May 25 10:50:31.005: //5014/000000000000/SIP/State/sipSPIChangeStreamState: Stream (callid = 5014) State changed from (STREAM_ADDING) to (STREAM_ACTIVE)
*May 25 10:50:31.009: //5013/558275C9A851/SIP/Msg/ccsipDisplayMsg:
Sent:
SIP/2.0 100 Trying
Via: SIP/2.0/UDP 103.193.166.11:5060;branch=z9hG4bKe43e.1bfaf007.0,SIP/2.0/UDP 103.193.166.37:5060;received=103.193.166.37;branch=z9hG4bK33433ef2;rport=5060
From: "61418656729" <sip:0418656729@103.193.166.37>;tag=as75513f08
To: <sip:0359159401@103.193.166.11>
Date: Wed, 25 May 2016 10:50:30 GMT
Call-ID: 14d4c315453e08912a0a7b9a04cd0024@103.193.166.37:5060
CSeq: 102 INVITE
Allow-Events: telephone-event
Server: Cisco-SIPGateway/IOS-12.x
Content-Length: 0
*May 25 10:50:31.009: //5014/000000000000/SIP/Msg/ccsipDisplayMsg:
Sent:
INVITE sip:0359159401@192.168.0.9:5060 SIP/2.0
Via: SIP/2.0/UDP 192.168.0.41:5060;branch=z9hG4bK6CC125A
Remote-Party-ID: "61418656729" <sip:0418656729@192.168.0.41>;party=calling;screen=no;privacy=off
From: "61418656729" <sip:0418656729@sip.telecube.com.au>;tag=91DEBCC-185D
To: <sip:0359159401@192.168.0.9>
Date: Wed, 25 May 2016 10:50:31 GMT
Call-ID: 55892E1F-219D11E6-A857A914-AEFF3C37@192.168.0.41
Supported: 100rel,timer,resource-priority,replaces,sdp-anat
Min-SE: 1800
Cisco-Guid: 1434613193-0563941862-2823923988-2935962679
User-Agent: Cisco-SIPGateway/IOS-12.x
Allow: INVITE, OPTIONS, BYE, CANCEL, ACK, PRACK, UPDATE, REFER, SUBSCRIBE, NOTIFY, INFO, REGISTER
CSeq: 101 INVITE
Timestamp: 1464173431
Contact: <sip:0418656729@192.168.0.41:5060>
Expires: 300
Allow-Events: telephone-event
Max-Forwards: 68
Content-Type: application/sdp
Content-Disposition: session;handling=required
Content-Length: 259
v=0
o=CiscoSystemsSIP-GW-UserAgent 8942 7872 IN IP4 192.168.0.41
s=SIP Call
c=IN IP4 192.168.0.41
t=0 0
m=audio 18736 RTP/AVP 0 8 101
c=IN IP4 192.168.0.41
a=rtpmap:0 PCMU/8000
a=rtpmap:8 PCMA/8000
a=rtpmap:101 telephone-event/8000
a=fmtp:101 0-16
*May 25 10:50:31.017: //5014/000000000000/SIP/Msg/ccsipDisplayMsg:
Received:
SIP/2.0 100 Trying
Via: SIP/2.0/UDP 192.168.0.41:5060;branch=z9hG4bK6CC125A
From: "61418656729" <sip:0418656729@sip.telecube.com.au>;tag=91DEBCC-185D
To: <sip:0359159401@192.168.0.9>
Date: Wed, 25 May 2016 10:29:19 GMT
Call-ID: 55892E1F-219D11E6-A857A914-AEFF3C37@192.168.0.41
CSeq: 101 INVITE
Allow-Events: presence
Content-Length: 0
*May 25 10:50:31.017: //5014/000000000000/SIP/State/sipSPIChangeState: 0x4BA76A80 : State change from (STATE_SENT_INVITE, SUBSTATE_NONE) to (STATE_RECD_PROCEEDING, SUBSTATE_PROCEEDING_PROCEEDING)
*May 25 10:50:31.021: //5014/000000000000/SIP/Msg/ccsipDisplayMsg:
Received:
SIP/2.0 180 Ringing
Via: SIP/2.0/UDP 192.168.0.41:5060;branch=z9hG4bK6CC125A
From: "61418656729" <sip:0418656729@sip.telecube.com.au>;tag=91DEBCC-185D
To: <sip:0359159401@192.168.0.9>;tag=5104~12d5d499-38ad-47af-a90a-d75e386b62e1-33197460
Date: Wed, 25 May 2016 10:29:19 GMT
Call-ID: 55892E1F-219D11E6-A857A914-AEFF3C37@192.168.0.41
CSeq: 101 INVITE
Allow: INVITE, OPTIONS, INFO, BYE, CANCEL, ACK, PRACK, UPDATE, REFER, SUBSCRIBE, NOTIFY
Allow-Events: presence
Server: Cisco-CUCM11.0
Supported: X-cisco-srtp-fallback
Supported: Geolocation
Session-ID: 1638c7ae5bec5b028a6170ba33197461;remote=48d77df2be0b6171b34f8a3e7bab5104
P-Asserted-Identity: "denys - 0359159401" <sip:0359159401@192.168.0.9>
Remote-Party-ID: "denys - 0359159401" <sip:0359159401@192.168.0.9>;party=called;screen=yes;privacy=off
Contact: <sip:0359159401@192.168.0.9:5060>
Content-Length: 0
*May 25 10:50:31.021: //5014/000000000000/SIP/Error/ccsip_alert_parent_or_child: Unable to add unsupported
hdrs to container
*May 25 10:50:31.021: //5014/558275C9A851/CCAPI/cc_api_call_alert:
Interface=0x4AC0F6C0, Progress Indication=NULL(0), Signal Indication=SIGNAL RINGBACK(1)
*May 25 10:50:31.025: //5014/558275C9A851/CCAPI/cc_api_call_alert:
Call Entry(Retry Count=0, Responsed=TRUE)
*May 25 10:50:31.025: //5014/000000000000/SIP/State/sipSPIChangeState: 0x4BA76A80 : State change from (STATE_RECD_PROCEEDING, SUBSTATE_PROCEEDING_PROCEEDING) to (STATE_RECD_PROCEEDING, SUBSTATE_PROCEEDING_PROCEEDING)
*May 25 10:50:31.025: //5013/558275C9A851/CCAPI/ccCallAlert:
Progress Indication=NULL(0), Signal Indication=SIGNAL RINGBACK(1)
*May 25 10:50:31.025: //5013/558275C9A851/CCAPI/ccCallAlert:
Call Entry(Responsed=TRUE, Alert Sent=TRUE)
*May 25 10:50:31.025: //-1/xxxxxxxxxxxx/SIP/Event/sipSPIEventInfo: Queued event from SIP SPI : SIPSPI_EV_CC_CALL_ALERTING
*May 25 10:50:31.025: //5013/558275C9A851/SIP/Event/Session-Timer/sipSTSLMain: Event: E_STSL_SESSION_REFRESH_RESP
*May 25 10:50:31.025: //5013/558275C9A851/SIP/Event/Session-Timer/sipSTSLMain: dir:1, method:102, resp_code:180, container:4BD3D654
*May 25 10:50:31.029: //5013/558275C9A851/SIP/Event/sipSPICreateRpid: Received Octet3A=0x81 -> Setting ;screen=yes ;privacy=off
*May 25 10:50:31.029: //5013/558275C9A851/SIP/State/sipSPIChangeState: 0x4BA38CD8 : State change from (STATE_RECD_INVITE, SUBSTATE_NONE) to (STATE_SENT_ALERTING, SUBSTATE_NONE)
*May 25 10:50:31.029: //5013/558275C9A851/SIP/Msg/ccsipDisplayMsg:
Sent:
SIP/2.0 180 Ringing
Via: SIP/2.0/UDP 103.193.166.11:5060;branch=z9hG4bKe43e.1bfaf007.0,SIP/2.0/UDP 103.193.166.37:5060;received=103.193.166.37;branch=z9hG4bK33433ef2;rport=5060
From: "61418656729" <sip:0418656729@103.193.166.37>;tag=as75513f08
To: <sip:0359159401@103.193.166.11>;tag=91DEBE0-478
Date: Wed, 25 May 2016 10:50:30 GMT
Call-ID: 14d4c315453e08912a0a7b9a04cd0024@103.193.166.37:5060
CSeq: 102 INVITE
Allow: INVITE, OPTIONS, BYE, CANCEL, ACK, PRACK, UPDATE, REFER, SUBSCRIBE, NOTIFY, INFO, REGISTER
Allow-Events: telephone-event
Remote-Party-ID: "denys - 0359159401" <sip:0359159401@192.168.0.41>;party=called;screen=yes;privacy=off
Contact: <sip:0359159401@192.168.0.41:5060>
Record-Route: <sip:103.193.166.11;lr;did=e74.b69b5224>
Server: Cisco-SIPGateway/IOS-12.x
Content-Length: 0
*May 25 10:50:33.189: //5014/000000000000/SIP/Msg/ccsipDisplayMsg:
Received:
SIP/2.0 200 OK
Via: SIP/2.0/UDP 192.168.0.41:5060;branch=z9hG4bK6CC125A
From: "61418656729" <sip:0418656729@sip.telecube.com.au>;tag=91DEBCC-185D
To: <sip:0359159401@192.168.0.9>;tag=5104~12d5d499-38ad-47af-a90a-d75e386b62e1-33197460
Date: Wed, 25 May 2016 10:29:19 GMT
Call-ID: 55892E1F-219D11E6-A857A914-AEFF3C37@192.168.0.41
CSeq: 101 INVITE
Allow: INVITE, OPTIONS, INFO, BYE, CANCEL, ACK, PRACK, UPDATE, REFER, SUBSCRIBE, NOTIFY
Allow-Events: presence
Supported: replaces
Server: Cisco-CUCM11.0
Supported: X-cisco-srtp-fallback
Supported: Geolocation
Session-Expires: 1800;refresher=uas
Require: timer
Session-ID: 1638c7ae5bec5b028a6170ba33197461;remote=48d77df2be0b6171b34f8a3e7bab5104
P-Asserted-Identity: "denys - 0359159401" <sip:0359159401@192.168.0.9>
Remote-Party-ID: "denys - 0359159401" <sip:0359159401@192.168.0.9>;party=called;screen=yes;privacy=off
Contact: <sip:0359159401@192.168.0.9:5060>
Content-Type: application/sdp
Content-Length: 243
v=0
o=CiscoSystemsCCM-SIP 5104 1 IN IP4 192.168.0.9
s=SIP Call
c=IN IP4 192.168.0.15
b=TIAS:64000
b=CT:64
b=AS:64
t=0 0
m=audio 24724 RTP/AVP 0 101
a=ptime:20
a=rtpmap:0 PCMU/8000
a=rtpmap:101 telephone-event/8000
a=fmtp:101 0-15
*May 25 10:50:33.193: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:cur_container:sip_iwf_sip_early_dialog_container, cur_state:S_SIP_IWF_SDP_SENT_AWAIT_SDP, event:E_SIP_IWF_EV_CALL_BRIDGE
*May 25 10:50:33.193: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:new_container:sip_iwf_main_container
*May 25 10:50:33.193: //5014/000000000000/SIP/Event/Session-Timer/sipSTSLMain: Event: E_STSL_SESSION_REFRESH_RESP
*May 25 10:50:33.193: //5014/000000000000/SIP/Event/Session-Timer/sipSTSLMain: dir:2, method:102, resp_code:200, container:4BD41EDC
*May 25 10:50:33.193: //5014/000000000000/SIP/Event/Session-Timer/sipSTSLPrintTDContainer: Peer-Event: E_STSL_PASS_ST_PARAMS, SE Value:1800, SE Refresher:uas, Min-SE Value:1800, flags:121
SIP: Attribute mid, level 1 instance 1 not found.
*May 25 10:50:33.197: //5014/000000000000/SIP/State/sipSPIChangeStreamState: Stream (callid = -1) State changed from (STREAM_DEAD) to (STREAM_ADDING)
*May 25 10:50:33.197: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: OA:cur_container:ccsip_offer_ans_main_container, cur_state:S_SIP_EARLY_DIALOG_OFFER_SENT, event:E_SIP_INVITE_RESP_SDP_RCVD
*May 25 10:50:33.197: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:cur_container:sip_iwf_sip_early_dialog_container, cur_state:S_SIP_IWF_SDP_SENT_AWAIT_SDP, event:E_SIP_IWF_EV_RCVD_SDP
*May 25 10:50:33.197: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IPIPMS:cur_container:ccsip_ipip_media_service_main_container, cur_state:S_IPIP_MEDIA_SERV_STATE_IDLE, event:E_IPIP_MEDIA_SERV_EV_ANS_RCVD
*May 25 10:50:33.197: //5014/558275C9A851/CCAPI/cc_set_post_tagdata:
CALL_ERROR; Avlist Removal Is Failed
*May 25 10:50:33.197: //5014/558275C9A851/CCAPI/cc_api_caps_ind:
Destination Interface=0x0, Destination Call Id=-1, Source Call Id=5014,
Caps(Codec=0x1, Fax Rate=0x2, Vad=0x2,
Modem=0x0, Codec Bytes=20, Signal Type=2)
*May 25 10:50:33.201: //5014/558275C9A851/CCAPI/cc_api_caps_ind:
Caps(Playout Mode=1, Playout Initial=60(ms), Playout Min=40(ms),
Playout Max=1000(ms), Fax Nom=300(ms))
*May 25 10:50:33.201: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IWF:cur_container:sip_iwf_sip_early_dialog_container, cur_state:S_SIP_IWF_SDP_RCVD_AWAIT_PEER_EVENT, event:E_SIP_IWF_EV_PEER_CAPS
*May 25 10:50:33.201: //5013/558275C9A851/CCAPI/cc_api_caps_ack:
Destination Interface=0x0, Destination Call Id=5014, Source Call Id=5013,
Caps(Codec=g711ulaw(0x1), Fax Rate=FAX_RATE_VOICE(0x2), Vad=OFF(0x1),
Modem=OFF(0x0), Codec Bytes=160, Signal Type=2, Seq Num Start=1)
*May 25 10:50:33.201: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IPIPMS:cur_container:ccsip_ipip_media_service_main_container, cur_state:S_IPIP_MEDIA_SERV_STATE_IDLE, event:E_IPIP_MEDIA_SERV_EV_PEER_CAPS_IND
*May 25 10:50:33.201: //5013/558275C9A851/CCAPI/cc_api_caps_ack:
Destination Interface=0x0, Destination Call Id=5014, Source Call Id=5013,
Caps(Codec=g711ulaw(0x1), Fax Rate=FAX_RATE_VOICE(0x2), Vad=OFF(0x1),
Modem=OFF(0x0), Codec Bytes=160, Signal Type=2, Seq Num Start=1)
*May 25 10:50:33.201: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IWF:next_state:CNFSM_NO_STATE_CHANGE
*May 25 10:50:33.201: //5014/558275C9A851/CCAPI/cc_api_event_indication:
Event=171, Call Id=5014
*May 25 10:50:33.201: //5014/558275C9A851/CCAPI/cc_api_event_indication:
Event Is Sent To Conferenced SPI(s) Directly
*May 25 10:50:33.201: //-1/xxxxxxxxxxxx/SIP/Event/sipSPIEventInfo: Queued event from SIP SPI : SIPSPI_EV_IWF
*May 25 10:50:33.201: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:next_state:S_SIP_IWF_SDP_DONE
*May 25 10:50:33.201: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: OA:next_state:S_SIP_EARLY_DIALOG_OFFER_ANSWER_COMPLETE
*May 25 10:50:33.201: //5014/000000000000/SIP/State/sipSPIChangeState: 0x4BA76A80 : State change from (STATE_RECD_PROCEEDING, SUBSTATE_PROCEEDING_PROCEEDING) to (STATE_RECD_PROCEEDING, SUBSTATE_NONE)
*May 25 10:50:33.201: //5014/558275C9A851/CCAPI/cc_api_call_connected:
Interface=0x4AC0F6C0, Data Bitmask=0x81000001, Progress Indication=NULL(0),
Connection Handle=0
*May 25 10:50:33.205: //5014/558275C9A851/CCAPI/cc_api_call_connected:
Call Entry(Connected=TRUE, Responsed=TRUE, Retry Count=0)
*May 25 10:50:33.205: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: OA:cur_container:ccsip_offer_ans_main_container, cur_state:S_SIP_EARLY_DIALOG_OFFER_ANSWER_COMPLETE, event:E_SIP_DIALOG_ESTD
*May 25 10:50:33.205: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:cur_container:sip_iwf_sip_early_dialog_container, cur_state:S_SIP_IWF_SDP_DONE, event:E_SIP_IWF_EV_CALL_ACTIVE
*May 25 10:50:33.205: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:new_container:sip_iwf_main_container
*May 25 10:50:33.205: //-1/xxxxxxxxxxxx/SIP/Event/sipSPIEventInfo: Queued event from SIP SPI : SIPSPI_EV_GEN_SERVICE
*May 25 10:50:33.205: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:new_container:sip_iwf_sip_mid_dialog_container
*May 25 10:50:33.205: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:next_state:CNFSM_NO_STATE_CHANGE
*May 25 10:50:33.205: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: OA:next_state:S_SIP_MID_DIALOG_IDLE
*May 25 10:50:33.205: //5014/000000000000/SIP/State/sipSPIChangeState: 0x4BA76A80 : State change from (STATE_RECD_PROCEEDING, SUBSTATE_NONE) to (STATE_ACTIVE, SUBSTATE_NONE)
*May 25 10:50:33.205: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IPIPMS:cur_container:ccsip_ipip_media_service_main_container, cur_state:S_IPIP_MEDIA_SERV_STATE_IDLE, event:E_IPIP_MEDIA_SERV_EV_TRIGGER_LOCAL_FA_MEDIA
*May 25 10:50:33.205: //5014/000000000000/SIP/Call/sipSPICallInfo:
The Call Setup Information is:
Call Control Block (CCB) : 0x4BA76A80
State of The Call : STATE_ACTIVE
TCP Sockets Used : NO
Calling Number : 0418656729
Called Number : 0359159401
Source IP Address (Sig ): 192.168.0.41
Destn SIP Req Addr:Port : 192.168.0.9:5060
Destn SIP Resp Addr:Port : 192.168.0.9:5060
Destination Name : 192.168.0.9
*May 25 10:50:33.209: //5014/000000000000/SIP/Call/sipSPIMediaCallInfo:
Number of Media Streams: 1
Media Stream : 1
Negotiated Codec : g711ulaw
Negotiated Codec Bytes : 160
Nego. Codec payload : 0 (tx), 0 (rx)
Negotiated Dtmf-relay : 6
Dtmf-relay Payload : 101 (tx), 101 (rx)
Source IP Address (Media): 192.168.0.41
Source IP Port (Media): 18736
Destn IP Address (Media): 192.168.0.15
Destn IP Port (Media): 24724
Orig Destn IP Address:Port (Media): [ - ]:0
*May 25 10:50:33.209: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:cur_container:sip_iwf_sip_mid_dialog_container, cur_state:S_SIP_IWF_SDP_DONE, event:E_SIP_IWF_EV_UPDATE_STREAM_CONTEXT
*May 25 10:50:33.209: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:next_state:CNFSM_NO_STATE_CHANGE
*May 25 10:50:33.209: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:cur_container:sip_iwf_sip_mid_dialog_container, cur_state:S_SIP_IWF_SDP_DONE, event:E_SIP_IWF_EV_PEER_CAPS_ACK,
*May 25 10:50:33.209: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:next_state:CNFSM_NO_STATE_CHANGE
*May 25 10:50:33.209: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:cur_container:sip_iwf_sip_mid_dialog_container, cur_state:S_SIP_IWF_SDP_DONE, event:E_SIP_IWF_EV_PEER_CAPS_ACK,
*May 25 10:50:33.209: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:next_state:CNFSM_NO_STATE_CHANGE
*May 25 10:50:33.209: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IWF:cur_container:sip_iwf_sip_early_dialog_container, cur_state:S_SIP_IWF_SDP_RCVD_AWAIT_PEER_EVENT, event:E_SIP_IWF_EV_PEER_CHANNEL_ACK
*May 25 10:50:33.209: //5013/558275C9A851/SIP/Error/sipSPIUpdateRtpSession: voip_rtp_update_callinfo returns FALSE
*May 25 10:50:33.209: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IPIPMS:cur_container:ccsip_ipip_media_service_main_container, cur_state:S_IPIP_MEDIA_SERV_STATE_IDLE, event:E_IPIP_MEDIA_SERV_EV_PEER_CHNL_ACK
*May 25 10:50:33.209: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IPIPMS:next_state:CNFSM_NO_STATE_CHANGE
*May 25 10:50:33.209: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IWF:next_state:CNFSM_NO_STATE_CHANGE
*May 25 10:50:33.213: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IPIPMS:cur_container:ccsip_ipip_media_service_main_container, cur_state:S_IPIP_MEDIA_SERV_STATE_IDLE, event:E_IPIP_MEDIA_SERV_EV_CALL_ACTIVE
*May 25 10:50:33.213: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IPIPMS:next_state:CNFSM_NO_STATE_CHANGE
*May 25 10:50:33.213: //5013/558275C9A851/CCAPI/ccConferenceCreate:
(confID=0x4C01987C, callID1=0x1395, gcid=5583AE19-219D11E6-A854A914-AEFF3C37, tag=0x0)
*May 25 10:50:33.213: //5014/558275C9A851/CCAPI/ccConferenceCreate:
(confID=0x4C01987C, callID2=0x1396, gcid=5583AE19-219D11E6-A854A914-AEFF3C37, tag=0x0)
*May 25 10:50:33.213: //5013/558275C9A851/CCAPI/ccConferenceCreate:
Conference Id=0x4C01987C, Call Id1=5013, Call Id2=5014, Tag=0x0
*May 25 10:50:33.213: //5013/xxxxxxxxxxxx/CCAPI/cc_api_get_xcode_stream:
*May 25 10:50:33.213: cc_api_get_xcode_stream : 4702
*May 25 10:50:33.213: //5014/xxxxxxxxxxxx/CCAPI/cc_api_get_xcode_stream:
*May 25 10:50:33.213: cc_api_get_xcode_stream : 4702
*May 25 10:50:33.213: //5013/558275C9A851/CCAPI/ccConferenceCreate:
*May 25 10:50:33.213: ccConferenceCreate: ret1=0, codecMask1=1, bytes1=160, negot1=1, dtmf1=6
ret2=0, codecMask2=1, bytes2=160, negot2=1, dtmf2=6,
tx_dynamic_pt1=0, rx_dynamic_pt1=0, codec_mode1=0, params_bitmap1 =0
tx_dynamic_pt2=0, rx_dynamic_pt2=0, codec_mode2=0, params_bitmap2 =0
*May 25 10:50:33.213: //5013/558275C9A851/CCAPI/ccConferenceCreate:
delay media to slow start case, codec negotation is not done
*May 25 10:50:33.213: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IWF:cur_container:sip_iwf_sip_early_dialog_container, cur_state:S_SIP_IWF_SDP_RCVD_AWAIT_PEER_EVENT, event:E_SIP_IWF_EV_SET_MODE
*May 25 10:50:33.217: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IWF:new_container:sip_iwf_main_container
*May 25 10:50:33.217: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IWF:new_container:sip_iwf_sip_early_dialog_container
*May 25 10:50:33.217: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IWF:next_state:CNFSM_NO_STATE_CHANGE
*May 25 10:50:33.217: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IWF:cur_container:sip_iwf_sip_early_dialog_container, cur_state:S_SIP_IWF_SDP_RCVD_AWAIT_PEER_EVENT, event:E_SIP_IWF_EV_CALL_BRIDGE
*May 25 10:50:33.217: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IWF:new_container:sip_iwf_main_container
*May 25 10:50:33.217: //5013/xxxxxxxxxxxx/CCAPI/cc_api_get_xcode_stream:
*May 25 10:50:33.217: cc_api_get_xcode_stream : 4702
*May 25 10:50:33.217: //5013/xxxxxxxxxxxx/CCAPI/cc_api_get_xcode_stream:
*May 25 10:50:33.217: cc_api_get_xcode_stream : 4702
*May 25 10:50:33.217: //5013/558275C9A851/SIP/State/sipSPIChangeStreamState: Stream (callid = 5013) State changed from (STREAM_ADDING) to (STREAM_ACTIVE)
*May 25 10:50:33.217: //5013/558275C9A851/CCAPI/cc_api_bridge_done:
Conference Id=0x407, Source Interface=0x4AC0F6C0, Source Call Id=5013,
Destination Call Id=5014, Disposition=0x0, Tag=0x0
*May 25 10:50:33.217: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:cur_container:sip_iwf_sip_mid_dialog_container, cur_state:S_SIP_IWF_SDP_DONE, event:E_SIP_IWF_EV_SET_MODE
*May 25 10:50:33.217: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:new_container:sip_iwf_main_container
*May 25 10:50:33.217: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:new_container:sip_iwf_sip_mid_dialog_container
*May 25 10:50:33.217: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:next_state:CNFSM_NO_STATE_CHANGE
*May 25 10:50:33.217: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:cur_container:sip_iwf_sip_mid_dialog_container, cur_state:S_SIP_IWF_SDP_DONE, event:E_SIP_IWF_EV_CALL_BRIDGE
*May 25 10:50:33.217: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IWF:new_container:sip_iwf_main_container
*May 25 10:50:33.221: //5014/xxxxxxxxxxxx/CCAPI/cc_api_get_xcode_stream:
*May 25 10:50:33.221: cc_api_get_xcode_stream : 4702
*May 25 10:50:33.221: //5014/xxxxxxxxxxxx/CCAPI/cc_api_get_xcode_stream:
*May 25 10:50:33.221: cc_api_get_xcode_stream : 4702
*May 25 10:50:33.221: //5014/000000000000/SIP/State/sipSPIChangeStreamState: Stream (callid = 5014) State changed from (STREAM_ADDING) to (STREAM_ACTIVE)
*May 25 10:50:33.221: //5014/558275C9A851/CCAPI/cc_api_bridge_done:
Conference Id=0x407, Source Interface=0x4AC0F6C0, Source Call Id=5014,
Destination Call Id=5013, Disposition=0x0, Tag=0x0
*May 25 10:50:33.221: //5013/558275C9A851/CCAPI/cc_generic_bridge_done:
Conference Id=0x407, Source Interface=0x4AC0F6C0, Source Call Id=5014,
Destination Call Id=5013, Disposition=0x0, Tag=0x0
*May 25 10:50:33.221: //-1/xxxxxxxxxxxx/CCAPI/cc_exchange_calls_mlpp_info:
Unable too Get MLPP nformation for callID 5013
*May 25 10:50:33.221: //5013/558275C9A851/CCAPI/ccConferenceCreate:
Call Entry(Conference Id=0x407, Destination Call Id=5014)
*May 25 10:50:33.221: //5014/558275C9A851/CCAPI/ccConferenceCreate:
Call Entry(Conference Id=0x407, Destination Call Id=5013)
*May 25 10:50:33.221: //5013/558275C9A851/CCAPI/cc_process_notify_bridge_done:
Conference Id=0x407, Call Id1=5013, Call Id2=5014
*May 25 10:50:33.225: //5014/000000000000/SIP/Msg/ccsipDisplayMsg:
Sent:
ACK sip:0359159401@192.168.0.9:5060 SIP/2.0
Via: SIP/2.0/UDP 192.168.0.41:5060;branch=z9hG4bK6CD45B
From: "61418656729" <sip:0418656729@sip.telecube.com.au>;tag=91DEBCC-185D
To: <sip:0359159401@192.168.0.9>;tag=5104~12d5d499-38ad-47af-a90a-d75e386b62e1-33197460
Date: Wed, 25 May 2016 10:50:31 GMT
Call-ID: 55892E1F-219D11E6-A857A914-AEFF3C37@192.168.0.41
Max-Forwards: 70
CSeq: 101 ACK
Allow-Events: telephone-event
Content-Length: 0
*May 25 10:50:33.225: //5013/558275C9A851/CCAPI/ccCallConnect:
Progress Indication=NULL(0), Data Bitmask=0x81000001
*May 25 10:50:33.225: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IWF:cur_container:sip_iwf_sip_early_dialog_container, cur_state:S_SIP_IWF_SDP_RCVD_AWAIT_PEER_EVENT, event:E_SIP_IWF_EV_CALL_CONNECT
*May 25 10:50:33.225: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IWF:new_container:sip_iwf_main_container
*May 25 10:50:33.225: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IWF:next_state:CNFSM_NO_STATE_CHANGE
*May 25 10:50:33.225: //-1/xxxxxxxxxxxx/SIP/Event/sipSPIEventInfo: Queued event from SIP SPI : SIPSPI_EV_CC_CALL_CONNECT
*May 25 10:50:33.225: //5013/558275C9A851/CCAPI/ccCallConnect:
Call Entry(Connected=TRUE, Responsed=TRUE)
*May 25 10:50:33.229: //5013/558275C9A851/SIP/Event/Session-Timer/sipSTSLMain: Event: E_STSL_SESSION_REFRESH_RESP
*May 25 10:50:33.229: //5013/558275C9A851/SIP/Event/Session-Timer/sipSTSLMain: dir:1, method:102, resp_code:200, container:4BD38534
*May 25 10:50:33.233: //5013/558275C9A851/SIP/Event/Session-Timer/sipSTSLPrintTDContainer: Peer-Event: E_STSL_PASS_ST_PARAMS, SE Value:1800, SE Refresher:uas, Min-SE Value:1800, flags:121
*May 25 10:50:33.233: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: OA:cur_container:ccsip_offer_ans_main_container, cur_state:S_SIP_EARLY_DIALOG_OFFER_RCVD, event:E_SIP_INVITE_RESP_SDP_SENT
*May 25 10:50:33.233: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IWF:cur_container:sip_iwf_sip_early_dialog_container, cur_state:S_SIP_IWF_SDP_RCVD_AWAIT_PEER_EVENT, event:E_SIP_IWF_EV_SENT_SDP
*May 25 10:50:33.233: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IWF:next_state:S_SIP_IWF_SDP_DONE
*May 25 10:50:33.233: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: OA:next_state:S_SIP_EARLY_DIALOG_OFFER_ANSWER_COMPLETE
*May 25 10:50:33.233: //5013/558275C9A851/SIP/Event/sipSPICreateRpid: Received Octet3A=0x81 -> Setting ;screen=yes ;privacy=off
SIP: (5013) Group (a= group line) attribute, level 65535 instance 1 not found.
*May 25 10:50:33.237: //5013/558275C9A851/SIP/State/sipSPIChangeState: 0x4BA38CD8 : State change from (STATE_SENT_ALERTING, SUBSTATE_NONE) to (STATE_SENT_SUCCESS, SUBSTATE_NONE)
*May 25 10:50:33.237: //5013/558275C9A851/SIP/Msg/ccsipDisplayMsg:
Sent:
SIP/2.0 200 OK
Via: SIP/2.0/UDP 103.193.166.11:5060;branch=z9hG4bKe43e.1bfaf007.0,SIP/2.0/UDP 103.193.166.37:5060;received=103.193.166.37;branch=z9hG4bK33433ef2;rport=5060
From: "61418656729" <sip:0418656729@103.193.166.37>;tag=as75513f08
To: <sip:0359159401@103.193.166.11>;tag=91DEBE0-478
Date: Wed, 25 May 2016 10:50:30 GMT
Call-ID: 14d4c315453e08912a0a7b9a04cd0024@103.193.166.37:5060
CSeq: 102 INVITE
Allow: INVITE, OPTIONS, BYE, CANCEL, ACK, PRACK, UPDATE, REFER, SUBSCRIBE, NOTIFY, INFO, REGISTER
Allow-Events: telephone-event
Remote-Party-ID: "denys - 0359159401" <sip:0359159401@192.168.0.41>;party=called;screen=yes;privacy=off
Contact: <sip:0359159401@192.168.0.41:5060>
Record-Route: <sip:103.193.166.11;lr;did=e74.b69b5224>
Supported: replaces
Supported: sdp-anat
Server: Cisco-SIPGateway/IOS-12.x
Session-Expires: 1800;refresher=uas
Require: timer
Supported: timer
Content-Type: application/sdp
Content-Disposition: session;handling=required
Content-Length: 246
v=0
o=CiscoSystemsSIP-GW-UserAgent 807 5526 IN IP4 192.168.0.41
s=SIP Call
c=IN IP4 192.168.0.41
t=0 0
m=audio 16778 RTP/AVP 0 101
c=IN IP4 192.168.0.41
a=rtpmap:0 PCMU/8000
a=rtpmap:101 telephone-event/8000
a=fmtp:101 0-16
a=ptime:20
*May 25 10:50:33.765: //5013/558275C9A851/SIP/Event/sipSPICreateRpid: Received Octet3A=0x81 -> Setting ;screen=yes ;privacy=off
SIP: (5013) Group (a= group line) attribute, level 65535 instance 1 not found.
*May 25 10:50:33.769: //5013/558275C9A851/SIP/Msg/ccsipDisplayMsg:
Sent:
SIP/2.0 200 OK
Via: SIP/2.0/UDP 103.193.166.11:5060;branch=z9hG4bKe43e.1bfaf007.0,SIP/2.0/UDP 103.193.166.37:5060;received=103.193.166.37;branch=z9hG4bK33433ef2;rport=5060
From: "61418656729" <sip:0418656729@103.193.166.37>;tag=as75513f08
To: <sip:0359159401@103.193.166.11>;tag=91DEBE0-478
Date: Wed, 25 May 2016 10:50:30 GMT
Call-ID: 14d4c315453e08912a0a7b9a04cd0024@103.193.166.37:5060
CSeq: 102 INVITE
Allow: INVITE, OPTIONS, BYE, CANCEL, ACK, PRACK, UPDATE, REFER, SUBSCRIBE, NOTIFY, INFO, REGISTER
Allow-Events: telephone-event
Remote-Party-ID: "denys - 0359159401" <sip:0359159401@192.168.0.41>;party=called;screen=yes;privacy=off
Contact: <sip:0359159401@192.168.0.41:5060>
Record-Route: <sip:103.193.166.11;lr;did=e74.b69b5224>
Supported: replaces
Supported: sdp-anat
Server: Cisco-SIPGateway/IOS-12.x
Session-Expires: 1800;refresher=uas
Require: timer
Supported: timer
Content-Type: application/sdp
Content-Disposition: session;handling=required
Content-Length: 246
v=0
o=CiscoSystemsSIP-GW-UserAgent 807 5526 IN IP4 192.168.0.41
s=SIP Call
c=IN IP4 192.168.0.41
t=0 0
m=audio 16778 RTP/AVP 0 101
c=IN IP4 192.168.0.41
a=rtpmap:0 PCMU/8000
a=rtpmap:101 telephone-event/8000
a=fmtp:101 0-16
a=ptime:20
*May 25 10:50:34.797: //5013/558275C9A851/SIP/Event/sipSPICreateRpid: Received Octet3A=0x81 -> Setting ;screen=yes ;privacy=off
SIP: (5013) Group (a= group line) attribute, level 65535 instance 1 not found.
*May 25 10:50:34.797: //5013/558275C9A851/SIP/Msg/ccsipDisplayMsg:
Sent:
SIP/2.0 200 OK
Via: SIP/2.0/UDP 103.193.166.11:5060;branch=z9hG4bKe43e.1bfaf007.0,SIP/2.0/UDP 103.193.166.37:5060;received=103.193.166.37;branch=z9hG4bK33433ef2;rport=5060
From: "61418656729" <sip:0418656729@103.193.166.37>;tag=as75513f08
To: <sip:0359159401@103.193.166.11>;tag=91DEBE0-478
Date: Wed, 25 May 2016 10:50:30 GMT
Call-ID: 14d4c315453e08912a0a7b9a04cd0024@103.193.166.37:5060
CSeq: 102 INVITE
Allow: INVITE, OPTIONS, BYE, CANCEL, ACK, PRACK, UPDATE, REFER, SUBSCRIBE, NOTIFY, INFO, REGISTER
Allow-Events: telephone-event
Remote-Party-ID: "denys - 0359159401" <sip:0359159401@192.168.0.41>;party=called;screen=yes;privacy=off
Contact: <sip:0359159401@192.168.0.41:5060>
Record-Route: <sip:103.193.166.11;lr;did=e74.b69b5224>
Supported: replaces
Supported: sdp-anat
Server: Cisco-SIPGateway/IOS-12.x
Session-Expires: 1800;refresher=uas
Require: timer
Supported: timer
Content-Type: application/sdp
Content-Disposition: session;handling=required
Content-Length: 246
v=0
o=CiscoSystemsSIP-GW-UserAgent 807 5526 IN IP4 192.168.0.41
s=SIP Call
c=IN IP4 192.168.0.41
t=0 0
m=audio 16778 RTP/AVP 0 101
c=IN IP4 192.168.0.41
a=rtpmap:0 PCMU/8000
a=rtpmap:101 telephone-event/8000
a=fmtp:101 0-16
a=ptime:20
*May 25 10:50:36.793: //5013/558275C9A851/SIP/Event/sipSPICreateRpid: Received Octet3A=0x81 -> Setting ;screen=yes ;privacy=off
SIP: (5013) Group (a= group line) attribute, level 65535 instance 1 not found.
*May 25 10:50:36.797: //5013/558275C9A851/SIP/Msg/ccsipDisplayMsg:
Sent:
SIP/2.0 200 OK
Via: SIP/2.0/UDP 103.193.166.11:5060;branch=z9hG4bKe43e.1bfaf007.0,SIP/2.0/UDP 103.193.166.37:5060;received=103.193.166.37;branch=z9hG4bK33433ef2;rport=5060
From: "61418656729" <sip:0418656729@103.193.166.37>;tag=as75513f08
To: <sip:0359159401@103.193.166.11>;tag=91DEBE0-478
Date: Wed, 25 May 2016 10:50:30 GMT
Call-ID: 14d4c315453e08912a0a7b9a04cd0024@103.193.166.37:5060
CSeq: 102 INVITE
Allow: INVITE, OPTIONS, BYE, CANCEL, ACK, PRACK, UPDATE, REFER, SUBSCRIBE, NOTIFY, INFO, REGISTER
Allow-Events: telephone-event
Remote-Party-ID: "denys - 0359159401" <sip:0359159401@192.168.0.41>;party=called;screen=yes;privacy=off
Contact: <sip:0359159401@192.168.0.41:5060>
Record-Route: <sip:103.193.166.11;lr;did=e74.b69b5224>
Supported: replaces
Supported: sdp-anat
Server: Cisco-SIPGateway/IOS-12.x
Session-Expires: 1800;refresher=uas
Require: timer
Supported: timer
Content-Type: application/sdp
Content-Disposition: session;handling=required
Content-Length: 246
v=0
o=CiscoSystemsSIP-GW-UserAgent 807 5526 IN IP4 192.168.0.41
s=SIP Call
c=IN IP4 192.168.0.41
t=0 0
m=audio 16778 RTP/AVP 0 101
c=IN IP4 192.168.0.41
a=rtpmap:0 PCMU/8000
a=rtpmap:101 telephone-event/8000
a=fmtp:101 0-16
a=ptime:20
*May 25 10:50:40.793: //5013/558275C9A851/SIP/Error/act_sentsucc_wait_ack: Out of retries
*May 25 10:50:40.793: //-1/xxxxxxxxxxxx/SIP/Error/sipSPIGetContentQSIG: No Inbound Container Created !!!
*May 25 10:50:40.793: //-1/xxxxxxxxxxxx/SIP/Error/sipSPIGetContentQ931: No Inbound Container Created !!!
*May 25 10:50:40.793: //5013/558275C9A851/SIP/Error/sipSPI_ipip_ExtractPassthruContentFromSipContainer: Invalid CCB/Data/Container
*May 25 10:50:40.793: //5013/558275C9A851/CCAPI/cc_api_call_disconnected:
Cause Value=102, Interface=0x4AC0F6C0, Call Id=5013
*May 25 10:50:40.793: //5013/558275C9A851/CCAPI/cc_api_call_disconnected:
Call Entry(Responsed=TRUE, Cause Value=102, Retry Count=0)
*May 25 10:50:40.793: //5013/558275C9A851/SIP/State/sipSPIChangeState: 0x4BA38CD8 : State change from (STATE_SENT_SUCCESS, SUBSTATE_NONE) to (STATE_DISCONNECTING, SUBSTATE_NONE)
*May 25 10:50:40.793: //5013/558275C9A851/SIP/State/sipSPIChangeState: 0x4BA38CD8 : State change from (STATE_DISCONNECTING, SUBSTATE_NONE) to (STATE_DISCONNECTING, SUBSTATE_NONE)
*May 25 10:50:40.797: //5013/558275C9A851/CCAPI/ccConferenceDestroy:
Conference Id=0x407, Tag=0x0
*May 25 10:50:40.797: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IPIPMS:cur_container:ccsip_ipip_media_service_main_container, cur_state:S_IPIP_MEDIA_SERV_STATE_IDLE, event:E_IPIP_MEDIA_SERV_EV_XCODER_RESET_STREAM
*May 25 10:50:40.797: //5013/xxxxxxxxxxxx/CCAPI/cc_api_get_xcode_stream:
*May 25 10:50:40.797: cc_api_get_xcode_stream : 4702
*May 25 10:50:40.797: //5014/xxxxxxxxxxxx/CCAPI/cc_api_get_xcode_stream:
*May 25 10:50:40.797: cc_api_get_xcode_stream : 4702
*May 25 10:50:40.797: //5013/xxxxxxxxxxxx/CCAPI/cc_api_get_xcode_stream:
*May 25 10:50:40.797: cc_api_get_xcode_stream : 4702
*May 25 10:50:40.797: //5013/xxxxxxxxxxxx/CCAPI/cc_api_get_xcode_stream:
*May 25 10:50:40.797: cc_api_get_xcode_stream : 4702
*May 25 10:50:40.797: //5013/558275C9A851/SIP/State/ccsip_cnfsm_debugs: IPIPMS:next_state:S_IPIP_MEDIA_SERV_STATE_IDLE
*May 25 10:50:40.797: //5013/558275C9A851/CCAPI/cc_api_bridge_drop_done:
Conference Id=0x407, Source Interface=0x4AC0F6C0, Source Call Id=5013,
Destination Call Id=5014, Disposition=0x0, Tag=0x0
*May 25 10:50:40.797: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IPIPMS:cur_container:ccsip_ipip_media_service_main_container, cur_state:S_IPIP_MEDIA_SERV_STATE_IDLE, event:E_IPIP_MEDIA_SERV_EV_XCODER_RESET_STREAM
*May 25 10:50:40.797: //5014/xxxxxxxxxxxx/CCAPI/cc_api_get_xcode_stream:
*May 25 10:50:40.797: cc_api_get_xcode_stream : 4702
*May 25 10:50:40.797: //5013/xxxxxxxxxxxx/CCAPI/cc_api_get_xcode_stream:
*May 25 10:50:40.797: cc_api_get_xcode_stream : 4702
*May 25 10:50:40.797: //5014/xxxxxxxxxxxx/CCAPI/cc_api_get_xcode_stream:
*May 25 10:50:40.797: cc_api_get_xcode_stream : 4702
*May 25 10:50:40.797: //5014/xxxxxxxxxxxx/CCAPI/cc_api_get_xcode_stream:
*May 25 10:50:40.801: cc_api_get_xcode_stream : 4702
*May 25 10:50:40.801: //5014/000000000000/SIP/State/ccsip_cnfsm_debugs: IPIPMS:next_state:S_IPIP_MEDIA_SERV_STATE_IDLE
*May 25 10:50:40.801: //5014/558275C9A851/CCAPI/cc_api_bridge_drop_done:
Conference Id=0x407, Source Interface=0x4AC0F6C0, Source Call Id=5014,
Destination Call Id=5013, Disposition=0x0, Tag=0x0
*May 25 10:50:40.801: //5013/558275C9A851/CCAPI/cc_generic_bridge_done:
Conference Id=0x407, Source Interface=0x4AC0F6C0, Source Call Id=5014,
Destination Call Id=5013, Disposition=0x0, Tag=0x0
*May 25 10:50:40.801: //5013/558275C9A851/SIP/Msg/ccsipDisplayMsg:
Sent:
BYE sip:0418656729@103.193.166.37:5060 SIP/2.0
Via: SIP/2.0/UDP 192.168.0.41:5060;branch=z9hG4bK6CEC9B
From: <sip:0359159401@103.193.166.11>;tag=91DEBE0-478
To: "61418656729" <sip:0418656729@103.193.166.37>;tag=as75513f08
Date: Wed, 25 May 2016 10:50:30 GMT
Call-ID: 14d4c315453e08912a0a7b9a04cd0024@103.193.166.37:5060
User-Agent: Cisco-SIPGateway/IOS-12.x
Max-Forwards: 70
Route: <sip:103.193.166.11;lr;did=e74.b69b5224>
Timestamp: 1464173440
CSeq: 101 BYE
Reason: Q.850;cause=86
P-RTP-Stat: PS=374,OS=59840,PR=371,OR=59360,PL=0,JI=0,LA=0,DU=7
Content-Length: 0
*May 25 10:50:40.805: //5013/558275C9A851/CCAPI/ccCallDisconnect:
Cause Value=102, Tag=0x0, Call Entry(Previous Disconnect Cause=0, Disconnect Cause=102)
*May 25 10:50:40.805: //5013/558275C9A851/CCAPI/ccCallDisconnect:
Cause Value=102, Call Entry(Responsed=TRUE, Cause Value=102)
*May 25 10:50:40.805: //-1/xxxxxxxxxxxx/SIP/Event/sipSPIEventInfo: Queued event from SIP SPI : SIPSPI_EV_CC_CALL_DISCONNECT
*May 25 10:50:40.805: //5014/558275C9A851/CCAPI/ccCallDisconnect:
Cause Value=102, Tag=0x0, Call Entry(Previous Disconnect Cause=0, Disconnect Cause=0)
*May 25 10:50:40.805: //5014/558275C9A851/CCAPI/ccCallDisconnect:
Cause Value=102, Call Entry(Responsed=TRUE, Cause Value=102)
*May 25 10:50:40.805: //-1/xxxxxxxxxxxx/SIP/Event/sipSPIEventInfo: Queued event from SIP SPI : SIPSPI_EV_CC_CALL_DISCONNECT
*May 25 10:50:40.805: //5013/558275C9A851/SIP/Event/Session-Timer/sipSTSLMain: Event: E_STSL_SPI_EVENT
*May 25 10:50:40.809: //5014/000000000000/SIP/State/sipSPIChangeState: 0x4BA76A80 : State change from (STATE_ACTIVE, SUBSTATE_NONE) to (STATE_DISCONNECTING, SUBSTATE_NONE)
*May 25 10:50:40.809: //5014/000000000000/SIP/Msg/ccsipDisplayMsg:
Sent:
BYE sip:0359159401@192.168.0.9:5060 SIP/2.0
Via: SIP/2.0/UDP 192.168.0.41:5060;branch=z9hG4bK6CF186F
From: "61418656729" <sip:0418656729@sip.telecube.com.au>;tag=91DEBCC-185D
To: <sip:0359159401@192.168.0.9>;tag=5104~12d5d499-38ad-47af-a90a-d75e386b62e1-33197460
Date: Wed, 25 May 2016 10:50:31 GMT
Call-ID: 55892E1F-219D11E6-A857A914-AEFF3C37@192.168.0.41
User-Agent: Cisco-SIPGateway/IOS-12.x
Max-Forwards: 70
Timestamp: 1464173440
CSeq: 102 BYE
Reason: Q.850;cause=102
P-RTP-Stat: PS=372,OS=59520,PR=378,OR=60480,PL=0,JI=0,LA=0,DU=7
Content-Length: 0
*May 25 10:50:41.009: //5014/000000000000/SIP/Msg/ccsipDisplayMsg:
Received:
SIP/2.0 200 OK
Via: SIP/2.0/UDP 192.168.0.41:5060;branch=z9hG4bK6CF186F
From: "61418656729" <sip:0418656729@sip.telecube.com.au>;tag=91DEBCC-185D
To: <sip:0359159401@192.168.0.9>;tag=5104~12d5d499-38ad-47af-a90a-d75e386b62e1-33197460
Date: Wed, 25 May 2016 10:29:28 GMT
Call-ID: 55892E1F-219D11E6-A857A914-AEFF3C37@192.168.0.41
Server: Cisco-CUCM11.0
CSeq: 102 BYE
Content-Length: 0
*May 25 10:50:41.013: //5014/558275C9A851/CCAPI/cc_api_call_disconnect_done:
Disposition=0, Interface=0x4AC0F6C0, Tag=0x0, Call Id=5014,
Call Entry(Disconnect Cause=102, Voice Class Cause Code=0, Retry Count=0)
*May 25 10:50:41.013: //5014/558275C9A851/CCAPI/cc_api_call_disconnect_done:
Call Disconnect Event Sent
*May 25 10:50:41.013: //-1/xxxxxxxxxxxx/CCAPI/cc_free_feature_vsa:
*May 25 10:50:41.013: :cc_free_feature_vsa freeing 4D05F8E8
*May 25 10:50:41.013: //-1/xxxxxxxxxxxx/CCAPI/cc_free_feature_vsa:
*May 25 10:50:41.013: vsacount in free is 1
*May 25 10:50:41.013: //5014/000000000000/SIP/State/sipSPIChangeState: 0x4BA76A80 : State change from (STATE_DISCONNECTING, SUBSTATE_NONE) to (STATE_DEAD, SUBSTATE_NONE)
*May 25 10:50:41.013: //5014/000000000000/SIP/Call/sipSPICallInfo:
The Call Setup Information is:
Call Control Block (CCB) : 0x4BA76A80
State of The Call : STATE_DEAD
TCP Sockets Used : NO
Calling Number : 0418656729
Called Number : 0359159401
Source IP Address (Sig ): 192.168.0.41
Destn SIP Req Addr:Port : 192.168.0.9:5060
Destn SIP Resp Addr:Port : 192.168.0.9:5060
Destination Name : 192.168.0.9
*May 25 10:50:41.013: //5014/000000000000/SIP/Call/sipSPIMediaCallInfo:
Number of Media Streams: 1
Media Stream : 1
Negotiated Codec : g711ulaw
Negotiated Codec Bytes : 160
Nego. Codec payload : 0 (tx), 0 (rx)
Negotiated Dtmf-relay : 6
Dtmf-relay Payload : 101 (tx), 101 (rx)
Source IP Address (Media): 192.168.0.41
Source IP Port (Media): 18736
Destn IP Address (Media): 192.168.0.15
Destn IP Port (Media): 24724
Orig Destn IP Address:Port (Media): [ - ]:0
*May 25 10:50:41.013: //5014/000000000000/SIP/Call/sipSPICallInfo:
Disconnect Cause (CC) : 102
Disconnect Cause (SIP) : 200
*May 25 10:50:41.021: //5013/558275C9A851/SIP/Msg/ccsipDisplayMsg:
Received:
SIP/2.0 200 OK
Via: SIP/2.0/UDP 192.168.0.41:5060;received=49.177.58.109;branch=z9hG4bK6CEC9B
From: <sip:0359159401@103.193.166.11>;tag=91DEBE0-478
To: "61418656729" <sip:0418656729@103.193.166.37>;tag=as75513f08
Call-ID: 14d4c315453e08912a0a7b9a04cd0024@103.193.166.37:5060
CSeq: 101 BYE
Server: Asterisk (Telecube) PBX
Allow: INVITE, ACK, CANCEL, OPTIONS, BYE, REFER, SUBSCRIBE, NOTIFY, INFO, PUBLISH
Supported: replaces, timer
Content-Length: 0
*May 25 10:50:41.025: //5013/558275C9A851/CCAPI/cc_api_call_disconnect_done:
Disposition=0, Interface=0x4AC0F6C0, Tag=0x0, Call Id=5013,
Call Entry(Disconnect Cause=102, Voice Class Cause Code=0, Retry Count=0)
*May 25 10:50:41.025: //5013/558275C9A851/CCAPI/cc_api_call_disconnect_done:
Call Disconnect Event Sent
*May 25 10:50:41.025: //-1/xxxxxxxxxxxx/CCAPI/cc_free_feature_vsa:
*May 25 10:50:41.025: :cc_free_feature_vsa freeing 4D05F3A8
*May 25 10:50:41.025: //-1/xxxxxxxxxxxx/CCAPI/cc_free_feature_vsa:
*May 25 10:50:41.025: vsacount in free is 0
*May 25 10:50:41.025: //5013/558275C9A851/SIP/State/sipSPIChangeState: 0x4BA38CD8 : State change from (STATE_DISCONNECTING, SUBSTATE_NONE) to (STATE_DEAD, SUBSTATE_NONE)
*May 25 10:50:41.025: //5013/558275C9A851/SIP/Call/sipSPICallInfo:
The Call Setup Information is:
Call Control Block (CCB) : 0x4BA38CD8
State of The Call : STATE_DEAD
TCP Sockets Used : NO
Calling Number : 0418656729
Called Number : 0359159401
Source IP Address (Sig ): 192.168.0.41
Destn SIP Req Addr:Port : 103.193.166.11:5060
Destn SIP Resp Addr:Port : 103.193.166.11:5060
Destination Name : 103.193.166.11
*May 25 10:50:41.025: //5013/558275C9A851/SIP/Call/sipSPIMediaCallInfo:
Number of Media Streams: 1
Media Stream : 1
Negotiated Codec : g711ulaw
Negotiated Codec Bytes : 160
Nego. Codec payload : 0 (tx), 0 (rx)
Negotiated Dtmf-relay : 6
Dtmf-relay Payload : 101 (tx), 101 (rx)
Source IP Address (Media): 192.168.0.41
Source IP Port (Media): 16778
Destn IP Address (Media): 103.193.166.37
Destn IP Port (Media): 11918
Orig Destn IP Address:Port (Media): [ - ]:0
*May 25 10:50:41.025: //5013/558275C9A851/SIP/Call/sipSPICallInfo:
Disconnect Cause (CC) : 86
Disconnect Cause (SIP) : 200
Cisco2811#
*May 25 10:51:25.281: //-1/xxxxxxxxxxxx/SIP/Msg/ccsipDisplayMsg:
Received:
OPTIONS sip:192.168.0.41:5060 SIP/2.0
Via: SIP/2.0/TCP 192.168.0.9:5060;branch=z9hG4bK12c57c4c02c5
From: <sip:192.168.0.9>;tag=1723005953
To: <sip:192.168.0.41>
Date: Wed, 25 May 2016 10:30:13 GMT
Call-ID: a8beae00-74517eb5-12b2-900a8c0@192.168.0.9
User-Agent: Cisco-CUCM11.0
CSeq: 101 OPTIONS
Contact: <sip:192.168.0.9:5060;transport=tcp>
Max-Forwards: 0
Content-Length: 0
*May 25 10:51:25.281: //-1/75E3A602A858/SIP/State/sipSPIChangeState: 0x4BA38CD8 : State change from (STATE_NONE, SUBSTATE_NONE) to (STATE_IDLE, SUBSTATE_NONE)
*May 25 10:51:25.285: //-1/xxxxxxxxxxxx/SIP/Event/sipSPIEventInfo: Queued event from SIP SPI : SIPSPI_EV_CC_OPTIONS_RESP
*May 25 10:51:25.285: //5015/75E3A602A858/SIP/State/sipSPIChangeState: 0x4BA38CD8 : State change from (STATE_IDLE, SUBSTATE_NONE) to (SIP_STATE_OPTIONS_WAIT, SUBSTATE_NONE)
*May 25 10:51:25.289: //-1/xxxxxxxxxxxx/SIP/Msg/ccsipDisplayMsg:
Sent:
SIP/2.0 200 OK
Via: SIP/2.0/TCP 192.168.0.9:5060;branch=z9hG4bK12c57c4c02c5
From: <sip:192.168.0.9>;tag=1723005953
To: <sip:192.168.0.41>;tag=91EBFD0-75B
Date: Wed, 25 May 2016 10:51:25 GMT
Call-ID: a8beae00-74517eb5-12b2-900a8c0@192.168.0.9
Server: Cisco-SIPGateway/IOS-12.x
CSeq: 101 OPTIONS
Allow: INVITE, OPTIONS, BYE, CANCEL, ACK, PRACK, UPDATE, REFER, SUBSCRIBE, NOTIFY, INFO, REGISTER
Allow-Events: telephone-event
Accept: application/sdp
Supported: 100rel,timer,resource-priority,replaces,sdp-anat
Content-Type: application/sdp
Content-Length: 169
v=0
o=CiscoSystemsSIP-GW-UserAgent 5832 9003 IN IP4 192.168.0.41
s=SIP Call
c=IN IP4 192.168.0.41
t=0 0
m=audio 0 RTP/AVP 18 0 8 9 4 2 15 3
c=IN IP4 192.168.0.41
Solved! Go to Solution.
05-25-2016 05:01 AM
Hi,
As you can see CUBE is retransmitting 200 OK to provider and waiting for ACK however there is no ACK from provider and hence CUBE is terminating the call.
You can check any network issues to 103.193.166.11 or check with provider if receiving 200 OK or not.
- Vivek
05-25-2016 05:01 AM
Hi,
As you can see CUBE is retransmitting 200 OK to provider and waiting for ACK however there is no ACK from provider and hence CUBE is terminating the call.
You can check any network issues to 103.193.166.11 or check with provider if receiving 200 OK or not.
- Vivek
05-29-2019 05:17 AM
Hope the issue got fixed. Kindly send me the resolution to fix the issue
Discover and save your favorite ideas. Come back to expert answers, step-by-step guides, recent topics, and more.
New here? Get started with these tips. How to use Community New member guide