[Freeswitch-users] Freeswitch (SBC + Media) does not know that gateway phone is picked up

Sherif Omran sherifomran2000 at yahoo.com
Sun May 27 13:30:01 MSD 2012


Hi Sammy

I found the solution. Made a new extension and set proxy media to false. Thats why the call was looping between Kamailio and FS. It now works fine

 <action application="set" data="proxy_media=false"/>


regards,
Sherif



--- On Sun, 5/27/12, SamyGo <govoiper at gmail.com> wrote:

From: SamyGo <govoiper at gmail.com>
Subject: Re: [Freeswitch-users] Freeswitch (SBC + Media) does not know that gateway phone is picked up
To: "FreeSWITCH Users Help" <freeswitch-users at lists.freeswitch.org>
Date: Sunday, May 27, 2012, 8:36 AM

OK Sheriff, I've gone through this. This says that destination on kamailio end is ringing and keeps on ringing state. What Im more interested in are the sip traces on port 5060 the story thats happening in between the destination phone and the kamailo..if u know what I mean !!


On Sat, May 26, 2012 at 8:06 PM, Sherif Omran <sherifomran2000 at yahoo.com> wrote:

Hi Sanny,

Please see the following links

http://pastebin.freeswitch.org/19175

http://pastebin.freeswitch.org/19174


regards,
Sherif


--- On Sat, 5/26/12, SamyGo <govoiper at gmail.com> wrote:


From: SamyGo <govoiper at gmail.com>
Subject: Re: [Freeswitch-users] Freeswitch (SBC + Media) does not know that gateway phone is picked up

To: "FreeSWITCH Users Help" <freeswitch-users at lists.freeswitch.org>
Date: Saturday, May 26, 2012, 5:52 PM

Hey Sherrif,
You might wanna resend the pcap file as I couldn;t find any single INVITE or any call in that capture. Please review.
BRSaGo.

On
 Sat, May 26, 2012 at 1:05 AM, Sherif Omran <sherifomran2000 at yahoo.com> wrote:

Hello Sammy

FS uses port 6090 and registers the GW. When a call comes, it rings the extension but then gives a busy signal and FS keeps ringing till I cancel the call from the GW.




recv 477 bytes from udp/[217.74.179.29]:5060 at 19:52:05.662344:

   ------------------------------------------------------------------------   CANCEL sip:gw+trunk_1000 at 78.138.90.58:6090;transport=udp;gw=trunk_1000 SIP/2.0

   Via: SIP/2.0/UDP 217.74.179.29;branch=z9hG4bKe567.13b0b9e.0   Via: SIP/2.0/UDP 217.74.179.28:5060;branch=z9hG4bK16d1a257;rport=5060

   From: "+41793940965" <sip:+41793940965 at bluesip.net>;tag=as1dccab06

   To: <sip:+498972101087914 at bluesip.net>
 
  Call-ID: 5cd37edb776a6b3a35e9713a453a3425 at bluesip.net   CSeq: 102 CANCEL
   User-Agent: blueSIP PSTN GW
   Max-Forwards: 69   Content-Length: 0   P-hint: USRLOC


--- On Fri, 5/25/12, SamyGo <govoiper at gmail.com> wrote:



From: SamyGo <govoiper at gmail.com>

Subject: Re: [Freeswitch-users] Freeswitch (SBC + Media) does not know that gateway phone is picked up

To: "FreeSWITCH Users Help" <freeswitch-users at lists.freeswitch.org>
Date: Friday,
 May 25, 2012, 10:46 AM

Hi again,If you want kamailio register to the provider then use UAC module. Kamailio will use the username/password and register with the provider.



Regards,Sammy

On Fri, May 25, 2012 at 12:20 PM, Sherif Omran <sherifomran2000 at yahoo.com> wrote:



Dear Sammy,

Thank you for your question ... Yes, the GW is registered through FS because I did not know how to register it to kamailio. But it seems better to register it to kamailio.



One more information, calls from 1001 to 1002 go to kamailio then to FS then return back to kamailio smoothly. Thus I would suggest that I change registering the gateway from FS to kamailio. but How to?



--- On Fri, 5/25/12, SamyGo <govoiper at gmail.com> wrote:




From: SamyGo <govoiper at gmail.com>


Subject: Re: [Freeswitch-users] Freeswitch (SBC + Media) does not know that gateway phone is picked up

To: "FreeSWITCH Users Help" <freeswitch-users at lists.freeswitch.org>
Date: Friday, May 25, 2012, 8:08 AM



Hi,These are SIP traces on FreeSWITCH console, whereas you are saying and it seems that kamailio is not detecting the answering (200 OK)of the call from extension 1002. Please, can you take a sip trace..!! I see you've both kamailio and FS on same server! Please take a pcap from the linux console using the following command.




#tcpdump -i any -s 0 -w new-call-trace.pcap -vvv
Please be quick on turning the sip trace on and off as quickly as possible to avoid extra packets. Once done open the file in wireshark ; apply filter "sip || rtp" and then save the resulting capture in separate file. Send us the new file to analyse.




One more silly question probably, I see REGISTERs coming to your FS as well and the calls to gateways are made from FS too !!, umm...just thinking what are you using kamailio for!!?




ThanksBR,Sammy

On Fri, May 25, 2012 at 4:40 AM, Sherif Omran <sherifomran2000 at yahoo.com> wrote:




Hi all,

here is the siptrace: To figure it out




1- gateway called bluesip.net. It send invide using caller number at bluesip.net



2- This call should go to extension kb-1002. kb means go from freeswitch port 6090 to kamailio port 5060

3- It should go to call extension 1002 in Kamailio
4- Extension 1002 rings but when I reply, it does not notice I replied


./fs_cli 
            _____ ____     ____ _     ___              
           |  ___/ ___|   / ___| |   |_ _|             




           |
 |_  \___ \  | |   | |    | |            
           |  _|  ___) | | |___| |___ | |              
           |_|   |____/   \____|_____|___|            

*******************************************************




* Anthony Minessale II, Ken Rice,                     *
* Michael Jerris, Travis Cross                        *
* FreeSWITCH
 (http://www.freeswitch.org)              *
* Paypal Donations Appreciated: paypal at freeswitch.org *




* Brought to you by ClueCon http://www.cluecon.com/   *
*******************************************************

Type /help <enter> to see a list of commands






+OK log level  [7]
freeswitch at internal> tracelevel
-ERR tracelevel Command not found!

freeswitch at internal> sofia global siptrace on
+OK Global siptrace on
recv 1104 bytes from udp/[217.74.179.29]:5060 at 23:08:45.822962:




   ------------------------------------------------------------------------
   INVITE sip:gw+trunk_1000 at 78.138.90.58:6090;transport=udp;gw=trunk_1000 SIP/2.0
   Record-Route: <sip:217.74.179.29;ftag=as00589402;lr=on>




   Via: SIP/2.0/UDP
 217.74.179.29;branch=z9hG4bK0dc9.284b9a03.0
   Via: SIP/2.0/UDP 217.74.179.28:5060;branch=z9hG4bK086622bb;rport=5060
   From: "+41793940965" <sip:+41793940965 at bluesip.net>;tag=as00589402




   To: <sip:+498972101087914 at bluesip.net>
   Contact: <sip:+41793940965 at 217.74.179.28>




   Call-ID: 4253e4bd2d624caf7f18faf85390b68f at bluesip.net
   CSeq: 102 INVITE
   User-Agent: blueSIP PSTN GW



   Max-Forwards: 69

   Date: Thu, 24 May 2012 23:08:44 GMT
   Allow: INVITE, ACK, CANCEL, OPTIONS, BYE, REFER, SUBSCRIBE, NOTIFY
   Supported: replaces
   Content-Type: application/sdp
   Content-Length: 367
   P-hint: USRLOC




   
   v=0
   o=root 20076 20076 IN IP4 217.74.179.28
   s=session
   c=IN IP4
 217.74.179.28
   t=0 0
   m=audio 25626 RTP/AVP 8 0 18 111 3 101
   a=rtpmap:8 PCMA/8000
   a=rtpmap:0 PCMU/8000
   a=rtpmap:18 G729/8000
   a=fmtp:18 annexb=no
   a=rtpmap:111 G726-32/8000
   a=rtpmap:3 GSM/8000




   a=rtpmap:101 telephone-event/8000
   a=fmtp:101 0-16
   a=silenceSupp:off - - - -
   a=ptime:20
   a=sendrecv
   ------------------------------------------------------------------------
send 494 bytes to udp/[217.74.179.29]:5060 at 23:08:45.844486:




   ------------------------------------------------------------------------
   SIP/2.0 100 Trying
   Via: SIP/2.0/UDP 217.74.179.29;branch=z9hG4bK0dc9.284b9a03.0
   Via: SIP/2.0/UDP 217.74.179.28:5060;branch=z9hG4bK086622bb;rport=5060




   Record-Route:
 <sip:217.74.179.29;ftag=as00589402;lr=on>
   From: "+41793940965" <sip:+41793940965 at bluesip.net>;tag=as00589402




   To: <sip:+498972101087914 at bluesip.net>
   Call-ID: 4253e4bd2d624caf7f18faf85390b68f at bluesip.net




   CSeq: 102 INVITE
   User-Agent: FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47 +0000
   Content-Length: 0
   
   ------------------------------------------------------------------------



2012-05-24 23:08:45.840749 [NOTICE] switch_channel.c:926 New Channel sofia/internal/+41793940965 at bluesip.net [69cd22e6-a5f5-11e1-a833-7b1f73a7ffcf]




2012-05-24 23:08:45.840749 [DEBUG] sofia.c:5532 Channel sofia/internal/+41793940965 at bluesip.net entering state [received][100]

2012-05-24 23:08:45.840749 [DEBUG] sofia.c:5543 Remote SDP:
v=0
o=root 20076 20076 IN IP4 217.74.179.28
s=session
c=IN IP4
 217.74.179.28
t=0 0
m=audio 25626 RTP/AVP 8 0 18 111 3 101
a=rtpmap:8 PCMA/8000
a=rtpmap:0 PCMU/8000
a=rtpmap:18 G729/8000
a=fmtp:18 annexb=no
a=rtpmap:111 G726-32/8000
a=rtpmap:3 GSM/8000
a=rtpmap:101 telephone-event/8000




a=fmtp:101 0-16
a=silenceSupp:off - - - -
a=ptime:20

2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [PCMA:8:8000:20:64000]/[iLBC:97:8000:30:13330]
2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [PCMU:0:8000:20:64000]/[iLBC:97:8000:30:13330]




2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [G729:18:8000:20:8000]/[iLBC:97:8000:30:13330]
2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [G726-32:111:8000:20:0]/[iLBC:97:8000:30:13330]




2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [GSM:3:8000:20:13200]/[iLBC:97:8000:30:13330]
2012-05-24 23:08:45.840749
 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [telephone-event:101:8000:20:0]/[iLBC:97:8000:30:13330]
2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:5000 Set 2833 dtmf send/recv payload to 101
2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [PCMA:8:8000:20:64000]/[G7221:115:32000:20:48000]




2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [PCMU:0:8000:20:64000]/[G7221:115:32000:20:48000]
2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [G729:18:8000:20:8000]/[G7221:115:32000:20:48000]




2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [G726-32:111:8000:20:0]/[G7221:115:32000:20:48000]
2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [GSM:3:8000:20:13200]/[G7221:115:32000:20:48000]




2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare
 [telephone-event:101:8000:20:0]/[G7221:115:32000:20:48000]
2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:5000 Set 2833 dtmf send/recv payload to 101
2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [PCMA:8:8000:20:64000]/[G7221:107:16000:20:32000]




2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [PCMU:0:8000:20:64000]/[G7221:107:16000:20:32000]
2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [G729:18:8000:20:8000]/[G7221:107:16000:20:32000]




2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [G726-32:111:8000:20:0]/[G7221:107:16000:20:32000]
2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [GSM:3:8000:20:13200]/[G7221:107:16000:20:32000]




2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [telephone-event:101:8000:20:0]/[G7221:107:16000:20:32000]
2012-05-24 23:08:45.840749 [DEBUG]
 sofia_glue.c:5000 Set 2833 dtmf send/recv payload to 101
2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [PCMA:8:8000:20:64000]/[G722:9:8000:20:64000]
2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [PCMU:0:8000:20:64000]/[G722:9:8000:20:64000]




2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [G729:18:8000:20:8000]/[G722:9:8000:20:64000]
2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [G726-32:111:8000:20:0]/[G722:9:8000:20:64000]




2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [GSM:3:8000:20:13200]/[G722:9:8000:20:64000]
2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [telephone-event:101:8000:20:0]/[G722:9:8000:20:64000]




2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:5000 Set 2833 dtmf send/recv payload to 101
2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec
 Compare [PCMA:8:8000:20:64000]/[PCMU:0:8000:20:64000]
2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:4879 Audio Codec Compare [PCMU:0:8000:20:64000]/[PCMU:0:8000:20:64000]
2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:2996 Set Codec sofia/internal/+41793940965 at bluesip.net PCMU/8000 20 ms 160 samples 64000 bits




2012-05-24 23:08:45.840749 [DEBUG] switch_core_codec.c:111 sofia/internal/+41793940965 at bluesip.net Original read codec set to PCMU:0




2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:5000 Set 2833 dtmf send/recv payload to 101
2012-05-24 23:08:45.840749 [DEBUG] sofia.c:5757 (sofia/internal/+41793940965 at bluesip.net) State Change CS_NEW -> CS_INIT




2012-05-24 23:08:45.840749 [DEBUG] switch_core_session.c:1182 Send signal sofia/internal/+41793940965 at bluesip.net [BREAK]

2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:362 (sofia/internal/+41793940965 at bluesip.net) Running State Change CS_INIT




2012-05-24
 23:08:45.840749 [DEBUG] switch_core_state_machine.c:401 (sofia/internal/+41793940965 at bluesip.net) State INIT

2012-05-24 23:08:45.840749 [DEBUG] mod_sofia.c:85 sofia/internal/+41793940965 at bluesip.net SOFIA INIT

2012-05-24 23:08:45.840749 [DEBUG] mod_sofia.c:125 (sofia/internal/+41793940965 at bluesip.net) State Change CS_INIT -> CS_ROUTING




2012-05-24 23:08:45.840749 [DEBUG] switch_core_session.c:1182 Send signal sofia/internal/+41793940965 at bluesip.net [BREAK]

2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:401 (sofia/internal/+41793940965 at bluesip.net) State INIT going to sleep




2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:362 (sofia/internal/+41793940965 at bluesip.net) Running State Change CS_ROUTING




2012-05-24 23:08:45.840749 [DEBUG] switch_channel.c:1886 (sofia/internal/+41793940965 at bluesip.net) Callstate Change DOWN -> RINGING




2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:410
 (sofia/internal/+41793940965 at bluesip.net) State ROUTING
2012-05-24 23:08:45.840749 [DEBUG] mod_sofia.c:148 sofia/internal/+41793940965 at bluesip.net SOFIA ROUTING




2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:104 sofia/internal/+41793940965 at bluesip.net Standard ROUTING

2012-05-24 23:08:45.840749 [INFO] mod_dialplan_xml.c:485 Processing +41793940965 <+41793940965>->kb-1002 in context public

Dialplan: sofia/internal/+41793940965 at bluesip.net parsing [public->from_kamailio] continue=false

Dialplan: sofia/internal/+41793940965 at bluesip.net Regex (PASS) [from_kamailio] destination_number(kb-1002) =~ /^(.+)$/ break=on-false




Dialplan: sofia/internal/+41793940965 at bluesip.net Action transfer(kb-1002 XML default) 
2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:154 (sofia/internal/+41793940965 at bluesip.net) State Change CS_ROUTING -> CS_EXECUTE




2012-05-24 23:08:45.840749 [DEBUG]
 switch_core_session.c:1182 Send signal sofia/internal/+41793940965 at bluesip.net [BREAK]
2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:410 (sofia/internal/+41793940965 at bluesip.net) State ROUTING going to sleep




2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:362 (sofia/internal/+41793940965 at bluesip.net) Running State Change CS_EXECUTE




2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:417 (sofia/internal/+41793940965 at bluesip.net) State EXECUTE

2012-05-24 23:08:45.840749 [DEBUG] mod_sofia.c:241 sofia/internal/+41793940965 at bluesip.net SOFIA EXECUTE

2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:192 sofia/internal/+41793940965 at bluesip.net Standard EXECUTE

EXECUTE sofia/internal/+41793940965 at bluesip.net transfer(kb-1002 XML default)
2012-05-24 23:08:45.840749 [DEBUG] switch_ivr.c:1711 (sofia/internal/+41793940965 at bluesip.net) State Change CS_EXECUTE -> CS_ROUTING




2012-05-24
 23:08:45.840749 [DEBUG] switch_core_session.c:1182 Send signal sofia/internal/+41793940965 at bluesip.net [BREAK]

2012-05-24 23:08:45.840749 [DEBUG] switch_core_session.c:731 Send signal sofia/internal/+41793940965 at bluesip.net [BREAK]

2012-05-24 23:08:45.840749 [NOTICE] switch_ivr.c:1717 Transfer sofia/internal/+41793940965 at bluesip.net to XML[kb-1002 at default]

2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:417 (sofia/internal/+41793940965 at bluesip.net) State EXECUTE going to sleep




2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:362 (sofia/internal/+41793940965 at bluesip.net) Running State Change CS_ROUTING




2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:410 (sofia/internal/+41793940965 at bluesip.net) State ROUTING

2012-05-24 23:08:45.840749 [DEBUG] mod_sofia.c:148 sofia/internal/+41793940965 at bluesip.net SOFIA ROUTING

2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:104
 sofia/internal/+41793940965 at bluesip.net Standard ROUTING
2012-05-24 23:08:45.840749 [INFO] mod_dialplan_xml.c:485 Processing +41793940965 <+41793940965>->kb-1002 in context default




Dialplan: sofia/internal/+41793940965 at bluesip.net parsing [default->vbox] continue=false
Dialplan: sofia/internal/+41793940965 at bluesip.net Regex (FAIL) [vbox] destination_number(kb-1002) =~ /^vb-([0-9][0-9][0-9])$/ break=on-false




Dialplan: sofia/internal/+41793940965 at bluesip.net parsing [default->vmenu] continue=false
Dialplan: sofia/internal/+41793940965 at bluesip.net Regex (FAIL) [vmenu] destination_number(kb-1002) =~ /^vm-([0-9][0-9][0-9][0-9])$/ break=on-false




Dialplan: sofia/internal/+41793940965 at bluesip.net parsing [default->kbridge] continue=false
Dialplan: sofia/internal/+41793940965 at bluesip.net Regex (PASS) [kbridge] destination_number(kb-1002) =~ /^kb-(.+)$/ break=on-false




Dialplan: sofia/internal/+41793940965 at bluesip.net
 Action set(proxy_media=true) 
Dialplan: sofia/internal/+41793940965 at bluesip.net Action set(call_timeout=50) 

Dialplan: sofia/internal/+41793940965 at bluesip.net Action set(continue_on_fail=true) 
Dialplan: sofia/internal/+41793940965 at bluesip.net Action set(hangup_after_bridge=true) 




Dialplan: sofia/internal/+41793940965 at bluesip.net Action set(sip_invite_domain=78.138.90.58) 
Dialplan: sofia/internal/+41793940965 at bluesip.net Action export(sip_contact_user=ufs) 




Dialplan: sofia/internal/+41793940965 at bluesip.net Action bridge(sofia/78.138.90.58/1002 at 78.138.90.58:5060) 




Dialplan: sofia/internal/+41793940965 at bluesip.net Action answer() 
Dialplan: sofia/internal/+41793940965 at bluesip.net Action voicemail(default ${domain_name} 1002) 




2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:154 (sofia/internal/+41793940965 at bluesip.net) State Change CS_ROUTING -> CS_EXECUTE




2012-05-24 23:08:45.840749 [DEBUG]
 switch_core_session.c:1182 Send signal sofia/internal/+41793940965 at bluesip.net [BREAK]
2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:410 (sofia/internal/+41793940965 at bluesip.net) State ROUTING going to sleep




2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:362 (sofia/internal/+41793940965 at bluesip.net) Running State Change CS_EXECUTE




2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:417 (sofia/internal/+41793940965 at bluesip.net) State EXECUTE

2012-05-24 23:08:45.840749 [DEBUG] mod_sofia.c:241 sofia/internal/+41793940965 at bluesip.net SOFIA EXECUTE

2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:192 sofia/internal/+41793940965 at bluesip.net Standard EXECUTE

EXECUTE sofia/internal/+41793940965 at bluesip.net set(proxy_media=true)
2012-05-24 23:08:45.840749 [DEBUG] mod_dptools.c:1281 sofia/internal/+41793940965 at bluesip.net SET [proxy_media]=[true]




EXECUTE
 sofia/internal/+41793940965 at bluesip.net set(call_timeout=50)
2012-05-24 23:08:45.840749 [DEBUG] mod_dptools.c:1281 sofia/internal/+41793940965 at bluesip.net SET [call_timeout]=[50]




EXECUTE sofia/internal/+41793940965 at bluesip.net set(continue_on_fail=true)
2012-05-24 23:08:45.840749 [DEBUG] mod_dptools.c:1281 sofia/internal/+41793940965 at bluesip.net SET [continue_on_fail]=[true]




EXECUTE sofia/internal/+41793940965 at bluesip.net set(hangup_after_bridge=true)
2012-05-24 23:08:45.840749 [DEBUG] mod_dptools.c:1281 sofia/internal/+41793940965 at bluesip.net SET [hangup_after_bridge]=[true]




EXECUTE sofia/internal/+41793940965 at bluesip.net set(sip_invite_domain=78.138.90.58)
2012-05-24 23:08:45.840749 [DEBUG] mod_dptools.c:1281 sofia/internal/+41793940965 at bluesip.net SET [sip_invite_domain]=[78.138.90.58]




EXECUTE sofia/internal/+41793940965 at bluesip.net export(sip_contact_user=ufs)
2012-05-24 23:08:45.840749 [DEBUG] switch_channel.c:1093 EXPORT
 (export_vars) [sip_contact_user]=[ufs]
EXECUTE sofia/internal/+41793940965 at bluesip.net bridge(sofia/78.138.90.58/1002 at 78.138.90.58:5060)




2012-05-24 23:08:45.840749 [DEBUG] switch_channel.c:1047 sofia/internal/+41793940965 at bluesip.net EXPORTING[export_vars] [sip_contact_user]=[ufs] to event




2012-05-24 23:08:45.840749 [DEBUG] switch_ivr_originate.c:1884 Parsing global variables
2012-05-24 23:08:45.840749 [NOTICE] switch_channel.c:926 New Channel sofia/internal/1002 at 78.138.90.58:5060 [69ce1f0c-a5f5-11e1-a838-7b1f73a7ffcf]




2012-05-24 23:08:45.840749 [DEBUG] mod_sofia.c:4691 (sofia/internal/1002 at 78.138.90.58:5060) State Change CS_NEW -> CS_INIT
2012-05-24 23:08:45.840749 [DEBUG] switch_core_session.c:1182 Send signal sofia/internal/1002 at 78.138.90.58:5060 [BREAK]




2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:362 (sofia/internal/1002 at 78.138.90.58:5060) Running State Change CS_INIT
2012-05-24 23:08:45.840749 [DEBUG]
 switch_core_state_machine.c:401 (sofia/internal/1002 at 78.138.90.58:5060) State INIT
2012-05-24 23:08:45.840749 [DEBUG] mod_sofia.c:85 sofia/internal/1002 at 78.138.90.58:5060 SOFIA INIT




2012-05-24 23:08:45.840749 [DEBUG] sofia_glue.c:1871 sofia/internal/1002 at 78.138.90.58:5060 Patched SDP
---
v=0
o=root 20076 20076 IN IP4 217.74.179.28




s=session
c=IN IP4 217.74.179.28
t=0 0
m=audio 25626 RTP/AVP 8 0 18 111 3 101
a=rtpmap:8 PCMA/8000
a=rtpmap:0 PCMU/8000
a=rtpmap:18 G729/8000
a=fmtp:18 annexb=no
a=rtpmap:111 G726-32/8000
a=rtpmap:3 GSM/8000




a=rtpmap:101 telephone-event/8000
a=fmtp:101 0-16
a=silenceSupp:off - - - -
a=ptime:20

+++
v=0
o=FreeSWITCH 1629510322 1629510323 IN IP4 78.138.90.58
s=FreeSWITCH
c=IN IP4 78.138.90.58
t=0 0




m=audio 31178 RTP/AVP 8 0 18 111 3 101
a=rtpmap:8 PCMA/8000
a=rtpmap:0 PCMU/8000
a=rtpmap:18 G729/8000
a=fmtp:18 annexb=no
a=rtpmap:111
 G726-32/8000
a=rtpmap:3 GSM/8000
a=rtpmap:101 telephone-event/8000
a=fmtp:101 0-16
a=silenceSupp:off - - - -
a=ptime:20

send 1340 bytes to udp/[78.138.90.58]:5060 at 23:08:45.852280:
   ------------------------------------------------------------------------




   INVITE sip:1002 at 78.138.90.58:5060 SIP/2.0
   Via: SIP/2.0/UDP 78.138.90.58:6090;rport;branch=z9hG4bKapDgFeegKyHXK
   Max-Forwards: 67



   From: "+41793940965" <sip:+41793940965 at 78.138.90.58>;tag=tgNrSS1jQFS8F

   To: <sip:1002 at 78.138.90.58:5060>
   Call-ID: 412c8312-2098-1230-8985-00163e6bb553
   CSeq: 28614398 INVITE
   Contact: <sip:ufs at 78.138.90.58:6090>




   User-Agent: FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47 +0000
   Allow: INVITE, ACK, BYE, CANCEL, OPTIONS, MESSAGE, UPDATE, INFO, REGISTER,
 REFER, NOTIFY, PUBLISH, SUBSCRIBE
   Supported: timer, precondition, path, replaces
   Allow-Events: talk, hold, presence, dialog, line-seize, call-info, sla, include-session-description, presence.winfo, message-summary, refer




   Content-Type: application/sdp
   Content-Disposition: session
   Content-Length: 372
   P-hint: USRLOC
   X-FS-Support: update_display,send_info
   Remote-Party-ID: "+41793940965" <sip:+41793940965 at 78.138.90.58>;party=calling;screen=yes;privacy=off




   
   v=0
   o=FreeSWITCH 1629510322 1629510323 IN IP4 78.138.90.58
   s=FreeSWITCH
   c=IN IP4 78.138.90.58
   t=0 0
   m=audio 31178 RTP/AVP 8 0 18 111 3 101
   a=rtpmap:8 PCMA/8000
   a=rtpmap:0 PCMU/8000




   a=rtpmap:18
 G729/8000
   a=fmtp:18 annexb=no
   a=rtpmap:111 G726-32/8000
   a=rtpmap:3 GSM/8000
   a=rtpmap:101 telephone-event/8000
   a=fmtp:101 0-16
   a=silenceSupp:off - - - -
   a=ptime:20
   ------------------------------------------------------------------------




2012-05-24 23:08:45.840749 [DEBUG] switch_core_session.c:877 Send signal sofia/internal/1002 at 78.138.90.58:5060 [BREAK]
2012-05-24 23:08:45.840749 [DEBUG] mod_sofia.c:125 (sofia/internal/1002 at 78.138.90.58:5060) State Change CS_INIT -> CS_ROUTING




2012-05-24 23:08:45.840749 [DEBUG] switch_core_session.c:1182 Send signal sofia/internal/1002 at 78.138.90.58:5060 [BREAK]
2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:401 (sofia/internal/1002 at 78.138.90.58:5060) State INIT going to sleep




2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:362
 (sofia/internal/1002 at 78.138.90.58:5060) Running State Change CS_ROUTING
2012-05-24 23:08:45.840749 [DEBUG] switch_channel.c:1886 (sofia/internal/1002 at 78.138.90.58:5060) Callstate Change DOWN -> RINGING




2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:410 (sofia/internal/1002 at 78.138.90.58:5060) State ROUTING
2012-05-24 23:08:45.840749 [DEBUG] mod_sofia.c:148 sofia/internal/1002 at 78.138.90.58:5060 SOFIA ROUTING




2012-05-24 23:08:45.840749 [DEBUG] switch_ivr_originate.c:66 (sofia/internal/1002 at 78.138.90.58:5060) State Change CS_ROUTING -> CS_CONSUME_MEDIA



2012-05-24 23:08:45.840749 [DEBUG] switch_core_session.c:1182 Send signal sofia/internal/1002 at 78.138.90.58:5060 [BREAK]

2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:410 (sofia/internal/1002 at 78.138.90.58:5060) State ROUTING going to sleep
2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:362 (sofia/internal/1002 at 78.138.90.58:5060)
 Running State Change CS_CONSUME_MEDIA
2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:429 (sofia/internal/1002 at 78.138.90.58:5060) State CONSUME_MEDIA




2012-05-24 23:08:45.840749 [DEBUG] switch_core_state_machine.c:429 (sofia/internal/1002 at 78.138.90.58:5060) State CONSUME_MEDIA going to sleep



2012-05-24 23:08:45.840749 [DEBUG] sofia.c:5532 Channel sofia/internal/1002 at 78.138.90.58:5060 entering state [calling][0]

recv 365 bytes from udp/[78.138.90.58]:5060 at 23:08:45.964309:
   ------------------------------------------------------------------------
   SIP/2.0 100 trying -- your call is important to us
   Via: SIP/2.0/UDP 78.138.90.58:6090;rport=6090;branch=z9hG4bKapDgFeegKyHXK




   From: "+41793940965" <sip:+41793940965 at 78.138.90.58>;tag=tgNrSS1jQFS8F

   To: <sip:1002 at 78.138.90.58:5060>
   Call-ID:
 412c8312-2098-1230-8985-00163e6bb553
   CSeq: 28614398 INVITE
   Server: kamailio (3.1.5 (x86_64/linux))
   Content-Length: 0
   
   ------------------------------------------------------------------------




recv 496 bytes from udp/[78.138.90.58]:5060 at 23:08:47.414766:
   ------------------------------------------------------------------------
   SIP/2.0 180 Ringing
   Via: SIP/2.0/UDP 78.138.90.58:6090;rport=6090;branch=z9hG4bKapDgFeegKyHXK




   Record-Route: <sip:78.138.90.58;lr;nat=yes>
   Call-ID: 412c8312-2098-1230-8985-00163e6bb553
   From: "+41793940965" <sip:+41793940965 at 78.138.90.58>;tag=tgNrSS1jQFS8F




   To: <sip:1002 at 78.138.90.58>;tag=qCSaB2YJOAsAr2dJ-RWNMhPoDdn1RFvs
   CSeq: 28614398 INVITE
   Contact: "Mama"
 <sip:1002 at 192.168.178.1:6060;transport=UDP>
   Allow: PRACK, INVITE, ACK, BYE, CANCEL, UPDATE, INFO, REGISTER
   Content-Length:  0
   
   ------------------------------------------------------------------------




2012-05-24 23:08:47.400741 [DEBUG] switch_core_session.c:877 Send signal sofia/internal/1002 at 78.138.90.58:5060 [BREAK]
2012-05-24 23:08:47.400741 [DEBUG] switch_core_session.c:877 Send signal sofia/internal/1002 at 78.138.90.58:5060 [BREAK]




2012-05-24 23:08:47.400741 [DEBUG] sofia.c:5532 Channel sofia/internal/1002 at 78.138.90.58:5060 entering state [proceeding][180]
2012-05-24 23:08:47.400741 [NOTICE] sofia.c:5624 Ring-Ready sofia/internal/1002 at 78.138.90.58:5060!




send 995 bytes to udp/[217.74.179.29]:5060 at 23:08:47.416538:
   ------------------------------------------------------------------------
   SIP/2.0 180 Ringing
   Via:
 SIP/2.0/UDP 217.74.179.29;branch=z9hG4bK0dc9.284b9a03.0
   Via: SIP/2.0/UDP 217.74.179.28:5060;branch=z9hG4bK086622bb;rport=5060
   Record-Route: <sip:217.74.179.29;ftag=as00589402;lr=on>
   From: "+41793940965" <sip:+41793940965 at bluesip.net>;tag=as00589402




   To: <sip:+498972101087914 at bluesip.net>;tag=S7UZQygFt62Nm
   Call-ID: 4253e4bd2d624caf7f18faf85390b68f at bluesip.net




   CSeq: 102 INVITE
   Contact: <sip:+498972101087914 at 78.138.90.58:6090;transport=udp>
   User-Agent: FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47 +0000

   Accept: application/sdp
   Allow: INVITE, ACK, BYE, CANCEL, OPTIONS, MESSAGE, UPDATE, INFO, REGISTER, REFER, NOTIFY, PUBLISH, SUBSCRIBE
   Supported: timer, precondition, path, replaces
   Allow-Events: talk, hold, presence, dialog,
 line-seize, call-info, sla, include-session-description, presence.winfo, message-summary, refer
   Content-Length: 0
   Remote-Party-ID: "Outbound Call" <sip:1002 at bluesip.net>;party=calling;privacy=off;screen=no




   
   ------------------------------------------------------------------------
2012-05-24 23:08:47.400741 [DEBUG] switch_core_session.c:877 Send signal sofia/internal/+41793940965 at bluesip.net [BREAK]




2012-05-24 23:08:47.400741 [NOTICE] mod_sofia.c:2514 Ring-Ready sofia/internal/+41793940965 at bluesip.net!

2012-05-24 23:08:47.400741 [DEBUG] sofia.c:5532 Channel sofia/internal/+41793940965 at bluesip.net entering state [early][180]

2012-05-24 23:08:47.400741 [DEBUG] switch_core_session.c:731 Send signal sofia/internal/+41793940965 at bluesip.net [BREAK]

2012-05-24 23:08:47.400741 [NOTICE] switch_ivr_originate.c:483 Ring Ready sofia/internal/+41793940965 at bluesip.net!

recv 496
 bytes from udp/[78.138.90.58]:5060 at 23:08:47.804967:
   ------------------------------------------------------------------------
   SIP/2.0 180 Ringing
   Via: SIP/2.0/UDP 78.138.90.58:6090;rport=6090;branch=z9hG4bKapDgFeegKyHXK




   Record-Route: <sip:78.138.90.58;lr=on;nat=yes>
   From: "+41793940965" <sip:+41793940965 at 78.138.90.58>;tag=tgNrSS1jQFS8F




   To: <sip:1002 at 78.138.90.58:5060>;tag=549D2DD03BBA7C67
   Call-ID: 412c8312-2098-1230-8985-00163e6bb553
   CSeq: 28614398 INVITE



   Contact: <sip:1002 at 41.34.123.243;uniq=6AC0DF4D2E498C8ACA82CB22226B9>

   User-Agent: AVM FRITZ!Box Fon WLAN 7170 29.04.80 (Jan 27 2010)
   Content-Length: 0
   
   ------------------------------------------------------------------------
2012-05-24 23:08:47.800746 [DEBUG]
 switch_core_session.c:877 Send signal sofia/internal/1002 at 78.138.90.58:5060 [BREAK]
2012-05-24 23:08:47.800746 [DEBUG] switch_core_session.c:877 Send signal sofia/internal/1002 at 78.138.90.58:5060 [BREAK]




2012-05-24 23:08:47.800746 [DEBUG] sofia.c:5532 Channel sofia/internal/1002 at 78.138.90.58:5060 entering state [proceeding][180]
recv 496 bytes from udp/[78.138.90.58]:5060 at 23:08:48.182098:




   ------------------------------------------------------------------------
   SIP/2.0 180 Ringing
   Via: SIP/2.0/UDP 78.138.90.58:6090;rport=6090;branch=z9hG4bKapDgFeegKyHXK
   Record-Route: <sip:78.138.90.58;lr;nat=yes>




   Call-ID: 412c8312-2098-1230-8985-00163e6bb553
   From: "+41793940965" <sip:+41793940965 at 78.138.90.58>;tag=tgNrSS1jQFS8F




   To: <sip:1002 at 78.138.90.58>;tag=qCSaB2YJOAsAr2dJ-RWNMhPoDdn1RFvs
   CSeq: 28614398
 INVITE
   Contact: "Mama" <sip:1002 at 192.168.178.1:6060;transport=UDP>
   Allow: PRACK, INVITE, ACK, BYE, CANCEL, UPDATE, INFO, REGISTER
   Content-Length:  0
   
   ------------------------------------------------------------------------




2012-05-24 23:08:48.180741 [DEBUG] switch_core_session.c:877 Send signal sofia/internal/1002 at 78.138.90.58:5060 [BREAK]
2012-05-24 23:08:48.180741 [DEBUG] switch_core_session.c:877 Send signal sofia/internal/1002 at 78.138.90.58:5060 [BREAK]




2012-05-24 23:08:48.180741 [DEBUG] sofia.c:5532 Channel sofia/internal/1002 at 78.138.90.58:5060 entering state [proceeding][180]
recv 496 bytes from udp/[78.138.90.58]:5060 at 23:08:48.417403:




   ------------------------------------------------------------------------
   SIP/2.0 180 Ringing
   Via: SIP/2.0/UDP
 78.138.90.58:6090;rport=6090;branch=z9hG4bKapDgFeegKyHXK
   Record-Route: <sip:78.138.90.58;lr=on;nat=yes>
   From: "+41793940965" <sip:+41793940965 at 78.138.90.58>;tag=tgNrSS1jQFS8F




   To: <sip:1002 at 78.138.90.58:5060>;tag=549D2DD03BBA7C67
   Call-ID: 412c8312-2098-1230-8985-00163e6bb553
   CSeq: 28614398 INVITE



   Contact: <sip:1002 at 41.34.123.243;uniq=6AC0DF4D2E498C8ACA82CB22226B9>

   User-Agent: AVM FRITZ!Box Fon WLAN 7170 29.04.80 (Jan 27 2010)
   Content-Length: 0
   
   ------------------------------------------------------------------------
2012-05-24 23:08:48.400744 [DEBUG] switch_core_session.c:877 Send signal sofia/internal/1002 at 78.138.90.58:5060 [BREAK]




2012-05-24 23:08:48.400744 [DEBUG] switch_core_session.c:877 Send signal sofia/internal/1002 at 78.138.90.58:5060 [BREAK]
2012-05-24
 23:08:48.400744 [DEBUG] sofia.c:5532 Channel sofia/internal/1002 at 78.138.90.58:5060 entering state [proceeding][180]
recv 496 bytes from udp/[78.138.90.58]:5060 at 23:08:49.292599:




   ------------------------------------------------------------------------
   SIP/2.0 180 Ringing
   Via: SIP/2.0/UDP 78.138.90.58:6090;rport=6090;branch=z9hG4bKapDgFeegKyHXK
   Record-Route: <sip:78.138.90.58;lr=on;nat=yes>




   From: "+41793940965" <sip:+41793940965 at 78.138.90.58>;tag=tgNrSS1jQFS8F

   To: <sip:1002 at 78.138.90.58:5060>;tag=549D2DD03BBA7C67
   Call-ID: 412c8312-2098-1230-8985-00163e6bb553
   CSeq: 28614398 INVITE



   Contact: <sip:1002 at 41.34.123.243;uniq=6AC0DF4D2E498C8ACA82CB22226B9>

   User-Agent: AVM FRITZ!Box Fon WLAN 7170 29.04.80 (Jan 27 2010)
   Content-Length: 0
  
 
   ------------------------------------------------------------------------
2012-05-24 23:08:49.280742 [DEBUG] switch_core_session.c:877 Send signal sofia/internal/1002 at 78.138.90.58:5060 [BREAK]




2012-05-24 23:08:49.280742 [DEBUG] switch_core_session.c:877 Send signal sofia/internal/1002 at 78.138.90.58:5060 [BREAK]
2012-05-24 23:08:49.280742 [DEBUG] sofia.c:5532 Channel sofia/internal/1002 at 78.138.90.58:5060 entering state [proceeding][180]




recv 478 bytes from udp/[217.74.179.29]:5060 at 23:09:15.066012:
   ------------------------------------------------------------------------
   CANCEL sip:gw+trunk_1000 at 78.138.90.58:6090;transport=udp;gw=trunk_1000 SIP/2.0




   Via: SIP/2.0/UDP 217.74.179.29;branch=z9hG4bK0dc9.284b9a03.0
   Via: SIP/2.0/UDP 217.74.179.28:5060;branch=z9hG4bK086622bb;rport=5060
   From: "+41793940965"
 <sip:+41793940965 at bluesip.net>;tag=as00589402
   To: <sip:+498972101087914 at bluesip.net>




   Call-ID: 4253e4bd2d624caf7f18faf85390b68f at bluesip.net
   CSeq: 102 CANCEL
   User-Agent: blueSIP PSTN GW



   Max-Forwards: 69

   Content-Length: 0
   P-hint: USRLOC
   
   ------------------------------------------------------------------------
send 369 bytes to udp/[217.74.179.29]:5060 at 23:09:15.066176:
   ------------------------------------------------------------------------




   SIP/2.0 200 OK
   Via: SIP/2.0/UDP 217.74.179.29;branch=z9hG4bK0dc9.284b9a03.0
   Via: SIP/2.0/UDP 217.74.179.28:5060;branch=z9hG4bK086622bb;rport=5060
   From: "+41793940965" <sip:+41793940965 at bluesip.net>;tag=as00589402




   To:
 <sip:+498972101087914 at bluesip.net>;tag=S7UZQygFt62Nm
   Call-ID: 4253e4bd2d624caf7f18faf85390b68f at bluesip.net




   CSeq: 102 CANCEL
   Content-Length: 0
   
   ------------------------------------------------------------------------
send 766 bytes to udp/[217.74.179.29]:5060 at 23:09:15.066289:
   ------------------------------------------------------------------------




   SIP/2.0 487 Request Terminated
   Via: SIP/2.0/UDP 217.74.179.29;branch=z9hG4bK0dc9.284b9a03.0
   Via: SIP/2.0/UDP 217.74.179.28:5060;branch=z9hG4bK086622bb;rport=5060
   From: "+41793940965" <sip:+41793940965 at bluesip.net>;tag=as00589402




   To: <sip:+498972101087914 at bluesip.net>;tag=S7UZQygFt62Nm
   Call-ID: 4253e4bd2d624caf7f18faf85390b68f at bluesip.net




   CSeq: 102 INVITE
   User-Agent:
 FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47 +0000
   Allow: INVITE, ACK, BYE, CANCEL, OPTIONS, MESSAGE, UPDATE, INFO, REGISTER, REFER, NOTIFY, PUBLISH, SUBSCRIBE
   Supported: timer, precondition, path, replaces




   Allow-Events: talk, hold, presence, dialog, line-seize, call-info, sla, include-session-description, presence.winfo, message-summary, refer
   Content-Length: 0
   
   ------------------------------------------------------------------------




2012-05-24 23:09:15.060742 [DEBUG] switch_core_session.c:877 Send signal sofia/internal/+41793940965 at bluesip.net [BREAK]

2012-05-24 23:09:15.060742 [DEBUG] switch_core_session.c:877 Send signal sofia/internal/+41793940965 at bluesip.net [BREAK]

2012-05-24 23:09:15.060742 [DEBUG] switch_core_session.c:877 Send signal sofia/internal/+41793940965 at bluesip.net [BREAK]

2012-05-24 23:09:15.060742 [DEBUG]
 sofia.c:5532 Channel sofia/internal/+41793940965 at bluesip.net entering state [terminated][487]
2012-05-24 23:09:15.060742 [DEBUG] switch_channel.c:2848 (sofia/internal/+41793940965 at bluesip.net) Callstate Change RINGING -> HANGUP




2012-05-24 23:09:15.060742 [NOTICE] sofia.c:6301 Hangup sofia/internal/+41793940965 at bluesip.net [CS_EXECUTE] [ORIGINATOR_CANCEL]

2012-05-24 23:09:15.060742 [DEBUG] switch_channel.c:2871 Send signal sofia/internal/+41793940965 at bluesip.net [KILL]

2012-05-24 23:09:15.060742 [DEBUG] switch_core_session.c:1182 Send signal sofia/internal/+41793940965 at bluesip.net [BREAK]

2012-05-24 23:09:15.060742 [DEBUG] switch_channel.c:2848 (sofia/internal/1002 at 78.138.90.58:5060) Callstate Change RINGING -> HANGUP
2012-05-24 23:09:15.060742 [NOTICE] switch_ivr_originate.c:3182 Hangup sofia/internal/1002 at 78.138.90.58:5060 [CS_CONSUME_MEDIA] [ORIGINATOR_CANCEL]




2012-05-24 23:09:15.060742 [DEBUG] switch_channel.c:2871 Send
 signal sofia/internal/1002 at 78.138.90.58:5060 [KILL]
2012-05-24 23:09:15.060742 [DEBUG] switch_core_state_machine.c:362 (sofia/internal/1002 at 78.138.90.58:5060) Running State Change CS_HANGUP




2012-05-24 23:09:15.060742 [DEBUG] switch_core_state_machine.c:602 (sofia/internal/1002 at 78.138.90.58:5060) State HANGUP
2012-05-24 23:09:15.060742 [DEBUG] mod_sofia.c:469 Channel sofia/internal/1002 at 78.138.90.58:5060 hanging up, cause: ORIGINATOR_CANCEL




2012-05-24 23:09:15.060742 [DEBUG] mod_sofia.c:523 Sending CANCEL to sofia/internal/1002 at 78.138.90.58:5060
2012-05-24 23:09:15.060742 [DEBUG] switch_core_state_machine.c:47 sofia/internal/1002 at 78.138.90.58:5060 Standard HANGUP, cause: ORIGINATOR_CANCEL




2012-05-24 23:09:15.060742 [DEBUG] switch_core_state_machine.c:602 (sofia/internal/1002 at 78.138.90.58:5060) State HANGUP going to sleep
2012-05-24 23:09:15.060742 [DEBUG] switch_core_state_machine.c:393 (sofia/internal/1002 at 78.138.90.58:5060) State
 Change CS_HANGUP -> CS_REPORTING
2012-05-24 23:09:15.060742 [DEBUG] switch_core_session.c:1182 Send signal sofia/internal/1002 at 78.138.90.58:5060 [BREAK]




2012-05-24 23:09:15.060742 [DEBUG] switch_core_state_machine.c:362 (sofia/internal/1002 at 78.138.90.58:5060) Running State Change CS_REPORTING
2012-05-24 23:09:15.060742 [DEBUG] switch_core_state_machine.c:662 (sofia/internal/1002 at 78.138.90.58:5060) State REPORTING




2012-05-24 23:09:15.060742 [DEBUG] switch_core_state_machine.c:79 sofia/internal/1002 at 78.138.90.58:5060 Standard REPORTING, cause: ORIGINATOR_CANCEL



2012-05-24 23:09:15.060742 [DEBUG] switch_core_state_machine.c:662 (sofia/internal/1002 at 78.138.90.58:5060) State REPORTING going to sleep

2012-05-24 23:09:15.060742 [DEBUG] switch_core_state_machine.c:387 (sofia/internal/1002 at 78.138.90.58:5060) State Change CS_REPORTING -> CS_DESTROY



2012-05-24 23:09:15.060742 [DEBUG] switch_core_session.c:1182 Send signal
 sofia/internal/1002 at 78.138.90.58:5060 [BREAK]
2012-05-24 23:09:15.060742 [DEBUG] switch_core_session.c:1382 Session 9 (sofia/internal/1002 at 78.138.90.58:5060) Locked, Waiting on external entities




2012-05-24 23:09:15.060742 [DEBUG] switch_core_session.c:1182 Send signal sofia/internal/1002 at 78.138.90.58:5060 [BREAK]
2012-05-24 23:09:15.060742 [DEBUG] switch_ivr_originate.c:3358 Originate Cancelled by originator termination Cause: 487 [ORIGINATOR_CANCEL]




2012-05-24 23:09:15.060742 [NOTICE] switch_core_session.c:1400 Session 9 (sofia/internal/1002 at 78.138.90.58:5060) Ended
2012-05-24 23:09:15.060742 [NOTICE] switch_core_session.c:1402 Close Channel sofia/internal/1002 at 78.138.90.58:5060 [CS_DESTROY]




2012-05-24 23:09:15.060742 [DEBUG] switch_core_state_machine.c:491 (sofia/internal/1002 at 78.138.90.58:5060) Callstate Change HANGUP -> DOWN



2012-05-24 23:09:15.060742 [DEBUG] switch_core_state_machine.c:494
 (sofia/internal/1002 at 78.138.90.58:5060) Running State Change CS_DESTROY
2012-05-24 23:09:15.060742 [DEBUG] switch_core_state_machine.c:504 (sofia/internal/1002 at 78.138.90.58:5060) State DESTROY




2012-05-24 23:09:15.060742 [DEBUG] mod_sofia.c:374 sofia/internal/1002 at 78.138.90.58:5060 SOFIA DESTROY
2012-05-24 23:09:15.060742 [DEBUG] switch_core_state_machine.c:86 sofia/internal/1002 at 78.138.90.58:5060 Standard DESTROY




2012-05-24 23:09:15.060742 [DEBUG] switch_core_state_machine.c:504 (sofia/internal/1002 at 78.138.90.58:5060) State DESTROY going to sleep
2012-05-24 23:09:15.060742 [INFO] mod_dptools.c:2922 Originate Failed.  Cause: ORIGINATOR_CANCEL




2012-05-24 23:09:15.060742 [DEBUG] switch_core_session.c:2287 sofia/internal/+41793940965 at bluesip.net skip receive message [APPLICATION_EXEC_COMPLETE] (channel is hungup already)




2012-05-24 23:09:15.060742 [DEBUG] switch_core_state_machine.c:417 (sofia/internal/+41793940965 at bluesip.net)
 State EXECUTE going to sleep
2012-05-24 23:09:15.060742 [DEBUG] switch_core_state_machine.c:362 (sofia/internal/+41793940965 at bluesip.net) Running State Change CS_HANGUP




2012-05-24 23:09:15.060742 [DEBUG] switch_core_state_machine.c:602 (sofia/internal/+41793940965 at bluesip.net) State HANGUP

2012-05-24 23:09:15.060742 [DEBUG] mod_sofia.c:469 Channel sofia/internal/+41793940965 at bluesip.net hanging up, cause: ORIGINATOR_CANCEL




2012-05-24 23:09:15.060742 [DEBUG] switch_core_state_machine.c:47 sofia/internal/+41793940965 at bluesip.net Standard HANGUP, cause: ORIGINATOR_CANCEL




2012-05-24 23:09:15.060742 [DEBUG] switch_core_state_machine.c:602 (sofia/internal/+41793940965 at bluesip.net) State HANGUP going to sleep




2012-05-24 23:09:15.060742 [DEBUG] switch_core_state_machine.c:393 (sofia/internal/+41793940965 at bluesip.net) State Change CS_HANGUP -> CS_REPORTING




2012-05-24 23:09:15.060742 [DEBUG] switch_core_session.c:1182 Send signal
 sofia/internal/+41793940965 at bluesip.net [BREAK]
2012-05-24 23:09:15.060742 [DEBUG] switch_core_state_machine.c:362 (sofia/internal/+41793940965 at bluesip.net) Running State Change CS_REPORTING




2012-05-24 23:09:15.060742 [DEBUG] switch_core_state_machine.c:662 (sofia/internal/+41793940965 at bluesip.net) State REPORTING

send 383 bytes to udp/[78.138.90.58]:5060 at 23:09:15.087695:
   ------------------------------------------------------------------------
   CANCEL sip:1002 at 78.138.90.58:5060 SIP/2.0




   Via: SIP/2.0/UDP 78.138.90.58:6090;rport;branch=z9hG4bKapDgFeegKyHXK
   Max-Forwards: 67
   From: "+41793940965" <sip:+41793940965 at 78.138.90.58>;tag=tgNrSS1jQFS8F




   To: <sip:1002 at 78.138.90.58:5060>
   Call-ID: 412c8312-2098-1230-8985-00163e6bb553
   CSeq: 28614398 CANCEL
   Reason:
 FreeSWITCH;cause=487;text="ORIGINATOR_CANCEL"
   Content-Length: 0
   
   ------------------------------------------------------------------------
recv 408 bytes from udp/[217.74.179.29]:5060 at 23:09:15.094670:




   ------------------------------------------------------------------------
   ACK sip:gw+trunk_1000 at 78.138.90.58:6090;transport=udp;gw=trunk_1000 SIP/2.0
   Via: SIP/2.0/UDP 217.74.179.29;branch=z9hG4bK0dc9.284b9a03.0




   From: "+41793940965" <sip:+41793940965 at bluesip.net>;tag=as00589402

   Call-ID: 4253e4bd2d624caf7f18faf85390b68f at bluesip.net
   To: <sip:+498972101087914 at bluesip.net>;tag=S7UZQygFt62Nm




   CSeq: 102 ACK
   User-Agent: Sip EXpress router(0.9.7 (i386/linux))
   Content-Length: 0
   
  
 ------------------------------------------------------------------------
2012-05-24 23:09:15.120807 [DEBUG] switch_core_state_machine.c:79 sofia/internal/+41793940965 at bluesip.net Standard REPORTING, cause: ORIGINATOR_CANCEL




2012-05-24 23:09:15.120807 [DEBUG] switch_core_state_machine.c:662 (sofia/internal/+41793940965 at bluesip.net) State REPORTING going to sleep




2012-05-24 23:09:15.120807 [DEBUG] switch_core_state_machine.c:387 (sofia/internal/+41793940965 at bluesip.net) State Change CS_REPORTING -> CS_DESTROY




2012-05-24 23:09:15.120807 [DEBUG] switch_core_session.c:1182 Send signal sofia/internal/+41793940965 at bluesip.net [BREAK]

2012-05-24 23:09:15.120807 [DEBUG] switch_core_session.c:1382 Session 8 (sofia/internal/+41793940965 at bluesip.net) Locked, Waiting on external entities




2012-05-24 23:09:15.120807 [NOTICE] switch_core_session.c:1400 Session 8 (sofia/internal/+41793940965 at bluesip.net) Ended

2012-05-24 23:09:15.120807 [NOTICE]
 switch_core_session.c:1402 Close Channel sofia/internal/+41793940965 at bluesip.net [CS_DESTROY]
2012-05-24 23:09:15.120807 [DEBUG] switch_core_state_machine.c:491 (sofia/internal/+41793940965 at bluesip.net) Callstate Change HANGUP -> DOWN




2012-05-24 23:09:15.120807 [DEBUG] switch_core_state_machine.c:494 (sofia/internal/+41793940965 at bluesip.net) Running State Change CS_DESTROY




2012-05-24 23:09:15.120807 [DEBUG] switch_core_state_machine.c:504 (sofia/internal/+41793940965 at bluesip.net) State DESTROY

2012-05-24 23:09:15.120807 [DEBUG] mod_sofia.c:374 sofia/internal/+41793940965 at bluesip.net SOFIA DESTROY

2012-05-24 23:09:15.120807 [DEBUG] switch_core_state_machine.c:86 sofia/internal/+41793940965 at bluesip.net Standard DESTROY

2012-05-24 23:09:15.120807 [DEBUG] switch_core_state_machine.c:504 (sofia/internal/+41793940965 at bluesip.net) State DESTROY going to sleep




recv 378 bytes from udp/[78.138.90.58]:5060 at
 23:09:15.135235:
   ------------------------------------------------------------------------
   SIP/2.0 200 canceling
   Via: SIP/2.0/UDP 78.138.90.58:6090;rport=6090;branch=z9hG4bKapDgFeegKyHXK
   From: "+41793940965" <sip:+41793940965 at 78.138.90.58>;tag=tgNrSS1jQFS8F




   To: <sip:1002 at 78.138.90.58:5060>;tag=a6a1c5f60faecf035a1ae5b6e96e979a-8c5b
   Call-ID: 412c8312-2098-1230-8985-00163e6bb553
   CSeq: 28614398 CANCEL




   Server: kamailio (3.1.5 (x86_64/linux))
   Content-Length: 0
   
   ------------------------------------------------------------------------
recv 446 bytes from udp/[78.138.90.58]:5060 at 23:09:16.419308:




   ------------------------------------------------------------------------
   SIP/2.0 487 Request Terminated
   Via: SIP/2.0/UDP
 78.138.90.58:6090;rport=6090;branch=z9hG4bKapDgFeegKyHXK
   Record-Route: <sip:78.138.90.58;lr;nat=yes>
   Call-ID: 412c8312-2098-1230-8985-00163e6bb553
   From: "+41793940965" <sip:+41793940965 at 78.138.90.58>;tag=tgNrSS1jQFS8F




   To: <sip:1002 at 78.138.90.58>;tag=qCSaB2YJOAsAr2dJ-RWNMhPoDdn1RFvs
   CSeq: 28614398 INVITE
   Allow: PRACK, INVITE, ACK, BYE, CANCEL, UPDATE, INFO, REGISTER




   Content-Length:  0
   
   ------------------------------------------------------------------------
send 354 bytes to udp/[78.138.90.58]:5060 at 23:09:16.419543:
   ------------------------------------------------------------------------




   ACK sip:1002 at 78.138.90.58:5060 SIP/2.0
   Via: SIP/2.0/UDP 78.138.90.58:6090;rport;branch=z9hG4bKapDgFeegKyHXK
   Max-Forwards:
 67
   From: "+41793940965" <sip:+41793940965 at 78.138.90.58>;tag=tgNrSS1jQFS8F

   To: <sip:1002 at 78.138.90.58>;tag=qCSaB2YJOAsAr2dJ-RWNMhPoDdn1RFvs
   Call-ID: 412c8312-2098-1230-8985-00163e6bb553
   CSeq: 28614398 ACK



   Content-Length: 0

   
   ------------------------------------------------------------------------
recv 564 bytes from udp/[41.34.123.243]:58881 at 23:13:13.612418:
   ------------------------------------------------------------------------




   REGISTER sip:sip.pcfone.com:6090 SIP/2.0
   Via: SIP/2.0/UDP 192.168.178.26:58881;rport;branch=z9hG4bKPjHQIpv.ACHGbXD4IHrMr72LwZ8kYdlu-J
   Max-Forwards: 70




   From: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=wOP.FVT4Crk8O5E.bB7BWUhNO6QG91IG
   To: "Sherif 1003" <sip:1002 at sip.pcfone.com>




  
 Call-ID: ohCjnPIlf85DIrNvetdMy.1RQM-rLj4e
   CSeq: 60926 REGISTER
   User-Agent: Telephone 1.0.2
   Contact: "Sherif 1003" <sip:1002 at 192.168.178.26:58881;ob>
   Expires: 300
   Allow: PRACK, INVITE, ACK, BYE, CANCEL, UPDATE, SUBSCRIBE, NOTIFY, REFER, MESSAGE, OPTIONS




   Content-Length:  0
   
   ------------------------------------------------------------------------
send 744 bytes to udp/[41.34.123.243]:58881 at 23:13:13.613152:
   ------------------------------------------------------------------------




   SIP/2.0 401 Unauthorized
   Via: SIP/2.0/UDP 192.168.178.26:58881;rport=58881;branch=z9hG4bKPjHQIpv.ACHGbXD4IHrMr72LwZ8kYdlu-J;received=41.34.123.243
   From: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=wOP.FVT4Crk8O5E.bB7BWUhNO6QG91IG




   To: "Sherif 1003"
 <sip:1002 at sip.pcfone.com>;tag=USeHUmjpmrFUB
   Call-ID: ohCjnPIlf85DIrNvetdMy.1RQM-rLj4e
   CSeq: 60926 REGISTER



   User-Agent: FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47 +0000

   Allow: INVITE, ACK, BYE, CANCEL, OPTIONS, MESSAGE, UPDATE, INFO, REGISTER, REFER, NOTIFY, PUBLISH, SUBSCRIBE
   Supported: timer, precondition, path, replaces
   WWW-Authenticate: Digest realm="sip.pcfone.com", nonce="09674764-a5f6-11e1-a83c-7b1f73a7ffcf", algorithm=MD5, qop="auth"




   Content-Length: 0
   
   ------------------------------------------------------------------------
recv 830 bytes from udp/[41.34.123.243]:58881 at 23:13:13.847746:
   ------------------------------------------------------------------------




   REGISTER sip:sip.pcfone.com:6090 SIP/2.0
   Via: SIP/2.0/UDP
 192.168.178.26:58881;rport;branch=z9hG4bKPjFr7rIAdAJPRQd2GmrMrVib3KT3Rup0q4
   Max-Forwards: 70
   From: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=wOP.FVT4Crk8O5E.bB7BWUhNO6QG91IG




   To: "Sherif 1003" <sip:1002 at sip.pcfone.com>
   Call-ID: ohCjnPIlf85DIrNvetdMy.1RQM-rLj4e
   CSeq: 60927 REGISTER



   User-Agent: Telephone 1.0.2

   Contact: "Sherif 1003" <sip:1002 at 192.168.178.26:58881;ob>
   Expires: 300
   Allow: PRACK, INVITE, ACK, BYE, CANCEL, UPDATE, SUBSCRIBE, NOTIFY, REFER, MESSAGE, OPTIONS
   Authorization: Digest username="1002", realm="sip.pcfone.com", nonce="09674764-a5f6-11e1-a83c-7b1f73a7ffcf", uri="sip:sip.pcfone.com:6090", response="3bc0bb82a803ded3641704c4eb78d58f", algorithm=MD5, cnonce="sc3AJfhuev18Bs-L-6tORmI.RXlxnPOz", qop=auth, nc=00000001




   Content-Length: 
 0
   
   ------------------------------------------------------------------------
send 706 bytes to udp/[41.34.123.243]:58881 at 23:13:13.850197:
   ------------------------------------------------------------------------




   SIP/2.0 200 OK
   Via: SIP/2.0/UDP 192.168.178.26:58881;rport=58881;branch=z9hG4bKPjFr7rIAdAJPRQd2GmrMrVib3KT3Rup0q4;received=41.34.123.243
   From: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=wOP.FVT4Crk8O5E.bB7BWUhNO6QG91IG




   To: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=v279vF3SH15DQ
   Call-ID: ohCjnPIlf85DIrNvetdMy.1RQM-rLj4e



   CSeq: 60927 REGISTER

   Contact: <sip:1002 at 192.168.178.26:58881;ob>;expires=300
   Date: Thu, 24 May 2012 23:13:13 GMT
   User-Agent: FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47 +0000
   Allow:
 INVITE, ACK, BYE, CANCEL, OPTIONS, MESSAGE, UPDATE, INFO, REGISTER, REFER, NOTIFY, PUBLISH, SUBSCRIBE
   Supported: timer, precondition, path, replaces
   Content-Length: 0
   
   ------------------------------------------------------------------------




send 989 bytes to udp/[41.34.123.243]:58881 at 23:13:13.888717:
   ------------------------------------------------------------------------
   NOTIFY sip:1002 at 192.168.178.26:58881;ob SIP/2.0
   Via: SIP/2.0/UDP 78.138.90.58:6090;rport;branch=z9hG4bKBZ68g9yKg77FF




   Route: <sip:1002 at 41.34.123.243:58881>;ob
   Max-Forwards: 70
   From: <sip:1002 at 78.138.90.58>;tag=XB12yamXeav0j




   To: <sip:1002 at 78.138.90.58>
   Call-ID: e0efa252-2098-1230-8985-00163e6bb553
   CSeq: 28614532 NOTIFY
   Contact:
 <sip:mod_sofia at 78.138.90.58:6090>
   User-Agent: FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47 +0000
   Allow: INVITE, ACK, BYE, CANCEL, OPTIONS, MESSAGE, UPDATE, INFO, REGISTER, REFER, NOTIFY, PUBLISH, SUBSCRIBE




   Supported: timer, precondition, path, replaces
   Event: message-summary
   Allow-Events: talk, hold, presence, dialog, line-seize, call-info, sla, include-session-description, presence.winfo, message-summary, refer




   Subscription-State: terminated;reason=noresource
   Content-Type: application/simple-message-summary
   Content-Length: 91
   
   Messages-Waiting: yes
   Message-Account: sip:1002 at 78.138.90.58




   Voice-Message: 1/0 (0/0)
   
   ------------------------------------------------------------------------
recv 308 bytes from
 udp/[41.34.123.243]:58881 at 23:13:14.298850:
   ------------------------------------------------------------------------
   SIP/2.0 200 OK
   Via: SIP/2.0/UDP 78.138.90.58:6090;rport=6090;received=78.138.90.58;branch=z9hG4bKBZ68g9yKg77FF




   Call-ID: e0efa252-2098-1230-8985-00163e6bb553
   From: <sip:1002 at 78.138.90.58>;tag=XB12yamXeav0j
   To: <sip:1002 at 78.138.90.58>;tag=z9hG4bKBZ68g9yKg77FF




   CSeq: 28614532 NOTIFY
   Content-Length:  0
   
   ------------------------------------------------------------------------
recv 564 bytes from udp/[41.34.123.243]:58881 at 23:18:09.067232:
   ------------------------------------------------------------------------




   REGISTER sip:sip.pcfone.com:6090 SIP/2.0
   Via: SIP/2.0/UDP
 192.168.178.26:58881;rport;branch=z9hG4bKPjABTslmZIhiHYRtLqQn2erwmX19MVYHFC
   Max-Forwards: 70
   From: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=JBSXL5WZLWbLzpvRFoTSP5x8qQslI1ST




   To: "Sherif 1003" <sip:1002 at sip.pcfone.com>
   Call-ID: ohCjnPIlf85DIrNvetdMy.1RQM-rLj4e
   CSeq: 60928 REGISTER



   User-Agent: Telephone 1.0.2

   Contact: "Sherif 1003" <sip:1002 at 192.168.178.26:58881;ob>
   Expires: 300
   Allow: PRACK, INVITE, ACK, BYE, CANCEL, UPDATE, SUBSCRIBE, NOTIFY, REFER, MESSAGE, OPTIONS
   Content-Length:  0




   
   ------------------------------------------------------------------------
send 744 bytes to udp/[41.34.123.243]:58881 at 23:18:09.068121:
   ------------------------------------------------------------------------




   SIP/2.0 401
 Unauthorized
   Via: SIP/2.0/UDP 192.168.178.26:58881;rport=58881;branch=z9hG4bKPjABTslmZIhiHYRtLqQn2erwmX19MVYHFC;received=41.34.123.243
   From: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=JBSXL5WZLWbLzpvRFoTSP5x8qQslI1ST




   To: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=ymtU0540BKjKe
   Call-ID: ohCjnPIlf85DIrNvetdMy.1RQM-rLj4e



   CSeq: 60928 REGISTER

   User-Agent: FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47 +0000
   Allow: INVITE, ACK, BYE, CANCEL, OPTIONS, MESSAGE, UPDATE, INFO, REGISTER, REFER, NOTIFY, PUBLISH, SUBSCRIBE
   Supported: timer, precondition, path, replaces




   WWW-Authenticate: Digest realm="sip.pcfone.com", nonce="b9821df4-a5f6-11e1-a83d-7b1f73a7ffcf", algorithm=MD5, qop="auth"



   Content-Length: 0

   
  
 ------------------------------------------------------------------------
recv 830 bytes from udp/[41.34.123.243]:58881 at 23:18:09.302944:
   ------------------------------------------------------------------------




   REGISTER sip:sip.pcfone.com:6090 SIP/2.0
   Via: SIP/2.0/UDP 192.168.178.26:58881;rport;branch=z9hG4bKPjRgtztcy63vMT97Jp5pH9n311li5EFeY-
   Max-Forwards: 70




   From: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=JBSXL5WZLWbLzpvRFoTSP5x8qQslI1ST
   To: "Sherif 1003" <sip:1002 at sip.pcfone.com>




   Call-ID: ohCjnPIlf85DIrNvetdMy.1RQM-rLj4e
   CSeq: 60929 REGISTER
   User-Agent: Telephone 1.0.2
   Contact: "Sherif 1003" <sip:1002 at 192.168.178.26:58881;ob>
   Expires: 300
   Allow: PRACK, INVITE, ACK, BYE, CANCEL, UPDATE, SUBSCRIBE, NOTIFY, REFER, MESSAGE,
 OPTIONS
   Authorization: Digest username="1002", realm="sip.pcfone.com", nonce="b9821df4-a5f6-11e1-a83d-7b1f73a7ffcf", uri="sip:sip.pcfone.com:6090", response="519c6301816b51f3bbb98d97a347e92b", algorithm=MD5, cnonce="sc3AJfhuev18Bs-L-6tORmI.RXlxnPOz", qop=auth, nc=00000001




   Content-Length:  0
   
   ------------------------------------------------------------------------
send 706 bytes to udp/[41.34.123.243]:58881 at 23:18:09.305217:
   ------------------------------------------------------------------------




   SIP/2.0 200 OK
   Via: SIP/2.0/UDP 192.168.178.26:58881;rport=58881;branch=z9hG4bKPjRgtztcy63vMT97Jp5pH9n311li5EFeY-;received=41.34.123.243
   From: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=JBSXL5WZLWbLzpvRFoTSP5x8qQslI1ST




   To: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=ZXKm20N48U85S
  
 Call-ID: ohCjnPIlf85DIrNvetdMy.1RQM-rLj4e
   CSeq: 60929 REGISTER
   Contact: <sip:1002 at 192.168.178.26:58881;ob>;expires=300
   Date: Thu, 24 May 2012 23:18:09 GMT
   User-Agent: FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47 +0000




   Allow: INVITE, ACK, BYE, CANCEL, OPTIONS, MESSAGE, UPDATE, INFO, REGISTER, REFER, NOTIFY, PUBLISH, SUBSCRIBE
   Supported: timer, precondition, path, replaces
   Content-Length: 0
   
   ------------------------------------------------------------------------




send 989 bytes to udp/[41.34.123.243]:58881 at 23:18:09.379987:
   ------------------------------------------------------------------------
   NOTIFY sip:1002 at 192.168.178.26:58881;ob SIP/2.0
   Via: SIP/2.0/UDP 78.138.90.58:6090;rport;branch=z9hG4bKc8Z1j4FQDgy2a




   Route:
 <sip:1002 at 41.34.123.243:58881>;ob
   Max-Forwards: 70
   From: <sip:1002 at 78.138.90.58>;tag=06cD4U6754yrN




   To: <sip:1002 at 78.138.90.58>
   Call-ID: 91100602-2099-1230-8985-00163e6bb553
   CSeq: 28614680 NOTIFY
   Contact: <sip:mod_sofia at 78.138.90.58:6090>




   User-Agent: FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47 +0000
   Allow: INVITE, ACK, BYE, CANCEL, OPTIONS, MESSAGE, UPDATE, INFO, REGISTER, REFER, NOTIFY, PUBLISH, SUBSCRIBE
   Supported: timer, precondition, path, replaces




   Event: message-summary
   Allow-Events: talk, hold, presence, dialog, line-seize, call-info, sla, include-session-description, presence.winfo, message-summary, refer
   Subscription-State: terminated;reason=noresource




   Content-Type:
 application/simple-message-summary
   Content-Length: 91
   
   Messages-Waiting: yes
   Message-Account: sip:1002 at 78.138.90.58



   Voice-Message: 1/0 (0/0)

   
   ------------------------------------------------------------------------
recv 308 bytes from udp/[41.34.123.243]:58881 at 23:18:09.773629:
   ------------------------------------------------------------------------




   SIP/2.0 200 OK
   Via: SIP/2.0/UDP 78.138.90.58:6090;rport=6090;received=78.138.90.58;branch=z9hG4bKc8Z1j4FQDgy2a
   Call-ID: 91100602-2099-1230-8985-00163e6bb553
   From: <sip:1002 at 78.138.90.58>;tag=06cD4U6754yrN




   To: <sip:1002 at 78.138.90.58>;tag=z9hG4bKc8Z1j4FQDgy2a
   CSeq: 28614680 NOTIFY
   Content-Length:  0
   
  
 ------------------------------------------------------------------------
recv 564 bytes from udp/[41.34.123.243]:58881 at 23:23:04.522455:
   ------------------------------------------------------------------------




   REGISTER sip:sip.pcfone.com:6090 SIP/2.0
   Via: SIP/2.0/UDP 192.168.178.26:58881;rport;branch=z9hG4bKPjaCuKyaBi6ZqcsHyp5HhH3WthJStom0SK
   Max-Forwards: 70




   From: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=qfUt1fQWuE-Ro3zWld6X0r6WidtD6B1q
   To: "Sherif 1003" <sip:1002 at sip.pcfone.com>




   Call-ID: ohCjnPIlf85DIrNvetdMy.1RQM-rLj4e
   CSeq: 60930 REGISTER
   User-Agent: Telephone 1.0.2
   Contact: "Sherif 1003" <sip:1002 at 192.168.178.26:58881;ob>
   Expires: 300
   Allow: PRACK, INVITE, ACK, BYE, CANCEL, UPDATE, SUBSCRIBE, NOTIFY, REFER, MESSAGE,
 OPTIONS
   Content-Length:  0
   
   ------------------------------------------------------------------------
send 744 bytes to udp/[41.34.123.243]:58881 at 23:23:04.523158:
   ------------------------------------------------------------------------




   SIP/2.0 401 Unauthorized
   Via: SIP/2.0/UDP 192.168.178.26:58881;rport=58881;branch=z9hG4bKPjaCuKyaBi6ZqcsHyp5HhH3WthJStom0SK;received=41.34.123.243
   From: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=qfUt1fQWuE-Ro3zWld6X0r6WidtD6B1q




   To: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=1F655pQB3DNBH
   Call-ID: ohCjnPIlf85DIrNvetdMy.1RQM-rLj4e



   CSeq: 60930 REGISTER

   User-Agent: FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47 +0000
   Allow: INVITE, ACK, BYE, CANCEL, OPTIONS, MESSAGE, UPDATE, INFO, REGISTER, REFER,
 NOTIFY, PUBLISH, SUBSCRIBE
   Supported: timer, precondition, path, replaces
   WWW-Authenticate: Digest realm="sip.pcfone.com", nonce="699cfe2a-a5f7-11e1-a83e-7b1f73a7ffcf", algorithm=MD5, qop="auth"




   Content-Length: 0
   
   ------------------------------------------------------------------------
recv 830 bytes from udp/[41.34.123.243]:58881 at 23:23:04.757798:
   ------------------------------------------------------------------------




   REGISTER sip:sip.pcfone.com:6090 SIP/2.0
   Via: SIP/2.0/UDP 192.168.178.26:58881;rport;branch=z9hG4bKPjs8SAufeoyzCLrePaAbYhZuOqQF47XIc-
   Max-Forwards: 70




   From: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=qfUt1fQWuE-Ro3zWld6X0r6WidtD6B1q
   To: "Sherif 1003" <sip:1002 at sip.pcfone.com>




   Call-ID:
 ohCjnPIlf85DIrNvetdMy.1RQM-rLj4e
   CSeq: 60931 REGISTER
   User-Agent: Telephone 1.0.2
   Contact: "Sherif 1003" <sip:1002 at 192.168.178.26:58881;ob>
   Expires: 300
   Allow: PRACK, INVITE, ACK, BYE, CANCEL, UPDATE, SUBSCRIBE, NOTIFY, REFER, MESSAGE, OPTIONS




   Authorization: Digest username="1002", realm="sip.pcfone.com", nonce="699cfe2a-a5f7-11e1-a83e-7b1f73a7ffcf", uri="sip:sip.pcfone.com:6090", response="23a886934aaf049f08432b6bb226bd37", algorithm=MD5, cnonce="sc3AJfhuev18Bs-L-6tORmI.RXlxnPOz", qop=auth, nc=00000001




   Content-Length:  0
   
   ------------------------------------------------------------------------
send 706 bytes to udp/[41.34.123.243]:58881 at 23:23:04.759924:
   ------------------------------------------------------------------------




   SIP/2.0 200 OK
   Via:
 SIP/2.0/UDP 192.168.178.26:58881;rport=58881;branch=z9hG4bKPjs8SAufeoyzCLrePaAbYhZuOqQF47XIc-;received=41.34.123.243
   From: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=qfUt1fQWuE-Ro3zWld6X0r6WidtD6B1q




   To: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=2rZy7H8e0pByc
   Call-ID: ohCjnPIlf85DIrNvetdMy.1RQM-rLj4e



   CSeq: 60931 REGISTER

   Contact: <sip:1002 at 192.168.178.26:58881;ob>;expires=300
   Date: Thu, 24 May 2012 23:23:04 GMT
   User-Agent: FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47 +0000
   Allow: INVITE, ACK, BYE, CANCEL, OPTIONS, MESSAGE, UPDATE, INFO, REGISTER, REFER, NOTIFY, PUBLISH, SUBSCRIBE




   Supported: timer, precondition, path, replaces
   Content-Length: 0
   
   ------------------------------------------------------------------------
send 989
 bytes to udp/[41.34.123.243]:58881 at 23:23:04.872728:
   ------------------------------------------------------------------------
   NOTIFY sip:1002 at 192.168.178.26:58881;ob SIP/2.0
   Via: SIP/2.0/UDP 78.138.90.58:6090;rport;branch=z9hG4bKDHStmZ0taSmNp




   Route: <sip:1002 at 41.34.123.243:58881>;ob
   Max-Forwards: 70
   From: <sip:1002 at 78.138.90.58>;tag=31rQ9cSjXZ1gr




   To: <sip:1002 at 78.138.90.58>
   Call-ID: 4130a1ce-209a-1230-8985-00163e6bb553
   CSeq: 28614828 NOTIFY
   Contact: <sip:mod_sofia at 78.138.90.58:6090>




   User-Agent: FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47 +0000
   Allow: INVITE, ACK, BYE, CANCEL, OPTIONS, MESSAGE, UPDATE, INFO, REGISTER, REFER, NOTIFY, PUBLISH, SUBSCRIBE
   Supported: timer, precondition, path,
 replaces
   Event: message-summary
   Allow-Events: talk, hold, presence, dialog, line-seize, call-info, sla, include-session-description, presence.winfo, message-summary, refer
   Subscription-State: terminated;reason=noresource




   Content-Type: application/simple-message-summary
   Content-Length: 91
   
   Messages-Waiting: yes
   Message-Account: sip:1002 at 78.138.90.58




   Voice-Message: 1/0 (0/0)
   
   ------------------------------------------------------------------------
recv 308 bytes from udp/[41.34.123.243]:58881 at 23:23:05.269063:
   ------------------------------------------------------------------------




   SIP/2.0 200 OK
   Via: SIP/2.0/UDP 78.138.90.58:6090;rport=6090;received=78.138.90.58;branch=z9hG4bKDHStmZ0taSmNp
   Call-ID:
 4130a1ce-209a-1230-8985-00163e6bb553
   From: <sip:1002 at 78.138.90.58>;tag=31rQ9cSjXZ1gr
   To: <sip:1002 at 78.138.90.58>;tag=z9hG4bKDHStmZ0taSmNp




   CSeq: 28614828 NOTIFY
   Content-Length:  0
   
   ------------------------------------------------------------------------
send 916 bytes to udp/[217.74.179.29]:5060 at 23:25:45.873423:
   ------------------------------------------------------------------------




   REGISTER sip:bluesip.net;transport=udp SIP/2.0
   Via: SIP/2.0/UDP 78.138.90.58:6090;rport;branch=z9hG4bKetjKptHy71a8H
   Max-Forwards: 70
   From: <sip:bluesip/sherifomran at bluesip.net;transport=udp>;tag=6r0vBQZS650Fg




   To: <sip:bluesip/sherifomran at bluesip.net;transport=udp>
   Call-ID: 2a3e4696-a5b9-11e1-a7ed-7b1f73a7ffcf
   CSeq:
 28601493 REGISTER
   Contact: <sip:gw+trunk_1000 at 78.138.90.58:6090;transport=udp;gw=trunk_1000>
   Expires: 3600
   User-Agent: FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47 +0000
   Allow: INVITE, ACK, BYE, CANCEL, OPTIONS, MESSAGE, UPDATE, INFO, REGISTER, REFER, NOTIFY, PUBLISH, SUBSCRIBE




   Supported: timer, precondition, path, replaces
   Authorization: Digest username="bluesip/sherifomran", realm="bluesip.net", nonce="4fbeba4ebfb7414d5c701bd6f994402d551f3acf", algorithm=MD5, uri="sip:bluesip.net;transport=udp", response="c6cdcafe0418e519bc9ee0d8fa3d4d74"




   Content-Length: 0
   
   ------------------------------------------------------------------------
recv 722 bytes from udp/[217.74.179.29]:5060 at 23:25:45.904176:
  
 ------------------------------------------------------------------------
   SIP/2.0 401 Unauthorized
   Via: SIP/2.0/UDP 78.138.90.58:6090;rport=6090;branch=z9hG4bKetjKptHy71a8H
   From: <sip:bluesip/sherifomran at bluesip.net;transport=udp>;tag=6r0vBQZS650Fg




   To: <sip:bluesip/sherifomran at bluesip.net;transport=udp>;tag=0354a2e1b960c9cc2279eca4e5f84e20.1b16
   Call-ID: 2a3e4696-a5b9-11e1-a7ed-7b1f73a7ffcf




   CSeq: 28601493 REGISTER
   WWW-Authenticate: Digest realm="bluesip.net", nonce="4fbec4a4ba82d1f1feaa32ccec01b85be054fcf7", stale=true



   Server: Sip EXpress router (0.9.7 (i386/linux))

   Content-Length: 0
   Warning: 392 217.74.179.29:5060 "Noisy feedback tells:  pid=5455 req_src_ip=78.138.90.58 req_src_port=6090 in_uri=sip:bluesip.net;transport=udp out_uri=sip:bluesip.net;transport=udp
 via_cnt==1"
   
   ------------------------------------------------------------------------
send 916 bytes to udp/[217.74.179.29]:5060 at 23:25:45.904416:
   ------------------------------------------------------------------------




   REGISTER sip:bluesip.net;transport=udp SIP/2.0
   Via: SIP/2.0/UDP 78.138.90.58:6090;rport;branch=z9hG4bKF3BcrN214a1tD
   Max-Forwards: 70
   From: <sip:bluesip/sherifomran at bluesip.net;transport=udp>;tag=6r0vBQZS650Fg




   To: <sip:bluesip/sherifomran at bluesip.net;transport=udp>
   Call-ID: 2a3e4696-a5b9-11e1-a7ed-7b1f73a7ffcf
   CSeq: 28601494 REGISTER



   Contact: <sip:gw+trunk_1000 at 78.138.90.58:6090;transport=udp;gw=trunk_1000>

   Expires: 3600
   User-Agent: FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47
 +0000
   Allow: INVITE, ACK, BYE, CANCEL, OPTIONS, MESSAGE, UPDATE, INFO, REGISTER, REFER, NOTIFY, PUBLISH, SUBSCRIBE
   Supported: timer, precondition, path, replaces
   Authorization: Digest username="bluesip/sherifomran", realm="bluesip.net", nonce="4fbec4a4ba82d1f1feaa32ccec01b85be054fcf7", algorithm=MD5, uri="sip:bluesip.net;transport=udp", response="4c09dbe4b9accb52d4104b40dfe20040"




   Content-Length: 0
   
   ------------------------------------------------------------------------
recv 699 bytes from udp/[217.74.179.29]:5060 at 23:25:45.935046:
   ------------------------------------------------------------------------




   SIP/2.0 200 OK
   Via: SIP/2.0/UDP 78.138.90.58:6090;rport=6090;branch=z9hG4bKF3BcrN214a1tD
   From: <sip:bluesip/sherifomran at bluesip.net;transport=udp>;tag=6r0vBQZS650Fg




   To:
 <sip:bluesip/sherifomran at bluesip.net;transport=udp>;tag=0354a2e1b960c9cc2279eca4e5f84e20.2017
   Call-ID: 2a3e4696-a5b9-11e1-a7ed-7b1f73a7ffcf



   CSeq: 28601494 REGISTER

   Contact: <sip:gw+trunk_1000 at 78.138.90.58:6090;transport=udp;gw=trunk_1000>;q=0.5;expires=3600
   Server: Sip EXpress router (0.9.7 (i386/linux))
   Content-Length: 0
   Warning: 392 217.74.179.29:5060 "Noisy feedback tells:  pid=5462 req_src_ip=78.138.90.58 req_src_port=6090 in_uri=sip:bluesip.net;transport=udp out_uri=sip:bluesip.net;transport=udp via_cnt==1"




   
   ------------------------------------------------------------------------
recv 564 bytes from udp/[41.34.123.243]:58881 at 23:27:59.977057:
   ------------------------------------------------------------------------




   REGISTER sip:sip.pcfone.com:6090 SIP/2.0
  
 Via: SIP/2.0/UDP 192.168.178.26:58881;rport;branch=z9hG4bKPjEOP.a4NoXqoFqC7a.k2tyeX-mYlUyH4H
   Max-Forwards: 70
   From: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=FYtvWBFYne8l.-.5Q6JgnCajTtrXQY-K




   To: "Sherif 1003" <sip:1002 at sip.pcfone.com>
   Call-ID: ohCjnPIlf85DIrNvetdMy.1RQM-rLj4e
   CSeq: 60932 REGISTER



   User-Agent: Telephone 1.0.2

   Contact: "Sherif 1003" <sip:1002 at 192.168.178.26:58881;ob>
   Expires: 300
   Allow: PRACK, INVITE, ACK, BYE, CANCEL, UPDATE, SUBSCRIBE, NOTIFY, REFER, MESSAGE, OPTIONS
   Content-Length:  0




   
   ------------------------------------------------------------------------
send 744 bytes to udp/[41.34.123.243]:58881 at 23:27:59.977960:
  
 ------------------------------------------------------------------------
   SIP/2.0 401 Unauthorized
   Via: SIP/2.0/UDP 192.168.178.26:58881;rport=58881;branch=z9hG4bKPjEOP.a4NoXqoFqC7a.k2tyeX-mYlUyH4H;received=41.34.123.243




   From: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=FYtvWBFYne8l.-.5Q6JgnCajTtrXQY-K
   To: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=4ajgB89Nt8Q3K




   Call-ID: ohCjnPIlf85DIrNvetdMy.1RQM-rLj4e
   CSeq: 60932 REGISTER
   User-Agent: FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47 +0000
   Allow: INVITE, ACK, BYE, CANCEL, OPTIONS, MESSAGE, UPDATE, INFO, REGISTER, REFER, NOTIFY, PUBLISH, SUBSCRIBE




   Supported: timer, precondition, path, replaces
   WWW-Authenticate: Digest realm="sip.pcfone.com", nonce="19b7cc40-a5f8-11e1-a83f-7b1f73a7ffcf", algorithm=MD5,
 qop="auth"
   Content-Length: 0
   
   ------------------------------------------------------------------------
recv 564 bytes from udp/[41.34.123.243]:58881 at 23:28:00.468487:
   ------------------------------------------------------------------------




   REGISTER sip:sip.pcfone.com:6090 SIP/2.0
   Via: SIP/2.0/UDP 192.168.178.26:58881;rport;branch=z9hG4bKPjEOP.a4NoXqoFqC7a.k2tyeX-mYlUyH4H
   Max-Forwards: 70




   From: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=FYtvWBFYne8l.-.5Q6JgnCajTtrXQY-K
   To: "Sherif 1003" <sip:1002 at sip.pcfone.com>




   Call-ID: ohCjnPIlf85DIrNvetdMy.1RQM-rLj4e
   CSeq: 60932 REGISTER
   User-Agent: Telephone 1.0.2
   Contact: "Sherif 1003" <sip:1002 at 192.168.178.26:58881;ob>
   Expires: 300
   Allow: PRACK, INVITE,
 ACK, BYE, CANCEL, UPDATE, SUBSCRIBE, NOTIFY, REFER, MESSAGE, OPTIONS
   Content-Length:  0
   
   ------------------------------------------------------------------------
send 744 bytes to udp/[41.34.123.243]:58881 at 23:28:00.468679:




   ------------------------------------------------------------------------
   SIP/2.0 401 Unauthorized
   Via: SIP/2.0/UDP 192.168.178.26:58881;rport=58881;branch=z9hG4bKPjEOP.a4NoXqoFqC7a.k2tyeX-mYlUyH4H;received=41.34.123.243




   From: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=FYtvWBFYne8l.-.5Q6JgnCajTtrXQY-K
   To: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=4ajgB89Nt8Q3K




   Call-ID: ohCjnPIlf85DIrNvetdMy.1RQM-rLj4e
   CSeq: 60932 REGISTER
   User-Agent: FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47 +0000
   Allow: INVITE, ACK,
 BYE, CANCEL, OPTIONS, MESSAGE, UPDATE, INFO, REGISTER, REFER, NOTIFY, PUBLISH, SUBSCRIBE
   Supported: timer, precondition, path, replaces
   WWW-Authenticate: Digest realm="sip.pcfone.com", nonce="19b7cc40-a5f8-11e1-a83f-7b1f73a7ffcf", algorithm=MD5, qop="auth"




   Content-Length: 0
   
   ------------------------------------------------------------------------
recv 830 bytes from udp/[41.34.123.243]:58881 at 23:28:00.717446:
   ------------------------------------------------------------------------




   REGISTER sip:sip.pcfone.com:6090 SIP/2.0
   Via: SIP/2.0/UDP 192.168.178.26:58881;rport;branch=z9hG4bKPj0iHd3-XUjnvcBs9DiJUCWzrmYTmWxFLt
   Max-Forwards: 70




   From: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=FYtvWBFYne8l.-.5Q6JgnCajTtrXQY-K
   To: "Sherif 1003"
 <sip:1002 at sip.pcfone.com>
   Call-ID: ohCjnPIlf85DIrNvetdMy.1RQM-rLj4e
   CSeq: 60933 REGISTER
   User-Agent: Telephone 1.0.2



   Contact: "Sherif 1003" <sip:1002 at 192.168.178.26:58881;ob>

   Expires: 300
   Allow: PRACK, INVITE, ACK, BYE, CANCEL, UPDATE, SUBSCRIBE, NOTIFY, REFER, MESSAGE, OPTIONS
   Authorization: Digest username="1002", realm="sip.pcfone.com", nonce="19b7cc40-a5f8-11e1-a83f-7b1f73a7ffcf", uri="sip:sip.pcfone.com:6090", response="e21c903e6d98b5adcdd2eefa75217157", algorithm=MD5, cnonce="sc3AJfhuev18Bs-L-6tORmI.RXlxnPOz", qop=auth, nc=00000001




   Content-Length:  0
   
   ------------------------------------------------------------------------
send 706 bytes to udp/[41.34.123.243]:58881 at 23:28:00.719947:
  
 ------------------------------------------------------------------------
   SIP/2.0 200 OK
   Via: SIP/2.0/UDP 192.168.178.26:58881;rport=58881;branch=z9hG4bKPj0iHd3-XUjnvcBs9DiJUCWzrmYTmWxFLt;received=41.34.123.243




   From: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=FYtvWBFYne8l.-.5Q6JgnCajTtrXQY-K
   To: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=5KB9c3tSQHepF




   Call-ID: ohCjnPIlf85DIrNvetdMy.1RQM-rLj4e
   CSeq: 60933 REGISTER
   Contact: <sip:1002 at 192.168.178.26:58881;ob>;expires=300
   Date: Thu, 24 May 2012 23:28:00 GMT
   User-Agent: FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47 +0000




   Allow: INVITE, ACK, BYE, CANCEL, OPTIONS, MESSAGE, UPDATE, INFO, REGISTER, REFER, NOTIFY, PUBLISH, SUBSCRIBE
   Supported: timer, precondition, path, replaces
  
 Content-Length: 0
   
   ------------------------------------------------------------------------
send 989 bytes to udp/[41.34.123.243]:58881 at 23:28:00.868368:
   ------------------------------------------------------------------------




   NOTIFY sip:1002 at 192.168.178.26:58881;ob SIP/2.0
   Via: SIP/2.0/UDP 78.138.90.58:6090;rport;branch=z9hG4bKgc54SgK51KQDS
   Route: <sip:1002 at 41.34.123.243:58881>;ob




   Max-Forwards: 70
   From: <sip:1002 at 78.138.90.58>;tag=6v41eyBXmt48a
   To: <sip:1002 at 78.138.90.58>




   Call-ID: f19dfbce-209a-1230-8985-00163e6bb553
   CSeq: 28614976 NOTIFY
   Contact: <sip:mod_sofia at 78.138.90.58:6090>
   User-Agent: FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47 +0000




   Allow: INVITE, ACK, BYE, CANCEL, OPTIONS,
 MESSAGE, UPDATE, INFO, REGISTER, REFER, NOTIFY, PUBLISH, SUBSCRIBE
   Supported: timer, precondition, path, replaces
   Event: message-summary
   Allow-Events: talk, hold, presence, dialog, line-seize, call-info, sla, include-session-description, presence.winfo, message-summary, refer




   Subscription-State: terminated;reason=noresource
   Content-Type: application/simple-message-summary
   Content-Length: 91
   
   Messages-Waiting: yes
   Message-Account: sip:1002 at 78.138.90.58




   Voice-Message: 1/0 (0/0)
   
   ------------------------------------------------------------------------
recv 308 bytes from udp/[41.34.123.243]:58881 at 23:28:01.128279:
   ------------------------------------------------------------------------




   SIP/2.0 200 OK
   Via:
 SIP/2.0/UDP 78.138.90.58:6090;rport=6090;received=78.138.90.58;branch=z9hG4bKgc54SgK51KQDS
   Call-ID: f19dfbce-209a-1230-8985-00163e6bb553
   From: <sip:1002 at 78.138.90.58>;tag=6v41eyBXmt48a




   To: <sip:1002 at 78.138.90.58>;tag=z9hG4bKgc54SgK51KQDS
   CSeq: 28614976 NOTIFY
   Content-Length:  0
   
   ------------------------------------------------------------------------




send 913 bytes to udp/[217.74.179.29]:5060 at 23:28:11.885213:
   ------------------------------------------------------------------------
   REGISTER sip:bluesip.net;transport=udp SIP/2.0




   Via: SIP/2.0/UDP 78.138.90.58:6090;rport;branch=z9hG4bKHNyXUB48yvD0m
   Max-Forwards: 70
   From: <sip:bluesip/salahomran at bluesip.net;transport=udp>;tag=5F739Uep9vaXm




   To:
 <sip:bluesip/salahomran at bluesip.net;transport=udp>
   Call-ID: 2a3e49c0-a5b9-11e1-a7ee-7b1f73a7ffcf
   CSeq: 28601493 REGISTER



   Contact: <sip:gw+trunk_1002 at 78.138.90.58:6090;transport=udp;gw=trunk_1002>

   Expires: 3600
   User-Agent: FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47 +0000
   Allow: INVITE, ACK, BYE, CANCEL, OPTIONS, MESSAGE, UPDATE, INFO, REGISTER, REFER, NOTIFY, PUBLISH, SUBSCRIBE




   Supported: timer, precondition, path, replaces
   Authorization: Digest username="bluesip/salahomran", realm="bluesip.net", nonce="4fbebeca79a5cff7c417463814cb9054d313bcac", algorithm=MD5, uri="sip:bluesip.net;transport=udp", response="bb1babb90f4ea1dc8fbb9aa45d6038c7"




   Content-Length: 0
   
   ------------------------------------------------------------------------
recv 720 bytes
 from udp/[217.74.179.29]:5060 at 23:28:11.915764:
   ------------------------------------------------------------------------
   SIP/2.0 401 Unauthorized
   Via: SIP/2.0/UDP 78.138.90.58:6090;rport=6090;branch=z9hG4bKHNyXUB48yvD0m




   From: <sip:bluesip/salahomran at bluesip.net;transport=udp>;tag=5F739Uep9vaXm
   To: <sip:bluesip/salahomran at bluesip.net;transport=udp>;tag=0354a2e1b960c9cc2279eca4e5f84e20.3454




   Call-ID: 2a3e49c0-a5b9-11e1-a7ee-7b1f73a7ffcf
   CSeq: 28601493 REGISTER
   WWW-Authenticate: Digest realm="bluesip.net", nonce="4fbec5365af3a174f1cc0b8cda770c727d25bf71", stale=true




   Server: Sip EXpress router (0.9.7 (i386/linux))
   Content-Length: 0
   Warning: 392 217.74.179.29:5060 "Noisy feedback tells:  pid=5462 req_src_ip=78.138.90.58 req_src_port=6090
 in_uri=sip:bluesip.net;transport=udp out_uri=sip:bluesip.net;transport=udp via_cnt==1"



   
   ------------------------------------------------------------------------

send 913 bytes to udp/[217.74.179.29]:5060 at 23:28:11.915914:
   ------------------------------------------------------------------------
   REGISTER sip:bluesip.net;transport=udp SIP/2.0




   Via: SIP/2.0/UDP 78.138.90.58:6090;rport;branch=z9hG4bKjyQpX6mcv53jg
   Max-Forwards: 70
   From: <sip:bluesip/salahomran at bluesip.net;transport=udp>;tag=5F739Uep9vaXm




   To: <sip:bluesip/salahomran at bluesip.net;transport=udp>
   Call-ID: 2a3e49c0-a5b9-11e1-a7ee-7b1f73a7ffcf
   CSeq: 28601494 REGISTER



   Contact: <sip:gw+trunk_1002 at 78.138.90.58:6090;transport=udp;gw=trunk_1002>

   Expires: 3600
   User-Agent:
 FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47 +0000
   Allow: INVITE, ACK, BYE, CANCEL, OPTIONS, MESSAGE, UPDATE, INFO, REGISTER, REFER, NOTIFY, PUBLISH, SUBSCRIBE
   Supported: timer, precondition, path, replaces




   Authorization: Digest username="bluesip/salahomran", realm="bluesip.net", nonce="4fbec5365af3a174f1cc0b8cda770c727d25bf71", algorithm=MD5, uri="sip:bluesip.net;transport=udp", response="e260f6dc9b01ce8bea8c5ffb36bd4ddd"




   Content-Length: 0
   
   ------------------------------------------------------------------------
recv 697 bytes from udp/[217.74.179.29]:5060 at 23:28:11.946325:
   ------------------------------------------------------------------------




   SIP/2.0 200 OK
   Via: SIP/2.0/UDP 78.138.90.58:6090;rport=6090;branch=z9hG4bKjyQpX6mcv53jg
   From:
 <sip:bluesip/salahomran at bluesip.net;transport=udp>;tag=5F739Uep9vaXm
   To: <sip:bluesip/salahomran at bluesip.net;transport=udp>;tag=0354a2e1b960c9cc2279eca4e5f84e20.4b5c




   Call-ID: 2a3e49c0-a5b9-11e1-a7ee-7b1f73a7ffcf
   CSeq: 28601494 REGISTER
   Contact: <sip:gw+trunk_1002 at 78.138.90.58:6090;transport=udp;gw=trunk_1002>;q=0.5;expires=3600
   Server: Sip EXpress router (0.9.7 (i386/linux))




   Content-Length: 0
   Warning: 392 217.74.179.29:5060 "Noisy feedback tells:  pid=5455 req_src_ip=78.138.90.58 req_src_port=6090 in_uri=sip:bluesip.net;transport=udp out_uri=sip:bluesip.net;transport=udp via_cnt==1"




   
   ------------------------------------------------------------------------
recv 564 bytes from udp/[41.34.123.243]:58881 at 23:32:55.930149:
  
 ------------------------------------------------------------------------
   REGISTER sip:sip.pcfone.com:6090 SIP/2.0
   Via: SIP/2.0/UDP 192.168.178.26:58881;rport;branch=z9hG4bKPjuk8DZGiaXfN7BmtslNHVjtSg5UXsbHXc




   Max-Forwards: 70
   From: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=Pz.t-0tGXj3saM.ehBiB1EAMmmitze1D



   To: "Sherif 1003" <sip:1002 at sip.pcfone.com>

   Call-ID: ohCjnPIlf85DIrNvetdMy.1RQM-rLj4e
   CSeq: 60934 REGISTER
   User-Agent: Telephone 1.0.2
   Contact: "Sherif 1003" <sip:1002 at 192.168.178.26:58881;ob>
   Expires: 300
   Allow: PRACK, INVITE, ACK, BYE, CANCEL, UPDATE, SUBSCRIBE, NOTIFY, REFER, MESSAGE, OPTIONS




   Content-Length:  0
   
   ------------------------------------------------------------------------
send 744 bytes to
 udp/[41.34.123.243]:58881 at 23:32:55.931324:
   ------------------------------------------------------------------------
   SIP/2.0 401 Unauthorized
   Via: SIP/2.0/UDP 192.168.178.26:58881;rport=58881;branch=z9hG4bKPjuk8DZGiaXfN7BmtslNHVjtSg5UXsbHXc;received=41.34.123.243




   From: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=Pz.t-0tGXj3saM.ehBiB1EAMmmitze1D
   To: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=75XtgSv0H3tUp




   Call-ID: ohCjnPIlf85DIrNvetdMy.1RQM-rLj4e
   CSeq: 60934 REGISTER
   User-Agent: FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47 +0000
   Allow: INVITE, ACK, BYE, CANCEL, OPTIONS, MESSAGE, UPDATE, INFO, REGISTER, REFER, NOTIFY, PUBLISH, SUBSCRIBE




   Supported: timer, precondition, path, replaces
   WWW-Authenticate: Digest realm="sip.pcfone.com",
 nonce="ca1eabee-a5f8-11e1-a840-7b1f73a7ffcf", algorithm=MD5, qop="auth"
   Content-Length: 0
   
   ------------------------------------------------------------------------
recv 830 bytes from udp/[41.34.123.243]:58881 at 23:32:56.165624:




   ------------------------------------------------------------------------
   REGISTER sip:sip.pcfone.com:6090 SIP/2.0
   Via: SIP/2.0/UDP 192.168.178.26:58881;rport;branch=z9hG4bKPjKEQ6xXmyzZxA6vCM88vHNYAOPAjUqFsD




   Max-Forwards: 70
   From: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=Pz.t-0tGXj3saM.ehBiB1EAMmmitze1D



   To: "Sherif 1003" <sip:1002 at sip.pcfone.com>

   Call-ID: ohCjnPIlf85DIrNvetdMy.1RQM-rLj4e
   CSeq: 60935 REGISTER
   User-Agent: Telephone 1.0.2
   Contact: "Sherif 1003"
 <sip:1002 at 192.168.178.26:58881;ob>
   Expires: 300
   Allow: PRACK, INVITE, ACK, BYE, CANCEL, UPDATE, SUBSCRIBE, NOTIFY, REFER, MESSAGE, OPTIONS
   Authorization: Digest username="1002", realm="sip.pcfone.com", nonce="ca1eabee-a5f8-11e1-a840-7b1f73a7ffcf", uri="sip:sip.pcfone.com:6090", response="ff6d12f4ec7abd4b37187222b3af2358", algorithm=MD5, cnonce="sc3AJfhuev18Bs-L-6tORmI.RXlxnPOz", qop=auth, nc=00000001




   Content-Length:  0
   
   ------------------------------------------------------------------------
send 706 bytes to udp/[41.34.123.243]:58881 at 23:32:56.168033:
   ------------------------------------------------------------------------




   SIP/2.0 200 OK
   Via: SIP/2.0/UDP 192.168.178.26:58881;rport=58881;branch=z9hG4bKPjKEQ6xXmyzZxA6vCM88vHNYAOPAjUqFsD;received=41.34.123.243
   From: "Sherif 1003"
 <sip:1002 at sip.pcfone.com>;tag=Pz.t-0tGXj3saM.ehBiB1EAMmmitze1D
   To: "Sherif 1003" <sip:1002 at sip.pcfone.com>;tag=8eQKjmD4ecHej




   Call-ID: ohCjnPIlf85DIrNvetdMy.1RQM-rLj4e
   CSeq: 60935 REGISTER
   Contact: <sip:1002 at 192.168.178.26:58881;ob>;expires=300
   Date: Thu, 24 May 2012 23:32:56 GMT
   User-Agent: FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47 +0000




   Allow: INVITE, ACK, BYE, CANCEL, OPTIONS, MESSAGE, UPDATE, INFO, REGISTER, REFER, NOTIFY, PUBLISH, SUBSCRIBE
   Supported: timer, precondition, path, replaces
   Content-Length: 0
   
   ------------------------------------------------------------------------




send 989 bytes to udp/[41.34.123.243]:58881 at 23:32:56.360238:
  
 ------------------------------------------------------------------------
   NOTIFY sip:1002 at 192.168.178.26:58881;ob SIP/2.0
   Via: SIP/2.0/UDP 78.138.90.58:6090;rport;branch=z9hG4bKK7gFZ15FSet5B
   Route: <sip:1002 at 41.34.123.243:58881>;ob




   Max-Forwards: 70
   From: <sip:1002 at 78.138.90.58>;tag=9QgcmFy7BN70D
   To: <sip:1002 at 78.138.90.58>




   Call-ID: a1be7708-209b-1230-8985-00163e6bb553
   CSeq: 28615124 NOTIFY
   Contact: <sip:mod_sofia at 78.138.90.58:6090>
   User-Agent: FreeSWITCH-mod_sofia/1.1.beta1-git-8edfd01 2012-03-24 05-16-47 +0000




   Allow: INVITE, ACK, BYE, CANCEL, OPTIONS, MESSAGE, UPDATE, INFO, REGISTER, REFER, NOTIFY, PUBLISH, SUBSCRIBE
   Supported: timer, precondition, path, replaces
   Event: message-summary
   Allow-Events: talk,
 hold, presence, dialog, line-seize, call-info, sla, include-session-description, presence.winfo, message-summary, refer
   Subscription-State: terminated;reason=noresource
   Content-Type: application/simple-message-summary




   Content-Length: 91
   
   Messages-Waiting: yes
   Message-Account: sip:1002 at 78.138.90.58
   Voice-Message: 1/0 (0/0)



   
   ------------------------------------------------------------------------

recv 308 bytes from udp/[41.34.123.243]:58881 at 23:32:56.623554:
   ------------------------------------------------------------------------
   SIP/2.0 200 OK
   Via: SIP/2.0/UDP 78.138.90.58:6090;rport=6090;received=78.138.90.58;branch=z9hG4bKK7gFZ15FSet5B




   Call-ID: a1be7708-209b-1230-8985-00163e6bb553
   From:
 <sip:1002 at 78.138.90.58>;tag=9QgcmFy7BN70D
   To: <sip:1002 at 78.138.90.58>;tag=z9hG4bKK7gFZ15FSet5B




   CSeq: 28615124 NOTIFY
   Content-Length:  0
   
   ------------------------------------------------------------------------
freeswitch at internal> 


--- On Thu, 5/24/12, Kristian Kielhofner <kris at kriskinc.com> wrote:





From: Kristian Kielhofner <kris at kriskinc.com>



Subject: Re: [Freeswitch-users] Freeswitch (SBC + Media) does not know that gateway phone is picked up

To: "FreeSWITCH Users Help" <freeswitch-users at lists.freeswitch.org>
Date: Thursday, May 24, 2012, 7:51 PM





Siptrace and logs please.

On Thu, May 24, 2012 at 11:53 AM, Sherif Omran
<sherifomran2000 at yahoo.com> wrote:



>

> Hi all,
>
> My topology is as follows:
>
> Kamailio  -> FS (SBS+Media server)
>
> I came across an issue with my system as follows.  I have a Hardphone registered. When I do local call inside kamailio, it gets to FS and returns back well and FS understands when I lift the handset. However, I added a gateway (german landline server), when I call my self from another phone, the call gets to FS and then transmits to Kamailio, it rings my extension but when I lift the handset FS does not notice it and keeps ringing.




>
> Any body has an Idea? Here is my gateway trunk.
>
> <include>
>         <gateway name="trunk_1000">
>         <param
 name="realm" value="bluesip.net"/>
>         <param name="username" value="bluesip/xxxxxx"/>
>         <param name="register" value="true"/>




>         <param name="extension" value="kb-1002"/>
>       </gateway>
> </include>
>
> thanks in advance
> Sherif Omran
>
>
> _________________________________________________________________________




> Professional FreeSWITCH Consulting Services:
> consulting at freeswitch.org
> http://www.freeswitchsolutions.com




>
> 
> 
>
> Official FreeSWITCH Sites
> http://www.freeswitch.org




> http://wiki.freeswitch.org
> http://www.cluecon.com
>
> Join Us At ClueCon - Aug 7-9, 2012




>
> FreeSWITCH-users mailing list
> FreeSWITCH-users at lists.freeswitch.org
> http://lists.freeswitch.org/mailman/listinfo/freeswitch-users




> UNSUBSCRIBE:http://lists.freeswitch.org/mailman/options/freeswitch-users
> http://www.freeswitch.org




>



--
Kristian Kielhofner

_________________________________________________________________________
Professional FreeSWITCH Consulting Services:
consulting at freeswitch.org




http://www.freeswitchsolutions.com








Official FreeSWITCH Sites
http://www.freeswitch.org
http://wiki.freeswitch.org



http://www.cluecon.com


Join Us At ClueCon - Aug 7-9, 2012

FreeSWITCH-users mailing list
FreeSWITCH-users at lists.freeswitch.org



http://lists.freeswitch.org/mailman/listinfo/freeswitch-users

UNSUBSCRIBE:http://lists.freeswitch.org/mailman/options/freeswitch-users
http://www.freeswitch.org





_________________________________________________________________________

Professional FreeSWITCH Consulting Services:

consulting at freeswitch.org

http://www.freeswitchsolutions.com









Official FreeSWITCH Sites

http://www.freeswitch.org

http://wiki.freeswitch.org

http://www.cluecon.com



Join Us At ClueCon - Aug 7-9, 2012



FreeSWITCH-users mailing list

FreeSWITCH-users at lists.freeswitch.org

http://lists.freeswitch.org/mailman/listinfo/freeswitch-users

UNSUBSCRIBE:http://lists.freeswitch.org/mailman/options/freeswitch-users

http://www.freeswitch.org





-----Inline Attachment Follows-----

_________________________________________________________________________
Professional FreeSWITCH Consulting Services:
consulting at freeswitch.org



http://www.freeswitchsolutions.com







Official FreeSWITCH Sites
http://www.freeswitch.org
http://wiki.freeswitch.org


http://www.cluecon.com


Join Us At ClueCon - Aug 7-9, 2012

FreeSWITCH-users mailing list
FreeSWITCH-users at lists.freeswitch.org


http://lists.freeswitch.org/mailman/listinfo/freeswitch-users

UNSUBSCRIBE:http://lists.freeswitch.org/mailman/options/freeswitch-users
http://www.freeswitch.org




_________________________________________________________________________

Professional FreeSWITCH Consulting Services:

consulting at freeswitch.org

http://www.freeswitchsolutions.com









Official FreeSWITCH Sites

http://www.freeswitch.org

http://wiki.freeswitch.org

http://www.cluecon.com



Join Us At ClueCon - Aug 7-9, 2012



FreeSWITCH-users mailing list

FreeSWITCH-users at lists.freeswitch.org

http://lists.freeswitch.org/mailman/listinfo/freeswitch-users

UNSUBSCRIBE:http://lists.freeswitch.org/mailman/options/freeswitch-users

http://www.freeswitch.org





-----Inline Attachment Follows-----

_________________________________________________________________________
Professional FreeSWITCH Consulting Services:
consulting at freeswitch.org


http://www.freeswitchsolutions.com






Official FreeSWITCH Sites
http://www.freeswitch.org
http://wiki.freeswitch.org

http://www.cluecon.com


Join Us At ClueCon - Aug 7-9, 2012

FreeSWITCH-users mailing list
FreeSWITCH-users at lists.freeswitch.org

http://lists.freeswitch.org/mailman/listinfo/freeswitch-users

UNSUBSCRIBE:http://lists.freeswitch.org/mailman/options/freeswitch-users
http://www.freeswitch.org



_________________________________________________________________________

Professional FreeSWITCH Consulting Services:

consulting at freeswitch.org

http://www.freeswitchsolutions.com









Official FreeSWITCH Sites

http://www.freeswitch.org

http://wiki.freeswitch.org

http://www.cluecon.com



Join Us At ClueCon - Aug 7-9, 2012



FreeSWITCH-users mailing list

FreeSWITCH-users at lists.freeswitch.org

http://lists.freeswitch.org/mailman/listinfo/freeswitch-users

UNSUBSCRIBE:http://lists.freeswitch.org/mailman/options/freeswitch-users

http://www.freeswitch.org





-----Inline Attachment Follows-----

_________________________________________________________________________
Professional FreeSWITCH Consulting Services:
consulting at freeswitch.org

http://www.freeswitchsolutions.com





Official FreeSWITCH Sites
http://www.freeswitch.org
http://wiki.freeswitch.org
http://www.cluecon.com


Join Us At ClueCon - Aug 7-9, 2012

FreeSWITCH-users mailing list
FreeSWITCH-users at lists.freeswitch.org
http://lists.freeswitch.org/mailman/listinfo/freeswitch-users

UNSUBSCRIBE:http://lists.freeswitch.org/mailman/options/freeswitch-users
http://www.freeswitch.org


_________________________________________________________________________

Professional FreeSWITCH Consulting Services:

consulting at freeswitch.org

http://www.freeswitchsolutions.com









Official FreeSWITCH Sites

http://www.freeswitch.org

http://wiki.freeswitch.org

http://www.cluecon.com



Join Us At ClueCon - Aug 7-9, 2012



FreeSWITCH-users mailing list

FreeSWITCH-users at lists.freeswitch.org

http://lists.freeswitch.org/mailman/listinfo/freeswitch-users

UNSUBSCRIBE:http://lists.freeswitch.org/mailman/options/freeswitch-users

http://www.freeswitch.org





-----Inline Attachment Follows-----

_________________________________________________________________________
Professional FreeSWITCH Consulting Services:
consulting at freeswitch.org
http://www.freeswitchsolutions.com




Official FreeSWITCH Sites
http://www.freeswitch.org
http://wiki.freeswitch.org
http://www.cluecon.com

Join Us At ClueCon - Aug 7-9, 2012

FreeSWITCH-users mailing list
FreeSWITCH-users at lists.freeswitch.org
http://lists.freeswitch.org/mailman/listinfo/freeswitch-users
UNSUBSCRIBE:http://lists.freeswitch.org/mailman/options/freeswitch-users
http://www.freeswitch.org
-------------- next part --------------
An HTML attachment was scrubbed...
URL: http://lists.freeswitch.org/pipermail/freeswitch-users/attachments/20120527/0ae138a6/attachment-0001.html 


Join us at ClueCon 2011 Aug 9-11, 2011
More information about the FreeSWITCH-users mailing list