hi! Pls shed some light to the below dingaling/gtalk issue. ___________________________Call path________________________ Gtalk ---> Account setup in client.xml ---routed to public.xml ---> route to a external SIP gateway -----> sipUserA ___________________________Problem statement________________ The above call scenario is successfull using the *PMCU, PCMA* codecs in "dingaling.conf.xml". Both parties can hear each other. When I choose G723 the call disconnects after few seconds(2~). Both parties can hear some noise & thasts all. I see the call is bridged and then immediately unbridged. I assume G.723 is suppose to work here in passtru mode. Do I have to do any other configuration ohter than the ones listed below in order to get passthru working. ___________________________LOG important parts________________ (Full log found at the end) 2009-12-11 16:05:12.948700 [ERR] mod_g723_1.c:148 This codec is only usable in passthrough mode! 2009-12-11 16:05:12.948700 [DEBUG] switch_ivr_bridge.c:464 DingaLing/new ending bridge by request from write function 2009-12-11 16:05:12.948700 [DEBUG] switch_ivr_bridge.c:520 sofia/external/0094777915380 receive message [UNBRIDGE] ________________________Configuration XMLS______________________ ________________________dingaling.conf.xml_____________________ <configuration name="dingaling.conf" description="XMPP Jingle Endpoint"> <settings> <param name="debug" value="20"/> <param name="codec-prefs" value="G723"/> <!-- <param name="codec-prefs" value="PCMU"/> --> </settings> <X-PRE-PROCESS cmd="include" data="../jingle_profiles/*.xml"/> </configuration> ______________________________public.xml__________________________ <extension name="public_did"> <condition field="caller_id_number" expression="^([^@]+)" break="never"> <action application="set" data="effective_caller_id_number=$1"/> </condition> <condition field="destination_number" expression="^(5555)$"> <action application="set" data="call_timeout=18"/> <action application="set" data="continue_on_fail=true"/> <action application="set" data="hangup_after_bridge=true"/> <!-- <action application="bridge" data="sofia/internal/1001@safaricom"/> --> <!-- X <action application="set" data="proxy_media=true"/> <action application="set" data="bypass_media=false"/> <anti-action application="set" data="proxy_media=false"/> <anti-action application="set" data="bypass_media=true"/> <action application="set" data="absolute_codec_string=G723"/> --> <!-- X--> <!-- <action application="bridge" data="user/1001@172.16.11.211"/> --> <!-- <action application="bridge" data="sofia/gateway/sbc/$1"/> --> <action application="bridge" data="sofia/gateway/sbc/sipUserA"/> </condition> </extension> ______________________________client.xml___________________________ <include> <!-- Client Profile (Original mode) --> <!-- to use this profile take the x- away from the open and close tags so its <profile> and </profile> --> <profile type="client"> <param name="name" value="gmail.com"/> <param name="login" value="xxxxx@gmail.com/gtalk"/> <param name="password" value="xxxx"/> <param name="server" value="talk.google.com"/> <param name="dialplan" value="XML"/> <param name="context" value="public"/> <param name="message" value="xxxxxxxxxx"/> <param name="rtp-ip" value="auto"/> <param name="candidate-acl" value="wan"/> <!-- if you are behind NAT, you should probably use stun --> <param name="ext-rtp-ip" value="$${external_rtp_ip}"/> <param name="auto-login" value="true"/> <param name="auto-reply" value="Press *Call* to join my conference"/> <param name="sasl" value="plain"/> <param name="tls" value="true"/> <param name="use-rtp-timer" value="true"/> <param name="exten" value="5555"/> <param name="vad" value="both"/> </profile> </include> __________________________________Full Log__________________________ ____________________________________________________________________ ____________________________________________________________________ ____________________________________________________________________ freeswitch@internal> 2009-12-11 16:18:05.848176 [INFO] libdingaling.c:1305 SecRECV: ------------------------------------------------------------------------------- <iq to="GTALK_JINGLE_CLIENT@gmail.com/gtalk8FB831CE" type="set" id="83" from="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB"> <session type="initiate" id="596627090" initiator=" GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB" xmlns=" http://www.google.com/session"> <description xmlns="http://www.google.com/session/phone"> <payload-type id="103" name="ISAC"></payload-type> <payload-type id="97" name="IPCMWB"></payload-type> <payload-type id="4" name="G723"></payload-type> <payload-type id="100" name="EG711U"></payload-type> <payload-type id="101" name="EG711A"></payload-type> <payload-type id="0" name="PCMU"></payload-type> <payload-type id="8" name="PCMA"></payload-type> <payload-type id="13" name="CN"></payload-type> <payload-type id="102" name="iLBC"></payload-type> <payload-type id="117" name="red"></payload-type> <payload-type id="106" name="audio/telephone-event"></payload-type> </description> </session> </iq> 2009-12-11 16:18:05.848176 [DEBUG] libdingaling.c:353 Created Session 596627090 2009-12-11 16:18:05.848176 [DEBUG] libdingaling.c:381 Message for Session 596627090 2009-12-11 16:18:05.848176 [DEBUG] libdingaling.c:421 Add Payload [ISAC] id='103' 2009-12-11 16:18:05.848176 [DEBUG] libdingaling.c:421 Add Payload [IPCMWB] id='97' 2009-12-11 16:18:05.848176 [DEBUG] libdingaling.c:421 Add Payload [G723] id='4' 2009-12-11 16:18:05.848176 [DEBUG] libdingaling.c:421 Add Payload [EG711U] id='100' 2009-12-11 16:18:05.848176 [DEBUG] libdingaling.c:421 Add Payload [EG711A] id='101' 2009-12-11 16:18:05.848176 [DEBUG] libdingaling.c:421 Add Payload [PCMU] id='0' 2009-12-11 16:18:05.848176 [DEBUG] libdingaling.c:421 Add Payload [PCMA] id='8' 2009-12-11 16:18:05.848176 [DEBUG] libdingaling.c:421 Add Payload [CN] id='13' 2009-12-11 16:18:05.848176 [DEBUG] libdingaling.c:421 Add Payload [iLBC] id='102' 2009-12-11 16:18:05.848176 [DEBUG] libdingaling.c:421 Add Payload [red] id='117' 2009-12-11 16:18:05.848176 [DEBUG] libdingaling.c:421 Add Payload [audio/telephone-event] id='106' 2009-12-11 16:18:05.848176 [DEBUG] mod_dingaling.c:3028 Creating an identity for 596627090 GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB < GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB> 5555 2009-12-11 16:18:05.848176 [NOTICE] switch_channel.c:613 New Channel dingaling/5555 [d689728e-fcbd-433d-8b87-7c54c03d2825] 2009-12-11 16:18:05.849387 [DEBUG] mod_dingaling.c:3056 Creating a session for 596627090 2009-12-11 16:18:05.849387 [NOTICE] switch_channel.c:611 Rename Channel dingaling/5555->DingaLing/new [d689728e-fcbd-433d-8b87-7c54c03d2825] 2009-12-11 16:18:05.849387 [DEBUG] mod_dingaling.c:3060 (DingaLing/new) State Change CS_NEW -> CS_INIT 2009-12-11 16:18:05.849387 [DEBUG] switch_core_session.c:999 Send signal DingaLing/new [BREAK] 2009-12-11 16:18:05.849387 [DEBUG] mod_dingaling.c:1333 DingaLing/new CHANNEL KILL 2009-12-11 16:18:05.849387 [DEBUG] mod_dingaling.c:3157 11 payloads 2009-12-11 16:18:05.849387 [DEBUG] mod_dingaling.c:3159 Available Payload ISAC 103 2009-12-11 16:18:05.849387 [DEBUG] mod_dingaling.c:3166 compare ISAC 103/8000 to G723 4/8000 2009-12-11 16:18:05.849387 [DEBUG] mod_dingaling.c:3159 Available Payload IPCMWB 97 2009-12-11 16:18:05.849387 [DEBUG] mod_dingaling.c:3166 compare IPCMWB 97/8000 to G723 4/8000 2009-12-11 16:18:05.849387 [DEBUG] mod_dingaling.c:3159 Available Payload G723 4 2009-12-11 16:18:05.849387 [DEBUG] mod_dingaling.c:3166 compare G723 4/8000 to G723 4/8000 2009-12-11 16:18:05.849387 [DEBUG] mod_dingaling.c:3177 Choosing Payload index 0 G723 4 2009-12-11 16:18:05.849387 [DEBUG] mod_dingaling.c:1066 Send Describe [G723@8000] 2009-12-11 16:18:05.849387 [DEBUG] switch_core_state_machine.c:314 (DingaLing/new) Running State Change CS_INIT 2009-12-11 16:18:05.849387 [DEBUG] switch_core_state_machine.c:338 (DingaLing/new) State INIT 2009-12-11 16:18:05.849387 [NOTICE] mod_dingaling.c:1093 Ring-Ready DingaLing/new! 2009-12-11 16:18:05.884166 [NOTICE] libdingaling.c:1307 SecSEND: ------------------------------------------------------------------------------- <iq type="result" to="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB" from=" GTALK_JINGLE_CLIENT@gmail.com/gtalk8FB831CE" id="83"> <query></query> </iq> 2009-12-11 16:18:05.884166 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:05.884166 [DEBUG] libdingaling.c:1406 Sending packet 300 (2 left) 2009-12-11 16:18:05.884166 [NOTICE] libdingaling.c:1307 SecSEND: ------------------------------------------------------------------------------- <iq xmlns="jabber:client" from="GTALK_JINGLE_CLIENT@gmail.com/gtalk8FB831CE" to="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB" type="set" id="300"> <ses:session xmlns:ses="http://www.google.com/session" type="accept" id="596627090" initiator="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB"> <pho:description xmlns:pho="http://www.google.com/session/phone" xml:lang="en"> <pho:payload-type xmlns:pho="http://www.google.com/session/phone" id="4" name="G723" clockrate="8000" bitrate="6300"></pho:payload-type> </pho:description> </ses:session> </iq> 2009-12-11 16:18:05.983333 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:06.084116 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:06.184092 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:06.284068 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:06.384042 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:06.483334 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:06.583993 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:06.683965 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:06.783940 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:06.867919 [INFO] libdingaling.c:1305 SecRECV: ------------------------------------------------------------------------------- <iq to="GTALK_JINGLE_CLIENT@gmail.com/gtalk8FB831CE" type="set" id="85" from="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB"> <session type="candidates" id="596627090" initiator=" GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB" xmlns=" http://www.google.com/session"> <candidate name="rtp" address="172.16.11.110" port="1563" username="Unokk7lKh84I8mEM" password="At5OQzApw/ZrIrCo" preference="1" protocol="udp" type="local" network="0" generation="0"></candidate> </session> </iq> 2009-12-11 16:18:06.867919 [DEBUG] libdingaling.c:381 Message for Session 596627090 2009-12-11 16:18:06.867919 [DEBUG] libdingaling.c:503 New Candidate 1 name=rtp type=local protocol=udp username=Unokk7lKh84I8mEM password=At5OQzApw/ZrIrCo address=172.16.11.110 port=1563 pref=1.00 2009-12-11 16:18:06.867919 [DEBUG] mod_dingaling.c:2916 using Existing session for 596627090 2009-12-11 16:18:06.867919 [DEBUG] mod_dingaling.c:3227 1 candidates 2009-12-11 16:18:06.867919 [DEBUG] mod_dingaling.c:3243 candidate 172.16.11.110:1563 FAIL ACL wan 2009-12-11 16:18:06.883915 [NOTICE] libdingaling.c:1307 SecSEND: ------------------------------------------------------------------------------- <iq type="result" to="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB" from=" GTALK_JINGLE_CLIENT@gmail.com/gtalk8FB831CE" id="85"> <query></query> </iq> 2009-12-11 16:18:06.883915 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:06.983330 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:07.013899 [INFO] libdingaling.c:1305 SecRECV: ------------------------------------------------------------------------------- <iq to="GTALK_JINGLE_CLIENT@gmail.com/gtalk8FB831CE" type="set" id="86" from="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB"> <session type="candidates" id="596627090" initiator=" GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB" xmlns=" http://www.google.com/session"> <candidate name="rtp" address="172.16.7.28" port="1566" username="W3xgvc25vCXb5M/U" password="7EcqsVB3S6J3I2+g" preference="1" protocol="udp" type="local" network="1" generation="0"></candidate> </session> </iq> 2009-12-11 16:18:07.013899 [DEBUG] libdingaling.c:381 Message for Session 596627090 2009-12-11 16:18:07.013899 [DEBUG] libdingaling.c:463 Duplicate Pref! 2009-12-11 16:18:07.013899 [DEBUG] libdingaling.c:503 New Candidate 1 name=rtp type=local protocol=udp username=W3xgvc25vCXb5M/U password=7EcqsVB3S6J3I2+g address=172.16.7.28 port=1566 pref=1.00 2009-12-11 16:18:07.013899 [DEBUG] mod_dingaling.c:2916 using Existing session for 596627090 2009-12-11 16:18:07.013899 [DEBUG] mod_dingaling.c:3227 1 candidates 2009-12-11 16:18:07.013899 [DEBUG] mod_dingaling.c:3243 candidate 172.16.7.28:1566 FAIL ACL wan 2009-12-11 16:18:07.083870 [NOTICE] libdingaling.c:1307 SecSEND: ------------------------------------------------------------------------------- <iq type="result" to="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB" from=" GTALK_JINGLE_CLIENT@gmail.com/gtalk8FB831CE" id="86"> <query></query> </iq> 2009-12-11 16:18:07.083870 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:07.119862 [INFO] libdingaling.c:1305 SecRECV: ------------------------------------------------------------------------------- <iq type="result" to="GTALK_JINGLE_CLIENT@gmail.com/gtalk8FB831CE" id="300" from="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB"></iq> 2009-12-11 16:18:07.119862 [DEBUG] libdingaling.c:943 Cancel packet 300 2009-12-11 16:18:07.183848 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:07.183848 [DEBUG] libdingaling.c:1414 Discarding packet 300 2009-12-11 16:18:08.365552 [INFO] libdingaling.c:1305 SecRECV: ------------------------------------------------------------------------------- <iq to="GTALK_JINGLE_CLIENT@gmail.com/gtalk8FB831CE" type="set" id="87" from="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB"> <session type="candidates" id="596627090" initiator=" GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB" xmlns=" http://www.google.com/session"> <candidate name="rtp" address="209.85.229.126" port="19295" username="erYq6ggXdBRbEVDe" password="GQcop4clv7IEVldS" preference="0.5" protocol="udp" type="relay" network="0" generation="0"></candidate> </session> </iq> 2009-12-11 16:18:08.365552 [DEBUG] libdingaling.c:381 Message for Session 596627090 2009-12-11 16:18:08.365552 [DEBUG] libdingaling.c:503 New Candidate 2 name=rtp type=relay protocol=udp username=erYq6ggXdBRbEVDe password=GQcop4clv7IEVldS address=209.85.229.126 port=19295 pref=0.50 2009-12-11 16:18:08.365552 [DEBUG] mod_dingaling.c:2916 using Existing session for 596627090 2009-12-11 16:18:08.365552 [DEBUG] mod_dingaling.c:3227 2 candidates 2009-12-11 16:18:08.365552 [DEBUG] mod_dingaling.c:3243 candidate 172.16.7.28:1566 FAIL ACL wan 2009-12-11 16:18:08.365552 [DEBUG] mod_dingaling.c:3239 candidate 209.85.229.126:19295 PASS ACL wan 2009-12-11 16:18:08.365552 [DEBUG] mod_dingaling.c:3288 Acceptable Candidate 209.85.229.126:19295 2009-12-11 16:18:08.365552 [DEBUG] mod_dingaling.c:976 Stun Lookup Local 172.16.11.211:22878 2009-12-11 16:18:15.496911 [INFO] mod_dingaling.c:984 Stun Success XX.XX.XX.XX:22878 2009-12-11 16:18:15.496911 [DEBUG] mod_dingaling.c:998 Send Candidate XX.XX.XX.XX:22878 [goTRR95uTkRRMe3t] 2009-12-11 16:18:15.496911 [DEBUG] mod_dingaling.c:856 Set Read Codec to G723@8000 2009-12-11 16:18:15.496911 [DEBUG] mod_dingaling.c:871 Set Write Codec to G723@8000 2009-12-11 16:18:15.496911 [DEBUG] mod_dingaling.c:884 SETUP RTP 172.16.11.211:22878 -> 209.85.229.126:19295 2009-12-11 16:18:15.496911 [DEBUG] switch_rtp.c:1167 Starting timer [soft] 960 bytes per 120ms 2009-12-11 16:18:15.498911 [DEBUG] switch_rtp.c:2905 Activate VAD codec G723 120ms 2009-12-11 16:18:15.498911 [DEBUG] mod_dingaling.c:1184 (DingaLing/new) State Change CS_INIT -> CS_ROUTING 2009-12-11 16:18:15.498911 [DEBUG] switch_core_session.c:999 Send signal DingaLing/new [BREAK] 2009-12-11 16:18:15.498911 [DEBUG] mod_dingaling.c:1333 DingaLing/new CHANNEL KILL 2009-12-11 16:18:15.498911 [DEBUG] switch_core_state_machine.c:338 (DingaLing/new) State INIT going to sleep 2009-12-11 16:18:15.498911 [DEBUG] switch_core_state_machine.c:314 (DingaLing/new) Running State Change CS_ROUTING 2009-12-11 16:18:15.498911 [DEBUG] switch_core_state_machine.c:341 (DingaLing/new) State ROUTING 2009-12-11 16:18:15.498911 [DEBUG] mod_dingaling.c:1198 DingaLing/new CHANNEL ROUTING 2009-12-11 16:18:15.498911 [DEBUG] switch_core_state_machine.c:78 DingaLing/new Standard ROUTING 2009-12-11 16:18:15.498911 [INFO] mod_dialplan_xml.c:408 Processing GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB->5555 in context public Dialplan: DingaLing/new parsing [public->public_did] continue=false Dialplan: DingaLing/new Regex (PASS) [public_did] caller_id_number( GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB) =~ /^([^@]+)/ break=never Dialplan: DingaLing/new Action set(effective_caller_id_number=GTALK_ANY_CLIENT) Dialplan: DingaLing/new Regex (PASS) [public_did] destination_number(5555) =~ /^(5555)$/ break=on-false Dialplan: DingaLing/new Action set(call_timeout=18) Dialplan: DingaLing/new Action set(continue_on_fail=true) Dialplan: DingaLing/new Action set(hangup_after_bridge=true) Dialplan: DingaLing/new Action bridge(sofia/gateway/sbc/sipUserA) Dialplan: DingaLing/new Action answer() Dialplan: DingaLing/new Action voicemail(default 172.16.11.211 1001) 2009-12-11 16:18:15.499911 [DEBUG] switch_core_state_machine.c:122 (DingaLing/new) State Change CS_ROUTING -> CS_EXECUTE 2009-12-11 16:18:15.499911 [DEBUG] switch_core_session.c:999 Send signal DingaLing/new [BREAK] 2009-12-11 16:18:15.499911 [DEBUG] mod_dingaling.c:1333 DingaLing/new CHANNEL KILL 2009-12-11 16:18:15.499911 [DEBUG] switch_core_state_machine.c:341 (DingaLing/new) State ROUTING going to sleep 2009-12-11 16:18:15.499911 [DEBUG] switch_core_state_machine.c:314 (DingaLing/new) Running State Change CS_EXECUTE 2009-12-11 16:18:15.499911 [DEBUG] switch_core_state_machine.c:348 (DingaLing/new) State EXECUTE 2009-12-11 16:18:15.499911 [DEBUG] mod_dingaling.c:1215 DingaLing/new CHANNEL EXECUTE 2009-12-11 16:18:15.499911 [DEBUG] switch_core_state_machine.c:159 DingaLing/new Standard EXECUTE EXECUTE DingaLing/new set(effective_caller_id_number=GTALK_ANY_CLIENT) 2009-12-11 16:18:15.499911 [DEBUG] mod_dptools.c:768 DingaLing/new SET [effective_caller_id_number]=[GTALK_ANY_CLIENT] EXECUTE DingaLing/new set(call_timeout=18) 2009-12-11 16:18:15.499911 [DEBUG] mod_dptools.c:768 DingaLing/new SET [call_timeout]=[18] EXECUTE DingaLing/new set(continue_on_fail=true) 2009-12-11 16:18:15.499911 [DEBUG] mod_dptools.c:768 DingaLing/new SET [continue_on_fail]=[true] EXECUTE DingaLing/new set(hangup_after_bridge=true) 2009-12-11 16:18:15.499911 [DEBUG] mod_dptools.c:768 DingaLing/new SET [hangup_after_bridge]=[true] EXECUTE DingaLing/new bridge(sofia/gateway/sbc/sipUserA) 2009-12-11 16:18:15.500912 [NOTICE] switch_channel.c:613 New Channel sofia/external/sipUserA [cf250379-b2c9-439e-8295-766feef6cf74] 2009-12-11 16:18:15.500912 [DEBUG] mod_sofia.c:3142 (sofia/external/sipUserA) State Change CS_NEW -> CS_INIT 2009-12-11 16:18:15.500912 [DEBUG] switch_core_session.c:999 Send signal sofia/external/sipUserA [BREAK] 2009-12-11 16:18:15.500912 [DEBUG] switch_core_state_machine.c:314 (sofia/external/sipUserA) Running State Change CS_INIT 2009-12-11 16:18:15.500912 [DEBUG] switch_core_state_machine.c:338 (sofia/external/sipUserA) State INIT 2009-12-11 16:18:15.500912 [DEBUG] mod_sofia.c:83 sofia/external/sipUserA SOFIA INIT 2009-12-11 16:18:15.500912 [DEBUG] mod_sofia.c:111 (sofia/external/sipUserA) State Change CS_INIT -> CS_ROUTING 2009-12-11 16:18:15.500912 [DEBUG] switch_core_session.c:999 Send signal sofia/external/sipUserA [BREAK] 2009-12-11 16:18:15.500912 [DEBUG] switch_core_state_machine.c:338 (sofia/external/sipUserA) State INIT going to sleep 2009-12-11 16:18:15.500912 [DEBUG] switch_core_state_machine.c:314 (sofia/external/sipUserA) Running State Change CS_ROUTING 2009-12-11 16:18:15.500912 [DEBUG] switch_core_state_machine.c:341 (sofia/external/sipUserA) State ROUTING 2009-12-11 16:18:15.500912 [DEBUG] mod_sofia.c:132 sofia/external/sipUserA SOFIA ROUTING 2009-12-11 16:18:15.500912 [DEBUG] switch_ivr_originate.c:66 (sofia/external/sipUserA) State Change CS_ROUTING -> CS_CONSUME_MEDIA 2009-12-11 16:18:15.500912 [DEBUG] switch_core_session.c:999 Send signal sofia/external/sipUserA [BREAK] 2009-12-11 16:18:15.501911 [DEBUG] switch_core_state_machine.c:341 (sofia/external/sipUserA) State ROUTING going to sleep 2009-12-11 16:18:15.501911 [DEBUG] switch_core_state_machine.c:314 (sofia/external/sipUserA) Running State Change CS_CONSUME_MEDIA 2009-12-11 16:18:15.501911 [DEBUG] switch_core_state_machine.c:360 (sofia/external/sipUserA) State CONSUME_MEDIA 2009-12-11 16:18:15.501911 [DEBUG] switch_core_state_machine.c:360 (sofia/external/sipUserA) State CONSUME_MEDIA going to sleep 2009-12-11 16:18:15.501911 [DEBUG] sofia.c:3727 Channel sofia/external/sipUserA entering state [calling][0] 2009-12-11 16:18:15.583888 [NOTICE] libdingaling.c:1307 SecSEND: ------------------------------------------------------------------------------- <iq type="result" to="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB" from=" GTALK_JINGLE_CLIENT@gmail.com/gtalk8FB831CE" id="87"> <query></query> </iq> 2009-12-11 16:18:15.583888 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:15.583888 [DEBUG] libdingaling.c:1406 Sending packet 301 (2 left) 2009-12-11 16:18:15.583888 [NOTICE] libdingaling.c:1307 SecSEND: ------------------------------------------------------------------------------- <iq xmlns="jabber:client" from="GTALK_JINGLE_CLIENT@gmail.com/gtalk8FB831CE" to="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB" type="set" id="301"> <ses:session xmlns:ses="http://www.google.com/session" type="candidates" id="596627090" initiator="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB"> <ses:candidate name="rtp" address="XX.XX.XX.XX" port="22878" username="goTRR95uTkRRMe3t" password="goTRR95uTkRRMe3t" preference="1.0" protocol="udp" type="stun" network="0" generation="0"></ses:candidate> </ses:session> </iq> 2009-12-11 16:18:15.684864 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:15.784839 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:15.884815 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:15.984789 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:16.084764 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:16.184740 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:16.284715 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:16.384691 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:16.484666 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:16.584640 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:16.684617 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:16.784591 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:16.810584 [INFO] libdingaling.c:1305 SecRECV: ------------------------------------------------------------------------------- <iq type="result" to="GTALK_JINGLE_CLIENT@gmail.com/gtalk8FB831CE" id="301" from="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB"></iq> 2009-12-11 16:18:16.810584 [DEBUG] libdingaling.c:943 Cancel packet 301 2009-12-11 16:18:16.884567 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:16.884567 [DEBUG] libdingaling.c:1414 Discarding packet 301 2009-12-11 16:18:17.795342 [INFO] libdingaling.c:1305 SecRECV: ------------------------------------------------------------------------------- <iq to="GTALK_JINGLE_CLIENT@gmail.com/gtalk8FB831CE" type="set" id="88" from="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB"> <session type="candidates" id="596627090" initiator=" GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB" xmlns=" http://www.google.com/session"> <candidate name="rtp" address="172.16.7.28" port="1569" username="pBOc+m0nq7uQngnq" password="HzZY2+zb/u9oRH++" preference="0.8" protocol="tcp" type="local" network="1" generation="0"></candidate> </session> </iq> 2009-12-11 16:18:17.795342 [DEBUG] libdingaling.c:381 Message for Session 596627090 2009-12-11 16:18:17.795342 [DEBUG] libdingaling.c:503 New Candidate 3 name=rtp type=local protocol=tcp username=pBOc+m0nq7uQngnq password=HzZY2+zb/u9oRH++ address=172.16.7.28 port=1569 pref=0.80 2009-12-11 16:18:17.795342 [DEBUG] mod_dingaling.c:2916 using Existing session for 596627090 2009-12-11 16:18:17.795342 [DEBUG] mod_dingaling.c:3223 Already picked an IP [209.85.229.126] 2009-12-11 16:18:17.798342 [INFO] libdingaling.c:1305 SecRECV: ------------------------------------------------------------------------------- <iq to="GTALK_JINGLE_CLIENT@gmail.com/gtalk8FB831CE" type="set" id="89" from="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB"> <session type="candidates" id="596627090" initiator=" GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB" xmlns=" http://www.google.com/session"> <candidate name="rtp" address="209.85.229.126" port="19294" username="erYq6ggXdBRbEVDe" password="GQcop4clv7IEVldS" preference="0.5" protocol="tcp" type="relay" network="0" generation="0"></candidate> <candidate name="rtp" address="172.16.11.110" port="1570" username="EXe2XpIc76S9WxgB" password="BKF7SUs/hc30Fplp" preference="0.8" protocol="tcp" type="local" network="0" generation="0"></candidate> </session> </iq> 2009-12-11 16:18:17.798342 [DEBUG] libdingaling.c:381 Message for Session 596627090 2009-12-11 16:18:17.798342 [DEBUG] libdingaling.c:463 Duplicate Pref! 2009-12-11 16:18:17.798342 [DEBUG] libdingaling.c:503 New Candidate 3 name=rtp type=relay protocol=tcp username=erYq6ggXdBRbEVDe password=GQcop4clv7IEVldS address=209.85.229.126 port=19294 pref=0.50 2009-12-11 16:18:17.798342 [DEBUG] libdingaling.c:463 Duplicate Pref! 2009-12-11 16:18:17.798342 [DEBUG] libdingaling.c:503 New Candidate 3 name=rtp type=local protocol=tcp username=EXe2XpIc76S9WxgB password=BKF7SUs/hc30Fplp address=172.16.11.110 port=1570 pref=0.80 2009-12-11 16:18:17.798342 [DEBUG] mod_dingaling.c:2916 using Existing session for 596627090 2009-12-11 16:18:17.798342 [DEBUG] mod_dingaling.c:3223 Already picked an IP [209.85.229.126] 2009-12-11 16:18:17.884322 [NOTICE] libdingaling.c:1307 SecSEND: ------------------------------------------------------------------------------- <iq type="result" to="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB" from=" GTALK_JINGLE_CLIENT@gmail.com/gtalk8FB831CE" id="88"> <query></query> </iq> 2009-12-11 16:18:17.884322 [NOTICE] libdingaling.c:1307 SecSEND: ------------------------------------------------------------------------------- <iq type="result" to="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB" from=" GTALK_JINGLE_CLIENT@gmail.com/gtalk8FB831CE" id="89"> <query></query> </iq> 2009-12-11 16:18:18.797094 [INFO] libdingaling.c:1305 SecRECV: ------------------------------------------------------------------------------- <iq to="GTALK_JINGLE_CLIENT@gmail.com/gtalk8FB831CE" type="set" id="90" from="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB"> <session type="candidates" id="596627090" initiator=" GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB" xmlns=" http://www.google.com/session"> <candidate name="rtp" address="209.85.229.126" port="443" username="erYq6ggXdBRbEVDe" password="GQcop4clv7IEVldS" preference="0.5" protocol="ssltcp" type="relay" network="0" generation="0"></candidate> </session> </iq> 2009-12-11 16:18:18.797094 [DEBUG] libdingaling.c:381 Message for Session 596627090 2009-12-11 16:18:18.797094 [DEBUG] libdingaling.c:463 Duplicate Pref! 2009-12-11 16:18:18.797094 [DEBUG] libdingaling.c:503 New Candidate 3 name=rtp type=relay protocol=ssltcp username=erYq6ggXdBRbEVDe password=GQcop4clv7IEVldS address=209.85.229.126 port=443 pref=0.50 2009-12-11 16:18:18.797094 [DEBUG] mod_dingaling.c:2916 using Existing session for 596627090 2009-12-11 16:18:18.797094 [DEBUG] mod_dingaling.c:3223 Already picked an IP [209.85.229.126] 2009-12-11 16:18:18.885072 [NOTICE] libdingaling.c:1307 SecSEND: ------------------------------------------------------------------------------- <iq type="result" to="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB" from=" GTALK_JINGLE_CLIENT@gmail.com/gtalk8FB831CE" id="90"> <query></query> </iq> 2009-12-11 16:18:21.529273 [INFO] sofia.c:506 Update Callee ID to "sipUserA" <sipUserA> 2009-12-11 16:18:21.529273 [DEBUG] sofia.c:3727 Channel sofia/external/sipUserA entering state [proceeding][180] 2009-12-11 16:18:21.529273 [DEBUG] sofia.c:3738 Remote SDP: v=0 o=- 298002432 1260522569 IN IP4 YY.YY.YY.YY s=- c=IN IP4 YY.YY.YY.YY t=0 0 m=audio 15002 RTP/AVP 4 8 a=rtpmap:4 G723/8000 a=rtpmap:8 PCMA/8000 a=ptime:30 2009-12-11 16:18:21.529273 [DEBUG] sofia_glue.c:3305 Audio Codec Compare [G723:4:8000:30]/[G723:4:8000:120] 2009-12-11 16:18:21.529273 [DEBUG] sofia_glue.c:3305 Audio Codec Compare [G723:4:8000:30]/[PCMU:0:8000:120] 2009-12-11 16:18:21.529273 [DEBUG] sofia_glue.c:3305 Audio Codec Compare [G723:4:8000:30]/[PCMA:8:8000:120] 2009-12-11 16:18:21.529273 [DEBUG] sofia_glue.c:3305 Audio Codec Compare [G723:4:8000:30]/[GSM:3:8000:120] 2009-12-11 16:18:21.529273 [DEBUG] sofia_glue.c:3353 Substituting codec G723@30i@8000h 2009-12-11 16:18:21.529273 [DEBUG] sofia_glue.c:2143 Set Codec sofia/external/sipUserA G723/8000 30 ms 240 samples 2009-12-11 16:18:21.529273 [DEBUG] sofia_glue.c:2381 AUDIO RTP [sofia/external/sipUserA] 172.16.11.211 port 32408 -> YY.YY.YY.YY port 15002 codec: 4 ms: 30 2009-12-11 16:18:21.530280 [DEBUG] switch_rtp.c:1167 Starting timer [soft] 240 bytes per 30ms 2009-12-11 16:18:21.531273 [NOTICE] sofia_glue.c:2909 Pre-Answer sofia/external/sipUserA! 2009-12-11 16:18:21.531273 [DEBUG] switch_channel.c:2020 Send signal DingaLing/new [BREAK] 2009-12-11 16:18:21.531273 [DEBUG] mod_dingaling.c:1333 DingaLing/new CHANNEL KILL 2009-12-11 16:18:21.531273 [DEBUG] switch_ivr_originate.c:2886 DingaLing/new receive message [PROGRESS] 2009-12-11 16:18:21.531273 [DEBUG] switch_core_session.c:645 Send signal DingaLing/new [BREAK] 2009-12-11 16:18:21.531273 [DEBUG] mod_dingaling.c:1333 DingaLing/new CHANNEL KILL 2009-12-11 16:18:21.531273 [NOTICE] switch_ivr_originate.c:2886 Pre-Answer DingaLing/new! 2009-12-11 16:18:21.531273 [DEBUG] switch_ivr_originate.c:2929 Originate Resulted in Success: [sofia/external/sipUserA] 2009-12-11 16:18:21.531273 [DEBUG] switch_channel.c:182 sofia/external/sipUserA receive message [AUDIO_SYNC] 2009-12-11 16:18:21.531273 [DEBUG] switch_channel.c:182 DingaLing/new receive message [AUDIO_SYNC] 2009-12-11 16:18:21.531273 [DEBUG] switch_ivr_bridge.c:1032 sofia/external/sipUserA receive message [BRIDGE] 2009-12-11 16:18:21.531273 [DEBUG] switch_core_session.c:645 Send signal sofia/external/sipUserA [BREAK] 2009-12-11 16:18:21.531273 [DEBUG] switch_ivr_bridge.c:1039 DingaLing/new receive message [BRIDGE] 2009-12-11 16:18:21.531273 [DEBUG] switch_core_session.c:645 Send signal DingaLing/new [BREAK] 2009-12-11 16:18:21.531273 [DEBUG] mod_dingaling.c:1333 DingaLing/new CHANNEL KILL 2009-12-11 16:18:21.531273 [DEBUG] switch_ivr_bridge.c:1083 (sofia/external/sipUserA) State Change CS_CONSUME_MEDIA -> CS_EXCHANGE_MEDIA 2009-12-11 16:18:21.531273 [DEBUG] switch_core_session.c:999 Send signal sofia/external/sipUserA [BREAK] 2009-12-11 16:18:21.531273 [DEBUG] switch_core_state_machine.c:314 (sofia/external/sipUserA) Running State Change CS_EXCHANGE_MEDIA 2009-12-11 16:18:21.531273 [DEBUG] switch_core_state_machine.c:351 (sofia/external/sipUserA) State EXCHANGE_MEDIA 2009-12-11 16:18:21.531273 [DEBUG] mod_sofia.c:455 SOFIA LOOPBACK 2009-12-11 16:18:21.548268 [DEBUG] switch_rtp.c:2004 Correct ip/port confirmed. 2009-12-11 16:18:23.513922 [INFO] sofia.c:506 Update Callee ID to "sipUserA" <sipUserA> 2009-12-11 16:18:23.513922 [DEBUG] sofia.c:3727 Channel sofia/external/sipUserA entering state [completing][200] 2009-12-11 16:18:23.513922 [DEBUG] sofia.c:3735 Duplicate SDP v=0 o=- 298002432 1260522569 IN IP4 YY.YY.YY.YY s=- c=IN IP4 YY.YY.YY.YY t=0 0 m=audio 15002 RTP/AVP 4 8 a=rtpmap:4 G723/8000 a=rtpmap:8 PCMA/8000 a=ptime:30 2009-12-11 16:18:23.513922 [DEBUG] sofia.c:3727 Channel sofia/external/sipUserA entering state [ready][200] 2009-12-11 16:18:23.513922 [DEBUG] switch_channel.c:2133 Send signal DingaLing/new [BREAK] 2009-12-11 16:18:23.513922 [DEBUG] mod_dingaling.c:1333 DingaLing/new CHANNEL KILL 2009-12-11 16:18:23.513922 [NOTICE] sofia.c:4219 Channel [sofia/external/sipUserA] has been answered 2009-12-11 16:18:23.513922 [DEBUG] switch_channel.c:182 sofia/external/sipUserA receive message [AUDIO_SYNC] 2009-12-11 16:18:23.587904 [DEBUG] switch_ivr_bridge.c:394 DingaLing/new receive message [ANSWER] 2009-12-11 16:18:23.587904 [DEBUG] switch_core_session.c:645 Send signal DingaLing/new [BREAK] 2009-12-11 16:18:23.587904 [DEBUG] mod_dingaling.c:1333 DingaLing/new CHANNEL KILL 2009-12-11 16:18:23.587904 [NOTICE] switch_ivr_bridge.c:394 Channel [DingaLing/new] has been answered 2009-12-11 16:18:23.587904 [DEBUG] switch_channel.c:182 DingaLing/new receive message [AUDIO_SYNC] 2009-12-11 16:18:23.587904 [DEBUG] switch_core_session.c:706 Send signal sofia/external/sipUserA [BREAK] 2009-12-11 16:18:23.587904 [DEBUG] switch_core_session.c:706 Send signal DingaLing/new [BREAK] 2009-12-11 16:18:23.587904 [DEBUG] mod_dingaling.c:1333 DingaLing/new CHANNEL KILL 2009-12-11 16:18:23.617898 [DEBUG] switch_ivr_bridge.c:131 sofia/external/sipUserA receive message [DISPLAY] 2009-12-11 16:18:23.708875 [DEBUG] switch_ivr_bridge.c:131 DingaLing/new receive message [DISPLAY] 2009-12-11 16:18:25.568413 [DEBUG] switch_rtp.c:2004 Correct ip/port confirmed. 2009-12-11 16:18:25.568413 [ERR] mod_g723_1.c:148 This codec is only usable in passthrough mode! 2009-12-11 16:18:25.568413 [DEBUG] switch_ivr_bridge.c:464 DingaLing/new ending bridge by request from write function 2009-12-11 16:18:25.568413 [DEBUG] switch_ivr_bridge.c:520 sofia/external/sipUserA receive message [UNBRIDGE] 2009-12-11 16:18:25.568413 [DEBUG] switch_core_session.c:645 Send signal sofia/external/sipUserA [BREAK] 2009-12-11 16:18:25.568413 [DEBUG] switch_ivr_bridge.c:563 BRIDGE THREAD DONE [sofia/external/sipUserA] 2009-12-11 16:18:25.568413 [DEBUG] switch_ivr_bridge.c:565 Send signal DingaLing/new [BREAK] 2009-12-11 16:18:25.568413 [DEBUG] mod_dingaling.c:1333 DingaLing/new CHANNEL KILL 2009-12-11 16:18:25.568413 [NOTICE] switch_ivr_bridge.c:617 Hangup sofia/external/sipUserA [CS_EXCHANGE_MEDIA] [NORMAL_CLEARING] 2009-12-11 16:18:25.568413 [DEBUG] switch_channel.c:1912 Send signal sofia/external/sipUserA [KILL] 2009-12-11 16:18:25.568413 [DEBUG] switch_core_session.c:999 Send signal sofia/external/sipUserA [BREAK] 2009-12-11 16:18:25.568413 [DEBUG] switch_core_state_machine.c:488 (sofia/external/sipUserA) State HANGUP 2009-12-11 16:18:25.568413 [DEBUG] mod_sofia.c:358 Channel sofia/external/sipUserA hanging up, cause: NORMAL_CLEARING 2009-12-11 16:18:25.568413 [DEBUG] mod_sofia.c:400 Sending BYE to sofia/external/sipUserA 2009-12-11 16:18:25.568413 [DEBUG] switch_core_state_machine.c:46 sofia/external/sipUserA Standard HANGUP, cause: NORMAL_CLEARING 2009-12-11 16:18:25.568413 [DEBUG] switch_core_state_machine.c:488 (sofia/external/sipUserA) State HANGUP going to sleep 2009-12-11 16:18:25.568413 [DEBUG] switch_core_state_machine.c:351 (sofia/external/sipUserA) State EXCHANGE_MEDIA going to sleep 2009-12-11 16:18:25.568413 [DEBUG] switch_core_state_machine.c:314 (sofia/external/sipUserA) Running State Change CS_HANGUP 2009-12-11 16:18:25.569414 [DEBUG] switch_core_state_machine.c:465 sofia/external/sipUserA handler already called, skipping state handler. 2009-12-11 16:18:25.569414 [DEBUG] switch_core_state_machine.c:333 (sofia/external/sipUserA) State Change CS_HANGUP -> CS_REPORTING 2009-12-11 16:18:25.569414 [DEBUG] switch_core_session.c:999 Send signal sofia/external/sipUserA [BREAK] 2009-12-11 16:18:25.569414 [DEBUG] switch_core_state_machine.c:314 (sofia/external/sipUserA) Running State Change CS_REPORTING 2009-12-11 16:18:25.569414 [DEBUG] switch_core_state_machine.c:579 (sofia/external/sipUserA) State REPORTING 2009-12-11 16:18:25.569414 [DEBUG] switch_core_state_machine.c:53 sofia/external/sipUserA Standard REPORTING, cause: NORMAL_CLEARING 2009-12-11 16:18:25.569414 [DEBUG] switch_core_state_machine.c:579 (sofia/external/sipUserA) State REPORTING going to sleep 2009-12-11 16:18:25.569414 [DEBUG] switch_core_state_machine.c:327 (sofia/external/sipUserA) State Change CS_REPORTING -> CS_DESTROY 2009-12-11 16:18:25.569414 [DEBUG] switch_core_session.c:999 Send signal sofia/external/sipUserA [BREAK] 2009-12-11 16:18:25.569414 [DEBUG] switch_core_session.c:1136 Session 2 (sofia/external/sipUserA) Locked, Waiting on external entities 2009-12-11 16:18:25.628397 [DEBUG] switch_ivr_bridge.c:520 DingaLing/new receive message [UNBRIDGE] 2009-12-11 16:18:25.628397 [DEBUG] switch_core_session.c:645 Send signal DingaLing/new [BREAK] 2009-12-11 16:18:25.628397 [DEBUG] mod_dingaling.c:1333 DingaLing/new CHANNEL KILL 2009-12-11 16:18:25.628397 [DEBUG] switch_ivr_bridge.c:563 BRIDGE THREAD DONE [DingaLing/new] 2009-12-11 16:18:25.628397 [DEBUG] switch_ivr_bridge.c:565 Send signal sofia/external/sipUserA [BREAK] 2009-12-11 16:18:25.628397 [NOTICE] switch_ivr_bridge.c:1179 Hangup DingaLing/new [CS_EXECUTE] [NORMAL_CLEARING] 2009-12-11 16:18:25.628397 [DEBUG] switch_channel.c:1912 Send signal DingaLing/new [KILL] 2009-12-11 16:18:25.628397 [DEBUG] libdingaling.c:298 Destroyed Session 596627090 2009-12-11 16:18:25.628397 [DEBUG] mod_dingaling.c:1333 DingaLing/new CHANNEL KILL 2009-12-11 16:18:25.628397 [DEBUG] switch_core_session.c:999 Send signal DingaLing/new [BREAK] 2009-12-11 16:18:25.628397 [DEBUG] mod_dingaling.c:1333 DingaLing/new CHANNEL KILL 2009-12-11 16:18:25.628397 [DEBUG] switch_core_state_machine.c:488 (DingaLing/new) State HANGUP 2009-12-11 16:18:25.628397 [DEBUG] mod_dingaling.c:1293 DingaLing/new CHANNEL HANGUP 2009-12-11 16:18:25.628397 [DEBUG] switch_core_state_machine.c:46 DingaLing/new Standard HANGUP, cause: NORMAL_CLEARING 2009-12-11 16:18:25.628397 [DEBUG] switch_core_state_machine.c:488 (DingaLing/new) State HANGUP going to sleep 2009-12-11 16:18:25.628397 [NOTICE] switch_core_session.c:1154 Session 2 (sofia/external/sipUserA) Ended 2009-12-11 16:18:25.628397 [NOTICE] switch_core_session.c:1156 Close Channel sofia/external/sipUserA [CS_DESTROY] 2009-12-11 16:18:25.628397 [DEBUG] switch_core_state_machine.c:348 (DingaLing/new) State EXECUTE going to sleep 2009-12-11 16:18:25.628397 [DEBUG] switch_core_state_machine.c:423 (sofia/external/sipUserA) Running State Change CS_DESTROY 2009-12-11 16:18:25.629398 [DEBUG] switch_core_state_machine.c:314 (DingaLing/new) Running State Change CS_HANGUP 2009-12-11 16:18:25.629398 [DEBUG] switch_core_state_machine.c:434 (sofia/external/sipUserA) State DESTROY 2009-12-11 16:18:25.629398 [DEBUG] mod_sofia.c:293 sofia/external/sipUserA SOFIA DESTROY 2009-12-11 16:18:25.629398 [DEBUG] switch_core_state_machine.c:465 DingaLing/new handler already called, skipping state handler. 2009-12-11 16:18:25.629398 [DEBUG] switch_core_state_machine.c:333 (DingaLing/new) State Change CS_HANGUP -> CS_REPORTING 2009-12-11 16:18:25.629398 [DEBUG] switch_core_session.c:999 Send signal DingaLing/new [BREAK] 2009-12-11 16:18:25.629398 [DEBUG] mod_dingaling.c:1333 DingaLing/new CHANNEL KILL 2009-12-11 16:18:25.629398 [DEBUG] switch_core_state_machine.c:314 (DingaLing/new) Running State Change CS_REPORTING 2009-12-11 16:18:25.629398 [DEBUG] switch_core_state_machine.c:60 sofia/external/sipUserA Standard DESTROY 2009-12-11 16:18:25.629398 [DEBUG] switch_core_state_machine.c:579 (DingaLing/new) State REPORTING 2009-12-11 16:18:25.629398 [DEBUG] switch_core_state_machine.c:434 (sofia/external/sipUserA) State DESTROY going to sleep 2009-12-11 16:18:25.629398 [DEBUG] switch_core_state_machine.c:53 DingaLing/new Standard REPORTING, cause: NORMAL_CLEARING 2009-12-11 16:18:25.629398 [DEBUG] switch_core_state_machine.c:579 (DingaLing/new) State REPORTING going to sleep 2009-12-11 16:18:25.629398 [DEBUG] switch_core_state_machine.c:327 (DingaLing/new) State Change CS_REPORTING -> CS_DESTROY 2009-12-11 16:18:25.629398 [DEBUG] switch_core_session.c:999 Send signal DingaLing/new [BREAK] 2009-12-11 16:18:25.629398 [DEBUG] mod_dingaling.c:1333 DingaLing/new CHANNEL KILL 2009-12-11 16:18:25.629398 [DEBUG] switch_core_session.c:1136 Session 1 (DingaLing/new) Locked, Waiting on external entities 2009-12-11 16:18:25.629398 [NOTICE] switch_core_session.c:1154 Session 1 (DingaLing/new) Ended 2009-12-11 16:18:25.629398 [NOTICE] switch_core_session.c:1156 Close Channel DingaLing/new [CS_DESTROY] 2009-12-11 16:18:25.629398 [DEBUG] switch_core_state_machine.c:423 (DingaLing/new) Running State Change CS_DESTROY 2009-12-11 16:18:25.629398 [DEBUG] switch_core_state_machine.c:434 (DingaLing/new) State DESTROY 2009-12-11 16:18:25.629398 [DEBUG] mod_dingaling.c:1231 NUKE RTP 2009-12-11 16:18:25.629398 [DEBUG] switch_core_state_machine.c:60 DingaLing/new Standard DESTROY 2009-12-11 16:18:25.629398 [DEBUG] switch_core_state_machine.c:434 (DingaLing/new) State DESTROY going to sleep 2009-12-11 16:18:25.683383 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:25.683383 [DEBUG] libdingaling.c:1406 Sending packet 302 (2 left) 2009-12-11 16:18:25.683383 [NOTICE] libdingaling.c:1307 SecSEND: ------------------------------------------------------------------------------- <iq xmlns="jabber:client" from="GTALK_JINGLE_CLIENT@gmail.com/gtalk8FB831CE" to="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB" type="set" id="302"> <ses:session xmlns:ses="http://www.google.com/session" type="terminate" id="596627090" initiator="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB "></ses:session> </iq> 2009-12-11 16:18:25.783359 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:25.883332 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:25.983307 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:26.083280 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:26.183267 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:26.283231 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:26.383206 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:26.483181 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:26.583156 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:26.651139 [INFO] libdingaling.c:1305 SecRECV: ------------------------------------------------------------------------------- <iq type="result" to="GTALK_JINGLE_CLIENT@gmail.com/gtalk8FB831CE" id="302" from="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB"></iq> 2009-12-11 16:18:26.651139 [DEBUG] libdingaling.c:943 Cancel packet 302 2009-12-11 16:18:26.660136 [INFO] libdingaling.c:1305 SecRECV: ------------------------------------------------------------------------------- <iq to="GTALK_JINGLE_CLIENT@gmail.com/gtalk8FB831CE" type="set" id="91" from="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB"> <session type="terminate" id="596627090" initiator=" GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB" xmlns=" http://www.google.com/session"></session> </iq> 2009-12-11 16:18:26.660136 [DEBUG] libdingaling.c:353 Created Session 596627090 2009-12-11 16:18:26.660136 [DEBUG] libdingaling.c:381 Message for Session 596627090 2009-12-11 16:18:26.660136 [DEBUG] mod_dingaling.c:2926 Session is already dead 2009-12-11 16:18:26.683132 [NOTICE] libdingaling.c:1307 SecSEND: ------------------------------------------------------------------------------- <iq type="result" to="GTALK_ANY_CLIENT@gmail.com/Talk.v1054D5EA6CB" from=" GTALK_JINGLE_CLIENT@gmail.com/gtalk8FB831CE" id="91"> <query></query> </iq> 2009-12-11 16:18:26.683132 [DEBUG] libdingaling.c:1389 Processing 1 packets in retry queue 2009-12-11 16:18:26.683132 [DEBUG] libdingaling.c:1414 Discarding packet 302 Regds.
participants (2)
-
Brian West
-
zendel fernandez