freeswitchforum.com

freeswitch@internal> 2014-04-11 10:52:46.476452 [NOTICE] switch_channel.c:1055 New Channel sofia/internal/22981 [656cfc7b-83d3-4a67-8314-9df
7f8665be9]
2014-04-11 10:52:46.476452 [DEBUG] switch_core_session.c:1037 Send signal sofia/internal/22981 [BREAK]
2014-04-11 10:52:46.476452 [DEBUG] switch_core_session.c:1037 Send signal sofia/internal/22981 [BREAK]
2014-04-11 10:52:46.476452 [DEBUG] switch_core_state_machine.c:467 (sofia/internal/22981) Running State Change CS_NEW
2014-04-11 10:52:46.476452 [DEBUG] switch_core_state_machine.c:485 (sofia/internal/22981) State NEW
2014-04-11 10:52:46.496453 [DEBUG] sofia.c:8020 IP 192.168.1.250 Approved by acl "domains[]". Access Granted.
2014-04-11 10:52:46.496453 [DEBUG] sofia.c:5861 Channel sofia/internal/22981 entering state [received][100]
2014-04-11 10:52:46.496453 [DEBUG] sofia.c:5871 Remote SDP:
v=0
o=- 609449 1 IN IP4 192.168.1.250
s=-
c=IN IP4 192.168.1.231
t=0 0
m=audio 5212 RTP/AVP 8 0 101 111
c=IN IP4 192.168.1.231
a=rtpmap:101 telephone-event/8000
a=fmtp:101 0-15
a=rtpmap:111 X-nt-inforeq/8000
a=ptime:20
a=maxptime:20

2014-04-11 10:52:46.496453 [DEBUG] sofia.c:6116 (sofia/internal/22981) State Change CS_NEW -> CS_INIT
2014-04-11 10:52:46.496453 [DEBUG] switch_core_session.c:1372 Send signal sofia/internal/22981 [BREAK]
2014-04-11 10:52:46.496453 [DEBUG] switch_core_state_machine.c:467 (sofia/internal/22981) Running State Change CS_INIT
2014-04-11 10:52:46.496453 [DEBUG] switch_core_state_machine.c:506 (sofia/internal/22981) State INIT
2014-04-11 10:52:46.496453 [DEBUG] mod_sofia.c:87 sofia/internal/22981 SOFIA INIT
2014-04-11 10:52:46.496453 [DEBUG] switch_core_state_machine.c:40 sofia/internal/22981 Standard INIT
2014-04-11 10:52:46.496453 [DEBUG] switch_core_state_machine.c:48 (sofia/internal/22981) State Change CS_INIT -> CS_ROUTING
2014-04-11 10:52:46.496453 [DEBUG] switch_core_session.c:1372 Send signal sofia/internal/22981 [BREAK]
2014-04-11 10:52:46.496453 [DEBUG] switch_core_state_machine.c:506 (sofia/internal/22981) State INIT going to sleep
2014-04-11 10:52:46.496453 [DEBUG] switch_core_state_machine.c:467 (sofia/internal/22981) Running State Change CS_ROUTING
2014-04-11 10:52:46.496453 [DEBUG] switch_channel.c:2178 (sofia/internal/22981) Callstate Change DOWN -> RINGING
2014-04-11 10:52:46.496453 [DEBUG] switch_core_state_machine.c:522 (sofia/internal/22981) State ROUTING
2014-04-11 10:52:46.496453 [DEBUG] mod_sofia.c:123 sofia/internal/22981 SOFIA ROUTING
2014-04-11 10:52:46.496453 [DEBUG] switch_core_state_machine.c:164 sofia/internal/22981 Standard ROUTING
2014-04-11 10:52:46.496453 [INFO] mod_dialplan_xml.c:558 Processing Sobolenkov A.V. <22981;phone-context=myCDPdomain.myUDPdomain.ru>->11531;
phone-context=myCDPdomain.myUDPdomain.ru in context public
Dialplan: sofia/internal/22981 parsing [public->unloop] continue=false
Dialplan: sofia/internal/22981 Regex (PASS) [unloop] ${unroll_loops}(true) =~ /^true$/ break=on-false
Dialplan: sofia/internal/22981 Regex (FAIL) [unloop] ${sip_looped_call}() =~ /^true$/ break=on-false
Dialplan: sofia/internal/22981 parsing [public->outside_call] continue=true
Dialplan: sofia/internal/22981 Absolute Condition [outside_call]
Dialplan: sofia/internal/22981 Action set(outside_call=true)
Dialplan: sofia/internal/22981 parsing [public->call_debug] continue=true
Dialplan: sofia/internal/22981 Regex (FAIL) [call_debug] ${call_debug}(false) =~ /^true$/ break=never
Dialplan: sofia/internal/22981 parsing [public->all_public_extensions] continue=false
Dialplan: sofia/internal/22981 Regex (FAIL) [all_public_extensions] destination_number(11531;phone-context=myCDPdomain.myUDPdomain.ru) =~ /^
(\*\d+)$/ break=on-false
Dialplan: sofia/internal/22981 parsing [public->all_public_extensions] continue=false
Dialplan: sofia/internal/22981 Regex (FAIL) [all_public_extensions] destination_number(11531;phone-context=myCDPdomain.myUDPdomain.ru) =~ /^
(\d+)$/ break=on-false
2014-04-11 10:52:46.496453 [DEBUG] switch_core_state_machine.c:214 (sofia/internal/22981) State Change CS_ROUTING -> CS_EXECUTE
2014-04-11 10:52:46.496453 [DEBUG] switch_core_session.c:1372 Send signal sofia/internal/22981 [BREAK]
2014-04-11 10:52:46.496453 [DEBUG] switch_core_state_machine.c:522 (sofia/internal/22981) State ROUTING going to sleep
2014-04-11 10:52:46.496453 [DEBUG] switch_core_state_machine.c:467 (sofia/internal/22981) Running State Change CS_EXECUTE
2014-04-11 10:52:46.496453 [DEBUG] switch_core_state_machine.c:529 (sofia/internal/22981) State EXECUTE
2014-04-11 10:52:46.496453 [DEBUG] mod_sofia.c:178 sofia/internal/22981 SOFIA EXECUTE
2014-04-11 10:52:46.496453 [DEBUG] switch_core_state_machine.c:256 sofia/internal/22981 Standard EXECUTE
EXECUTE sofia/internal/22981 set(outside_call=true)
2014-04-11 10:52:46.496453 [DEBUG] mod_dptools.c:1402 sofia/internal/22981 SET [outside_call]=[true]
2014-04-11 10:52:46.496453 [NOTICE] switch_core_state_machine.c:313 sofia/internal/22981 has executed the last dialplan instruction, hanging
 up.
2014-04-11 10:52:46.496453 [NOTICE] switch_core_state_machine.c:315 Hangup sofia/internal/22981 [CS_EXECUTE] [NORMAL_CLEARING]
2014-04-11 10:52:46.496453 [DEBUG] switch_channel.c:3211 Send signal sofia/internal/22981 [KILL]
2014-04-11 10:52:46.496453 [DEBUG] switch_core_session.c:1372 Send signal sofia/internal/22981 [BREAK]
2014-04-11 10:52:46.496453 [DEBUG] switch_core_state_machine.c:529 (sofia/internal/22981) State EXECUTE going to sleep
2014-04-11 10:52:46.496453 [DEBUG] switch_core_state_machine.c:467 (sofia/internal/22981) Running State Change CS_HANGUP
2014-04-11 10:52:46.496453 [DEBUG] switch_core_state_machine.c:730 (sofia/internal/22981) State HANGUP
2014-04-11 10:52:46.496453 [DEBUG] mod_sofia.c:413 Channel sofia/internal/22981 hanging up, cause: NORMAL_CLEARING
2014-04-11 10:52:46.496453 [DEBUG] mod_sofia.c:547 Responding to INVITE with: 480
2014-04-11 10:52:46.496453 [DEBUG] switch_core_state_machine.c:58 sofia/internal/22981 Standard HANGUP, cause: NORMAL_CLEARING
2014-04-11 10:52:46.496453 [DEBUG] switch_core_state_machine.c:730 (sofia/internal/22981) State HANGUP going to sleep
2014-04-11 10:52:46.496453 [DEBUG] switch_core_state_machine.c:743 (sofia/internal/22981) Callstate Change RINGING -> HANGUP
2014-04-11 10:52:46.496453 [DEBUG] switch_core_state_machine.c:498 (sofia/internal/22981) State Change CS_HANGUP -> CS_REPORTING
2014-04-11 10:52:46.496453 [DEBUG] switch_core_session.c:1372 Send signal sofia/internal/22981 [BREAK]
2014-04-11 10:52:46.496453 [DEBUG] switch_core_state_machine.c:467 (sofia/internal/22981) Running State Change CS_REPORTING
2014-04-11 10:52:46.496453 [DEBUG] switch_core_state_machine.c:815 (sofia/internal/22981) State REPORTING
2014-04-11 10:53:07.496655 [ERR] mod_xml_cdr.c:365 Got error [0] posting to web server [http://10.1.68.50/IPCP/Services/Cdr]
2014-04-11 10:53:07.496655 [ERR] mod_xml_cdr.c:372 Retry will be with url [http://10.1.68.50/IPCP/Services/Cdr]
2014-04-11 10:53:07.496655 [ERR] mod_xml_cdr.c:383 Unable to post to web server, writing to file
2014-04-11 10:53:07.496655 [DEBUG] switch_core_state_machine.c:102 sofia/internal/22981 Standard REPORTING, cause: NORMAL_CLEARING
2014-04-11 10:53:07.496655 [DEBUG] switch_core_state_machine.c:815 (sofia/internal/22981) State REPORTING going to sleep
2014-04-11 10:53:07.496655 [DEBUG] switch_core_state_machine.c:492 (sofia/internal/22981) State Change CS_REPORTING -> CS_DESTROY
2014-04-11 10:53:07.496655 [DEBUG] switch_core_session.c:1372 Send signal sofia/internal/22981 [BREAK]
2014-04-11 10:53:07.496655 [DEBUG] switch_core_session.c:1580 Session 6 (sofia/internal/22981) Locked, Waiting on external entities
2014-04-11 10:53:07.496655 [NOTICE] switch_core_session.c:1598 Session 6 (sofia/internal/22981) Ended
2014-04-11 10:53:07.496655 [NOTICE] switch_core_session.c:1602 Close Channel sofia/internal/22981 [CS_DESTROY]
2014-04-11 10:53:07.496655 [DEBUG] switch_core_state_machine.c:617 (sofia/internal/22981) Callstate Change HANGUP -> DOWN
2014-04-11 10:53:07.496655 [DEBUG] switch_core_state_machine.c:620 (sofia/internal/22981) Running State Change CS_DESTROY
2014-04-11 10:53:07.496655 [DEBUG] switch_core_state_machine.c:630 (sofia/internal/22981) State DESTROY
2014-04-11 10:53:07.496655 [DEBUG] mod_sofia.c:323 sofia/internal/22981 SOFIA DESTROY
2014-04-11 10:53:07.496655 [DEBUG] switch_core_state_machine.c:109 sofia/internal/22981 Standard DESTROY
2014-04-11 10:53:07.496655 [DEBUG] switch_core_state_machine.c:630 (sofia/internal/22981) State DESTROY going to sleep