freeswitchforum.com

Форум поддержки FreeSWITCH

FreeSWITCH is a registered trademark of Anthony Minessale. Official FreeSWITCH site.

Текущее время: 28 мар 2024 18:47

Часовой пояс: UTC + 4 часа




Начать новую тему Ответить на тему  [ Сообщений: 19 ]  На страницу Пред.  1, 2
Автор Сообщение
 Заголовок сообщения: Re: Переадресация с IVR
СообщениеДобавлено: 03 сен 2013 11:04 

Зарегистрирован: 07 июн 2013 10:17
Сообщения: 122
Так ведь..
Цитата:
9090 - Set CF for my phone (from my phone)
9091 - Set CF for any extension (from any phone)
9092 - Cancel CF for my phone (from my phone)
9093 - Cancel CF for any extension (from any phone)


Цитата:
Go to a phone that you would like to call forward. Dial 9090 and then enter in a destination number. For a simple test, send the call to '9192' so that it does an info dump and then exits. If you call your source extension number it will "forward" to 9192, which does the info dump and hangs up.
To see what's actually happening, consider an example where I used extension 1007. After setting the call forward to 9192, go to the fs_cli and type this command:

Код:
expand hash_dump all ${domain}-CF

Цитата:
You should see something like this:

Код:
D/10.15.128.192-CF_1001/9192


Или я что-то не так понял? Чтобы настроить переадресацию телефона 1001, надо с 1001 позвонить на 9090 и набрать номер, куда будет идти переадресация. Так?


Вернуться к началу
 Профиль  
 
 Заголовок сообщения: Re: Переадресация с IVR
СообщениеДобавлено: 03 сен 2013 12:05 
FreeSWITCH_GuRu

Зарегистрирован: 22 авг 2012 09:52
Сообщения: 1710
Код:
 <extension name="CF from my station">
   <condition field="destination_number" expression="^(9090)$">
     <action application="answer"/>
     <action application="log" data="INFO Set CF from ${caller_id_number}"/>
     <action application="play_and_get_digits"
         data="4 4 3 3000 # phrase:enter_dest_number ivr/ivr-that_was_an_invalid_entry.wav target_number \d+"/>
     <action application="hash" data="insert/${domain_name}-CF/${caller_id_number}/${target_number}"/>
     <action application="sleep" data="1000"/>
     <action application="playback" data="phrase:call_forward_set:${caller_id_number}:${target_number}"/>
   </condition>
 </extension>

позвонив на 9090 должны услышать enter_dest_number (которого у вас нет), соответственно play_and_get_digits не выполняется от этого ${target_number} выходит пустой

_________________
ЛС: @rostel
Сообщество: @ru_freeswitch


Вернуться к началу
 Профиль  
 
 Заголовок сообщения: Re: Переадресация с IVR
СообщениеДобавлено: 04 сен 2013 06:43 

Зарегистрирован: 07 июн 2013 10:17
Сообщения: 122
Но там есть enter_dest_number, дает ввести, а по окончании произносит два номера - номер, с которого позвонил и номер, который ввел :?


Вернуться к началу
 Профиль  
 
 Заголовок сообщения: Re: Переадресация с IVR
СообщениеДобавлено: 04 сен 2013 06:52 
FreeSWITCH_GuRu

Зарегистрирован: 22 авг 2012 09:52
Сообщения: 1710
выкладывайте полный листинг консоли установки переадресации
expand hash_dump all ${domain}-CF
и полный листинг вызова на номер на котором стоит переадресация

_________________
ЛС: @rostel
Сообщество: @ru_freeswitch


Вернуться к началу
 Профиль  
 
 Заголовок сообщения: Re: Переадресация с IVR
СообщениеДобавлено: 04 сен 2013 07:21 

Зарегистрирован: 07 июн 2013 10:17
Сообщения: 122
[+] 
Код:
2013-09-04 11:57:50.696568 [NOTICE] switch_channel.c:1030 New Channel sofia/sipinterface_1/1003@194.143.148.10 [27a796b16b9652cd5a1647e96ccb4033@10.1.4.158]
2013-09-04 11:57:50.696568 [DEBUG] switch_core_session.c:1006 Send signal sofia/sipinterface_1/1003@194.143.148.10 [BREAK]
2013-09-04 11:57:50.696568 [DEBUG] switch_core_session.c:1006 Send signal sofia/sipinterface_1/1003@194.143.148.10 [BREAK]
2013-09-04 11:57:50.696568 [DEBUG] switch_core_state_machine.c:418 (sofia/sipinterface_1/1003@194.143.148.10) Running State Change CS_NEW
2013-09-04 11:57:50.696568 [DEBUG] switch_core_state_machine.c:436 (sofia/sipinterface_1/1003@194.143.148.10) State NEW
2013-09-04 11:57:50.716583 [DEBUG] sofia.c:7958 1 acls to check for proxy
2013-09-04 11:57:50.716583 [DEBUG] sofia.c:7963 checking 10.1.4.158 against acl authoritative
2013-09-04 11:57:50.716583 [DEBUG] sofia.c:8003 IP 10.1.4.158 Rejected by acl "authoritative". Falling back to Digest auth.
2013-09-04 11:57:50.716583 [WARNING] sofia_reg.c:1632 SIP auth challenge (INVITE) on sofia profile 'sipinterface_1' for [9090@194.143.148.10] from ip 10.1.4.158
2013-09-04 11:57:50.716583 [DEBUG] switch_core_session.c:1006 Send signal sofia/sipinterface_1/1003@194.143.148.10 [BREAK]
2013-09-04 11:57:50.716583 [DEBUG] sofia.c:1788 detaching session 27a796b16b9652cd5a1647e96ccb4033@10.1.4.158
2013-09-04 11:57:51.116570 [DEBUG] sofia.c:1880 Re-attaching to session 27a796b16b9652cd5a1647e96ccb4033@10.1.4.158
2013-09-04 11:57:51.116570 [DEBUG] switch_core_session.c:1006 Send signal sofia/sipinterface_1/1003@194.143.148.10 [BREAK]
2013-09-04 11:57:51.116570 [DEBUG] switch_core_session.c:1006 Send signal sofia/sipinterface_1/1003@194.143.148.10 [BREAK]
2013-09-04 11:57:51.136580 [DEBUG] sofia.c:7958 1 acls to check for proxy
2013-09-04 11:57:51.136580 [DEBUG] sofia.c:7963 checking 10.1.4.158 against acl authoritative
2013-09-04 11:57:51.136580 [DEBUG] sofia.c:8003 IP 10.1.4.158 Rejected by acl "authoritative". Falling back to Digest auth.
2013-09-04 11:57:51.136580 [DEBUG] sofia.c:5834 Channel sofia/sipinterface_1/1003@194.143.148.10 entering state [received][100]
2013-09-04 11:57:51.136580 [DEBUG] sofia.c:5844 Remote SDP:
v=0
o=- 7961 0 IN IP4 10.1.4.158
s=SIP CALL
c=IN IP4 10.1.4.158
t=0 0
m=audio 60000 RTP/AVP 8 0 18 101
a=rtpmap:8 PCMA/8000
a=rtpmap:0 PCMU/8000
a=rtpmap:18 G729/8000
a=rtpmap:101 telephone-event/8000
a=fmtp:101 0-15

2013-09-04 11:57:51.136580 [DEBUG] sofia.c:6056 (sofia/sipinterface_1/1003@194.143.148.10) State Change CS_NEW -> CS_INIT
2013-09-04 11:57:51.136580 [DEBUG] switch_core_session.c:1341 Send signal sofia/sipinterface_1/1003@194.143.148.10 [BREAK]
2013-09-04 11:57:51.136580 [DEBUG] switch_core_state_machine.c:418 (sofia/sipinterface_1/1003@194.143.148.10) Running State Change CS_INIT
2013-09-04 11:57:51.136580 [DEBUG] switch_core_state_machine.c:457 (sofia/sipinterface_1/1003@194.143.148.10) State INIT
2013-09-04 11:57:51.136580 [DEBUG] mod_sofia.c:87 sofia/sipinterface_1/1003@194.143.148.10 SOFIA INIT
2013-09-04 11:57:51.136580 [DEBUG] mod_sofia.c:114 (sofia/sipinterface_1/1003@194.143.148.10) State Change CS_INIT -> CS_ROUTING
2013-09-04 11:57:51.136580 [DEBUG] switch_core_session.c:1341 Send signal sofia/sipinterface_1/1003@194.143.148.10 [BREAK]
2013-09-04 11:57:51.136580 [DEBUG] switch_core_state_machine.c:457 (sofia/sipinterface_1/1003@194.143.148.10) State INIT going to sleep
2013-09-04 11:57:51.136580 [DEBUG] switch_core_state_machine.c:418 (sofia/sipinterface_1/1003@194.143.148.10) Running State Change CS_ROUTING
2013-09-04 11:57:51.136580 [DEBUG] switch_channel.c:2116 (sofia/sipinterface_1/1003@194.143.148.10) Callstate Change DOWN -> RINGING
2013-09-04 11:57:51.136580 [DEBUG] switch_core_state_machine.c:473 (sofia/sipinterface_1/1003@194.143.148.10) State ROUTING
2013-09-04 11:57:51.136580 [DEBUG] mod_sofia.c:137 sofia/sipinterface_1/1003@194.143.148.10 SOFIA ROUTING
2013-09-04 11:57:51.136580 [DEBUG] switch_core_state_machine.c:117 sofia/sipinterface_1/1003@194.143.148.10 Standard ROUTING
2013-09-04 11:57:51.136580 [INFO] mod_dialplan_xml.c:558 Processing 1003 <1003>->9090 in context default
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->record_session] continue=true
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (PASS) [record_session] ${caller_id_number}(1003) =~ /^.+$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Action set(RECORD_TITLE=Recording ${destination_number} ${caller_id_number} ${strftime(%Y-%m-%d %H:%M)})
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Action set(RECORD_SOFTWARE=FreeSWITCH)
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Action set(RECORD_ARTIST=FreeSWITCH)
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Action set(RECORD_COMMENT=FreeSWITCH)
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Action set(RECORD_DATE=${strftime(%Y-%m-%d %H:%M)})
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Action record_session(/usr/local/freeswitch/recordings/archive/${strftime(%Y)}/${strftime(%b)}/${strftime(%d)}/${strftime(%Y%m%d_%H%M%S)}_${caller_id_number}_${destination_number}.mp3)
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Action set(RECORD_STEREO=true)
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->unloop] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (PASS) [unloop] ${unroll_loops}(true) =~ /^true$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [unloop] ${sip_looped_call}() =~ /^true$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->global-intercept] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [global-intercept] destination_number(9090) =~ /^886$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->group-intercept] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [group-intercept] destination_number(9090) =~ /^\*8$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->intercept-ext] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [intercept-ext] destination_number(9090) =~ /^\*\*(\d+)$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->redial] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [redial] destination_number(9090) =~ /^(redial|870)$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->global] continue=true
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [global] ${call_debug}(false) =~ /^true$/ break=never
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [global] ${rtp_has_crypto}() =~ /^(AES_CM_128_HMAC_SHA1_32|AES_CM_128_HMAC_SHA1_80)$/ break=never
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (PASS) [global] ${endpoint_disposition}(DELAYED NEGOTIATION) =~ /^(DELAYED NEGOTIATION)/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [global] ${switch_r_sdp}(v=0
o=- 7961 0 IN IP4 10.1.4.158
s=SIP CALL
c=IN IP4 10.1.4.158
t=0 0
m=audio 60000 RTP/AVP 8 0 18 101
a=rtpmap:8 PCMA/8000
a=rtpmap:0 PCMU/8000
a=rtpmap:18 G729/8000
a=rtpmap:101 telephone-event/8000
a=fmtp:101 0-15
) =~ /(AES_CM_128_HMAC_SHA1_32|AES_CM_128_HMAC_SHA1_80)/ break=never
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Absolute Condition [global]
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Action hash(insert/${domain_name}-spymap/${caller_id_number}/${uuid})
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Action hash(insert/${domain_name}-last_dial/${caller_id_number}/${destination_number})
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Action hash(insert/${domain_name}-last_dial/global/${uuid})
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Action export(RFC2822_DATE=${strftime(%a, %d %b %Y %T %z)})
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->call_return] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [call_return] destination_number(9090) =~ /^\*69$|^869$|^lcr$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->del-group] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [del-group] destination_number(9090) =~ /^80(\d{2})$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->add-group] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [add-group] destination_number(9090) =~ /^81(\d{2})$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->call-group-simo] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [call-group-simo] destination_number(9090) =~ /^82(\d{2})$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->call-group-order] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [call-group-order] destination_number(9090) =~ /^83(\d{2})$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->extension-intercom] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [extension-intercom] destination_number(9090) =~ /^8(10[01][0-9])$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->Local_Extension] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [Local_Extension] destination_number(9090) =~ /^(10[01][0-9])$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->Check IVR-based CF] continue=true
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (PASS) [Check IVR-based CF] destination_number(9090) =~ /^(\d+)$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Action set(dialed_number=9090) INLINE
EXECUTE sofia/sipinterface_1/1003@194.143.148.10 set(dialed_number=9090)
2013-09-04 11:57:51.136580 [DEBUG] mod_dptools.c:1395 sofia/sipinterface_1/1003@194.143.148.10 SET [dialed_number]=[9090]
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Action set(cf_target=${hash(select/${domain_name}-CF/9090)}) INLINE
EXECUTE sofia/sipinterface_1/1003@194.143.148.10 set(cf_target=)
2013-09-04 11:57:51.136580 [DEBUG] mod_dptools.c:1395 sofia/sipinterface_1/1003@194.143.148.10 SET [cf_target]=[UNDEF]
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [Check IVR-based CF] ${cf_target}() =~ /^(\d+)$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->Local_Extension_Skinny] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [Local_Extension_Skinny] destination_number(9090) =~ /^(11[01][0-9])$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->group_dial_sales] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [group_dial_sales] destination_number(9090) =~ /^2000$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->group_dial_support] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [group_dial_support] destination_number(9090) =~ /^2001$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->group_dial_billing] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [group_dial_billing] destination_number(9090) =~ /^2002$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->operator] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [operator] destination_number(9090) =~ /^(operator|0)$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->vmain] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [vmain] destination_number(9090) =~ /^vmain$|^4000$|^\*98$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->sip_uri] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [sip_uri] destination_number(9090) =~ /^sip:(.*)$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->nb_conferences] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [nb_conferences] destination_number(9090) =~ /^(30\d{2})$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->wb_conferences] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [wb_conferences] destination_number(9090) =~ /^(31\d{2})$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->uwb_conferences] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [uwb_conferences] destination_number(9090) =~ /^(32\d{2})$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->cdquality_conferences] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [cdquality_conferences] destination_number(9090) =~ /^(33\d{2})$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->freeswitch_public_conf_via_sip] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [freeswitch_public_conf_via_sip] destination_number(9090) =~ /^9(888|8888|1616|3232)$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->mad_boss_intercom] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [mad_boss_intercom] destination_number(9090) =~ /^0911$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->mad_boss_intercom] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [mad_boss_intercom] destination_number(9090) =~ /^0912$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->mad_boss] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [mad_boss] destination_number(9090) =~ /^0913$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->ivr_demo] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [ivr_demo] destination_number(9090) =~ /^5000$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->dynamic_conference] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [dynamic_conference] destination_number(9090) =~ /^5001$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->rtp_multicast_page] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [rtp_multicast_page] destination_number(9090) =~ /^pagegroup$|^7243$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->park] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [park] destination_number(9090) =~ /^5900$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->unpark] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [unpark] destination_number(9090) =~ /^5901$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->valet_park] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [valet_park] destination_number(9090) =~ /^(6000)$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->valet_park] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [valet_park] destination_number(9090) =~ /^(60\d[1-9])$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->park] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (PASS) [park] source(mod_sofia) =~ /mod_sofia/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [park] destination_number(9090) =~ /park\+(\d+)/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->unpark] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (PASS) [unpark] source(mod_sofia) =~ /mod_sofia/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [unpark] destination_number(9090) =~ /^parking$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->park] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (PASS) [park] source(mod_sofia) =~ /mod_sofia/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [park] destination_number(9090) =~ /callpark/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->unpark] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (PASS) [unpark] source(mod_sofia) =~ /mod_sofia/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [unpark] destination_number(9090) =~ /pickup/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->wait] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [wait] destination_number(9090) =~ /^wait$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->fax_receive] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [fax_receive] destination_number(9090) =~ /^9178$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->fax_transmit] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [fax_transmit] destination_number(9090) =~ /^9179$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->ringback_180] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [ringback_180] destination_number(9090) =~ /^9180$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->ringback_183_uk_ring] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [ringback_183_uk_ring] destination_number(9090) =~ /^9181$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->ringback_183_music_ring] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [ringback_183_music_ring] destination_number(9090) =~ /^9182$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->ringback_post_answer_uk_ring] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [ringback_post_answer_uk_ring] destination_number(9090) =~ /^9183$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->ringback_post_answer_music] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [ringback_post_answer_music] destination_number(9090) =~ /^9184$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->ClueCon] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [ClueCon] destination_number(9090) =~ /^9191$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->show_info] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [show_info] destination_number(9090) =~ /^9192$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->video_record] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [video_record] destination_number(9090) =~ /^9193$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->video_playback] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [video_playback] destination_number(9090) =~ /^9194$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->delay_echo] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [delay_echo] destination_number(9090) =~ /^9195$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->echo] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [echo] destination_number(9090) =~ /^9196$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->milliwatt] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [milliwatt] destination_number(9090) =~ /^9197$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->tone_stream] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [tone_stream] destination_number(9090) =~ /^9198$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->zrtp_enrollement] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [zrtp_enrollement] destination_number(9090) =~ /^9787$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->hold_music] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [hold_music] destination_number(9090) =~ /^9664$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->laugh break] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [laugh break] destination_number(9090) =~ /^9386$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->1001] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [1001] context(default) =~ /public/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->1002] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [1002] context(default) =~ /public/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->1003] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [1003] context(default) =~ /public/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->Time_condition1] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [Time_condition1] destination_number(9090) =~ /^9999$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->gateway1.d3] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [gateway1.d3] destination_number(9090) =~ /^(\d{3})$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->Announce Conf Count (Inline)] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (FAIL) [Announce Conf Count (Inline)] destination_number(9090) =~ /^ANNOUNCE_CONF_COUNT_PRIVATE$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 parsing [default->CF from my station] continue=false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Regex (PASS) [CF from my station] destination_number(9090) =~ /^(9090)$/ break=on-false
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Action answer()
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Action log(INFO Set CF from ${caller_id_number})
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Action play_and_get_digits(4 4 3 3000 # phrase:enter_dest_number ivr/ivr-that_was_an_invalid_entry.wav target_number \d+)
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Action hash(insert/${domain_name}-CF/${caller_id_number}/${target_number})
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Action sleep(1000)
Dialplan: sofia/sipinterface_1/1003@194.143.148.10 Action playback(phrase:call_forward_set:${caller_id_number}:${target_number})
2013-09-04 11:57:51.156580 [DEBUG] switch_core_state_machine.c:167 (sofia/sipinterface_1/1003@194.143.148.10) State Change CS_ROUTING -> CS_EXECUTE
2013-09-04 11:57:51.156580 [DEBUG] switch_core_session.c:1341 Send signal sofia/sipinterface_1/1003@194.143.148.10 [BREAK]
2013-09-04 11:57:51.156580 [DEBUG] switch_core_state_machine.c:473 (sofia/sipinterface_1/1003@194.143.148.10) State ROUTING going to sleep
2013-09-04 11:57:51.156580 [DEBUG] switch_core_state_machine.c:418 (sofia/sipinterface_1/1003@194.143.148.10) Running State Change CS_EXECUTE
2013-09-04 11:57:51.156580 [DEBUG] switch_core_state_machine.c:480 (sofia/sipinterface_1/1003@194.143.148.10) State EXECUTE
2013-09-04 11:57:51.156580 [DEBUG] mod_sofia.c:230 sofia/sipinterface_1/1003@194.143.148.10 SOFIA EXECUTE
2013-09-04 11:57:51.156580 [DEBUG] switch_core_state_machine.c:209 sofia/sipinterface_1/1003@194.143.148.10 Standard EXECUTE
EXECUTE sofia/sipinterface_1/1003@194.143.148.10 set(RECORD_TITLE=Recording 9090 1003 2013-09-04 11:57)
2013-09-04 11:57:51.156580 [DEBUG] mod_dptools.c:1395 sofia/sipinterface_1/1003@194.143.148.10 SET [RECORD_TITLE]=[Recording 9090 1003 2013-09-04 11:57]
EXECUTE sofia/sipinterface_1/1003@194.143.148.10 set(RECORD_SOFTWARE=FreeSWITCH)
2013-09-04 11:57:51.156580 [DEBUG] mod_dptools.c:1395 sofia/sipinterface_1/1003@194.143.148.10 SET [RECORD_SOFTWARE]=[FreeSWITCH]
EXECUTE sofia/sipinterface_1/1003@194.143.148.10 set(RECORD_ARTIST=FreeSWITCH)
2013-09-04 11:57:51.156580 [DEBUG] mod_dptools.c:1395 sofia/sipinterface_1/1003@194.143.148.10 SET [RECORD_ARTIST]=[FreeSWITCH]
EXECUTE sofia/sipinterface_1/1003@194.143.148.10 set(RECORD_COMMENT=FreeSWITCH)
2013-09-04 11:57:51.156580 [DEBUG] mod_dptools.c:1395 sofia/sipinterface_1/1003@194.143.148.10 SET [RECORD_COMMENT]=[FreeSWITCH]
EXECUTE sofia/sipinterface_1/1003@194.143.148.10 set(RECORD_DATE=2013-09-04 11:57)
2013-09-04 11:57:51.156580 [DEBUG] mod_dptools.c:1395 sofia/sipinterface_1/1003@194.143.148.10 SET [RECORD_DATE]=[2013-09-04 11:57]
2013-09-04 11:57:51.156580 [DEBUG] switch_core_session.c:2597 Application record_session Requires media! pre_answering channel sofia/sipinterface_1/1003@194.143.148.10
2013-09-04 11:57:51.156580 [INFO] switch_core_session.c:2599 Sending early media
2013-09-04 11:57:51.156580 [DEBUG] switch_core_media.c:2885 Audio Codec Compare [PCMA:8:8000:20:64000]/[PCMU:0:8000:20:64000]
2013-09-04 11:57:51.156580 [DEBUG] switch_core_media.c:2885 Audio Codec Compare [PCMA:8:8000:20:64000]/[PCMA:8:8000:20:64000]
2013-09-04 11:57:51.156580 [DEBUG] switch_core_media.c:1918 Set Codec sofia/sipinterface_1/1003@194.143.148.10 PCMA/8000 20 ms 160 samples 64000 bits
2013-09-04 11:57:51.156580 [DEBUG] switch_core_codec.c:111 sofia/sipinterface_1/1003@194.143.148.10 Original read codec set to PCMA:8
2013-09-04 11:57:51.156580 [DEBUG] switch_core_media.c:3056 Set 2833 dtmf send/recv payload to 101
2013-09-04 11:57:51.156580 [INFO] switch_nat.c:590 NAT port mapping disabled
2013-09-04 11:57:51.156580 [DEBUG] switch_core_media.c:4087 AUDIO RTP [sofia/sipinterface_1/1003@194.143.148.10] 194.143.148.10 port 17598 -> 10.1.4.158 port 60000 codec: 8 ms: 20
2013-09-04 11:57:51.156580 [DEBUG] switch_rtp.c:2891 Starting timer [soft] 160 bytes per 20ms
2013-09-04 11:57:51.156580 [DEBUG] switch_core_media.c:4423 Set 2833 dtmf send payload to 101
2013-09-04 11:57:51.156580 [DEBUG] switch_core_media.c:4429 Set 2833 dtmf receive payload to 101
2013-09-04 11:57:51.156580 [NOTICE] sofia_media.c:92 Pre-Answer sofia/sipinterface_1/1003@194.143.148.10!
2013-09-04 11:57:51.156580 [DEBUG] switch_channel.c:3316 (sofia/sipinterface_1/1003@194.143.148.10) Callstate Change RINGING -> EARLY
2013-09-04 11:57:51.156580 [DEBUG] mod_sofia.c:2135 Ring SDP:
v=0
o=FreeSWITCH 1378245873 1378245874 IN IP4 194.143.148.10
s=FreeSWITCH
c=IN IP4 194.143.148.10
t=0 0
m=audio 17598 RTP/AVP 8 101
a=rtpmap:8 PCMA/8000
a=rtpmap:101 telephone-event/8000
a=fmtp:101 0-16
a=silenceSupp:off - - - -
a=ptime:20
a=sendrecv

2013-09-04 11:57:51.156580 [DEBUG] switch_core_session.c:861 Send signal sofia/sipinterface_1/1003@194.143.148.10 [BREAK]
EXECUTE sofia/sipinterface_1/1003@194.143.148.10 record_session(/usr/local/freeswitch/recordings/archive/2013/Sep/04/20130904_115751_1003_9090.mp3)
2013-09-04 11:57:51.156580 [DEBUG] switch_core_session.c:1006 Send signal sofia/sipinterface_1/1003@194.143.148.10 [BREAK]
2013-09-04 11:57:51.156580 [DEBUG] sofia.c:5834 Channel sofia/sipinterface_1/1003@194.143.148.10 entering state [early][183]
2013-09-04 11:57:51.156580 [INFO] mod_shout.c:324 LAME 3.98.4 32bits (http://www.mp3dev.org/)
2013-09-04 11:57:51.156580 [INFO] mod_shout.c:324 Using polyphase lowpass filter, transition band:  3903 Hz -  4000 Hz
2013-09-04 11:57:51.156580 [DEBUG] switch_core_media_bug.c:532 Attaching BUG to sofia/sipinterface_1/1003@194.143.148.10
EXECUTE sofia/sipinterface_1/1003@194.143.148.10 set(RECORD_STEREO=true)
2013-09-04 11:57:51.156580 [DEBUG] mod_dptools.c:1395 sofia/sipinterface_1/1003@194.143.148.10 SET [RECORD_STEREO]=[true]
EXECUTE sofia/sipinterface_1/1003@194.143.148.10 hash(insert/194.143.148.10-spymap/1003/27a796b16b9652cd5a1647e96ccb4033@10.1.4.158)
EXECUTE sofia/sipinterface_1/1003@194.143.148.10 hash(insert/194.143.148.10-last_dial/1003/9090)
EXECUTE sofia/sipinterface_1/1003@194.143.148.10 hash(insert/194.143.148.10-last_dial/global/27a796b16b9652cd5a1647e96ccb4033@10.1.4.158)
EXECUTE sofia/sipinterface_1/1003@194.143.148.10 export(RFC2822_DATE=Wed, 04 Sep 2013 11:57:51 +0900)
2013-09-04 11:57:51.176583 [DEBUG] switch_channel.c:1222 EXPORT (export_vars) [RFC2822_DATE]=[Wed, 04 Sep 2013 11:57:51 +0900]
EXECUTE sofia/sipinterface_1/1003@194.143.148.10 answer()
2013-09-04 11:57:51.176583 [DEBUG] mod_sofia.c:824 Local SDP sofia/sipinterface_1/1003@194.143.148.10:
v=0
o=FreeSWITCH 1378245873 1378245875 IN IP4 194.143.148.10
s=FreeSWITCH
c=IN IP4 194.143.148.10
t=0 0
m=audio 17598 RTP/AVP 8 101
a=rtpmap:8 PCMA/8000
a=rtpmap:101 telephone-event/8000
a=fmtp:101 0-16
a=silenceSupp:off - - - -
a=ptime:20
a=sendrecv

2013-09-04 11:57:51.176583 [DEBUG] switch_core_session.c:861 Send signal sofia/sipinterface_1/1003@194.143.148.10 [BREAK]
2013-09-04 11:57:51.176583 [DEBUG] switch_core_session.c:1006 Send signal sofia/sipinterface_1/1003@194.143.148.10 [BREAK]
2013-09-04 11:57:51.176583 [NOTICE] mod_dptools.c:1218 Channel [sofia/sipinterface_1/1003@194.143.148.10] has been answered
2013-09-04 11:57:51.176583 [DEBUG] switch_channel.c:3595 (sofia/sipinterface_1/1003@194.143.148.10) Callstate Change EARLY -> ACTIVE
2013-09-04 11:57:51.176583 [DEBUG] sofia.c:5834 Channel sofia/sipinterface_1/1003@194.143.148.10 entering state [completed][200]
EXECUTE sofia/sipinterface_1/1003@194.143.148.10 log(INFO Set CF from 1003)
2013-09-04 11:57:51.176583 [INFO] mod_dptools.c:1588 Set CF from 1003
EXECUTE sofia/sipinterface_1/1003@194.143.148.10 play_and_get_digits(4 4 3 3000 # phrase:enter_dest_number ivr/ivr-that_was_an_invalid_entry.wav target_number \d+)
2013-09-04 11:57:51.176583 [DEBUG] switch_ivr_play_say.c:70 No language specified - Using [ru]
2013-09-04 11:57:51.196584 [DEBUG] switch_ivr_play_say.c:251 Handle sleep:[1000] (ru:ru)
2013-09-04 11:57:51.316569 [DEBUG] switch_ivr_play_say.c:251 Handle play-file:[ivr/ivr-enter_destination_telephone_number.wav] (ru:ru)
2013-09-04 11:57:51.316569 [DEBUG] switch_ivr_play_say.c:1315 Codec Activated L16@8000hz 1 channels 20ms
2013-09-04 11:57:51.536570 [DEBUG] switch_rtp.c:4918 Correct ip/port confirmed.
2013-09-04 11:57:51.536570 [DEBUG] switch_core_io.c:489 Setting BUG Codec PCMA:8
2013-09-04 11:57:51.756569 [DEBUG] switch_core_session.c:1006 Send signal sofia/sipinterface_1/1003@194.143.148.10 [BREAK]
2013-09-04 11:57:51.756569 [DEBUG] switch_core_session.c:1006 Send signal sofia/sipinterface_1/1003@194.143.148.10 [BREAK]
2013-09-04 11:57:51.756569 [DEBUG] switch_core_session.c:1006 Send signal sofia/sipinterface_1/1003@194.143.148.10 [BREAK]
2013-09-04 11:57:51.776572 [DEBUG] sofia.c:5834 Channel sofia/sipinterface_1/1003@194.143.148.10 entering state [ready][200]
2013-09-04 11:57:54.656568 [DEBUG] switch_ivr_play_say.c:1704 done playing file /usr/local/freeswitch/sounds/ru/RU/elena/ivr/ivr-enter_destination_telephone_number.wav
2013-09-04 11:57:54.756568 [DEBUG] switch_ivr_play_say.c:251 Handle sleep:[1000] (ru:ru)
2013-09-04 11:57:55.416568 [DEBUG] switch_rtp.c:5117 RTP RECV DTMF 1:800
2013-09-04 11:57:55.416568 [DEBUG] switch_channel.c:471 RECV DTMF 1:800
2013-09-04 11:57:55.676571 [DEBUG] switch_rtp.c:5117 RTP RECV DTMF 0:800
2013-09-04 11:57:55.676571 [DEBUG] switch_channel.c:471 RECV DTMF 0:800
2013-09-04 11:57:55.976571 [DEBUG] switch_rtp.c:5117 RTP RECV DTMF 0:800
2013-09-04 11:57:55.976571 [DEBUG] switch_channel.c:471 RECV DTMF 0:800
2013-09-04 11:57:56.156571 [DEBUG] switch_rtp.c:5117 RTP RECV DTMF 1:800
2013-09-04 11:57:56.156571 [DEBUG] switch_channel.c:471 RECV DTMF 1:800
EXECUTE sofia/sipinterface_1/1003@194.143.148.10 hash(insert/194.143.148.10-CF/1003/1001)
EXECUTE sofia/sipinterface_1/1003@194.143.148.10 sleep(1000)
2013-09-04 11:57:56.536572 [DEBUG] switch_rtp.c:5117 RTP RECV DTMF #:800
2013-09-04 11:57:56.536572 [DEBUG] switch_channel.c:471 RECV DTMF #:800
EXECUTE sofia/sipinterface_1/1003@194.143.148.10 playback(phrase:call_forward_set:1003:1001)
2013-09-04 11:57:56.536572 [DEBUG] switch_ivr_play_say.c:70 No language specified - Using [ru]
2013-09-04 11:57:56.556571 [DEBUG] switch_ivr_play_say.c:251 Handle sleep:[1000] (ru:ru)
2013-09-04 11:57:56.676569 [DEBUG] switch_ivr_play_say.c:251 Handle play-file:[ivr/ivr-extension_number.wav] (ru:ru)
2013-09-04 11:57:56.676569 [DEBUG] switch_ivr_play_say.c:1315 Codec Activated L16@8000hz 1 channels 20ms
2013-09-04 11:57:56.676569 [DEBUG] mod_dptools.c:2098 Digit #
2013-09-04 11:57:57.816570 [DEBUG] switch_ivr_play_say.c:1704 done playing file /usr/local/freeswitch/sounds/ru/RU/elena/ivr/ivr-extension_number.wav
2013-09-04 11:57:57.936569 [DEBUG] switch_ivr_play_say.c:251 Handle sleep:[400] (ru:ru)
2013-09-04 11:57:58.056568 [DEBUG] switch_ivr_play_say.c:251 Handle say:[1003] (ru:ru)
2013-09-04 11:57:58.056568 [INFO] mod_say_ru.c:721 ru_say!!!  1003!   say_opt.gender=0   say_opt.cases=0
2013-09-04 11:57:58.056568 [DEBUG] switch_ivr_play_say.c:1315 Codec Activated L16@8000hz 1 channels 20ms
2013-09-04 11:58:00.056570 [DEBUG] switch_ivr_play_say.c:1704 done playing file file_string://digits/1f.wav!digits/thousand.wav!digits/3.wav
2013-09-04 11:58:00.156571 [DEBUG] switch_ivr_play_say.c:251 Handle sleep:[400] (ru:ru)
2013-09-04 11:58:00.256571 [DEBUG] switch_ivr_play_say.c:251 Handle play-file:[digits/2.wav] (ru:ru)
2013-09-04 11:58:00.256571 [DEBUG] switch_ivr_play_say.c:1315 Codec Activated L16@8000hz 1 channels 20ms
2013-09-04 11:58:00.836568 [DEBUG] switch_ivr_play_say.c:1704 done playing file /usr/local/freeswitch/sounds/ru/RU/elena/digits/2.wav
2013-09-04 11:58:00.936568 [DEBUG] switch_ivr_play_say.c:251 Handle sleep:[1000] (ru:ru)
2013-09-04 11:58:01.036568 [DEBUG] switch_ivr_play_say.c:251 Handle play-file:[ivr/ivr-extension_number.wav] (ru:ru)
2013-09-04 11:58:01.036568 [DEBUG] switch_ivr_play_say.c:1315 Codec Activated L16@8000hz 1 channels 20ms
2013-09-04 11:58:02.176568 [DEBUG] switch_ivr_play_say.c:1704 done playing file /usr/local/freeswitch/sounds/ru/RU/elena/ivr/ivr-extension_number.wav
2013-09-04 11:58:02.276568 [DEBUG] switch_ivr_play_say.c:251 Handle sleep:[400] (ru:ru)
2013-09-04 11:58:02.376569 [DEBUG] switch_ivr_play_say.c:251 Handle say:[1001] (ru:ru)
2013-09-04 11:58:02.376569 [INFO] mod_say_ru.c:721 ru_say!!!  1001!   say_opt.gender=0   say_opt.cases=0
2013-09-04 11:58:02.376569 [DEBUG] switch_ivr_play_say.c:1315 Codec Activated L16@8000hz 1 channels 20ms
2013-09-04 11:58:04.576568 [DEBUG] switch_ivr_play_say.c:1704 done playing file file_string://digits/1f.wav!digits/thousand.wav!digits/1.wav
2013-09-04 11:58:04.676568 [DEBUG] switch_ivr_play_say.c:251 Handle sleep:[1000] (ru:ru)
2013-09-04 11:58:04.776568 [DEBUG] switch_ivr_play_say.c:251 Handle play-file:[ivr/ivr-call_forwarding_has_been_set.wav] (ru:ru)
2013-09-04 11:58:04.776568 [DEBUG] switch_ivr_play_say.c:1315 Codec Activated L16@8000hz 1 channels 20ms
2013-09-04 11:58:07.296580 [DEBUG] switch_ivr_play_say.c:1704 done playing file /usr/local/freeswitch/sounds/ru/RU/elena/ivr/ivr-call_forwarding_has_been_set.wav
2013-09-04 11:58:07.416569 [DEBUG] switch_ivr_play_say.c:251 Handle sleep:[1500] (ru:ru)
2013-09-04 11:58:07.516569 [NOTICE] switch_core_state_machine.c:264 sofia/sipinterface_1/1003@194.143.148.10 has executed the last dialplan instruction, hanging up.
2013-09-04 11:58:07.516569 [NOTICE] switch_core_state_machine.c:266 Hangup sofia/sipinterface_1/1003@194.143.148.10 [CS_EXECUTE] [NORMAL_CLEARING]
2013-09-04 11:58:07.516569 [DEBUG] switch_channel.c:3135 Send signal sofia/sipinterface_1/1003@194.143.148.10 [KILL]
2013-09-04 11:58:07.516569 [DEBUG] switch_core_session.c:1341 Send signal sofia/sipinterface_1/1003@194.143.148.10 [BREAK]
2013-09-04 11:58:07.516569 [DEBUG] switch_core_state_machine.c:480 (sofia/sipinterface_1/1003@194.143.148.10) State EXECUTE going to sleep
2013-09-04 11:58:07.516569 [DEBUG] switch_core_state_machine.c:418 (sofia/sipinterface_1/1003@194.143.148.10) Running State Change CS_HANGUP
2013-09-04 11:58:07.516569 [DEBUG] switch_ivr_async.c:1175 Stop recording file /usr/local/freeswitch/recordings/archive/2013/Sep/04/20130904_115751_1003_9090.mp3
2013-09-04 11:58:07.556570 [DEBUG] switch_core_media_bug.c:780 Removing BUG from sofia/sipinterface_1/1003@194.143.148.10
2013-09-04 11:58:07.556570 [DEBUG] switch_core_state_machine.c:681 (sofia/sipinterface_1/1003@194.143.148.10) State HANGUP
2013-09-04 11:58:07.556570 [DEBUG] mod_sofia.c:465 Channel sofia/sipinterface_1/1003@194.143.148.10 hanging up, cause: NORMAL_CLEARING
2013-09-04 11:58:07.556570 [DEBUG] mod_sofia.c:517 Sending BYE to sofia/sipinterface_1/1003@194.143.148.10
2013-09-04 11:58:07.556570 [DEBUG] switch_core_state_machine.c:48 sofia/sipinterface_1/1003@194.143.148.10 Standard HANGUP, cause: NORMAL_CLEARING
2013-09-04 11:58:07.556570 [DEBUG] switch_core_state_machine.c:681 (sofia/sipinterface_1/1003@194.143.148.10) State HANGUP going to sleep
2013-09-04 11:58:07.556570 [DEBUG] switch_core_state_machine.c:694 (sofia/sipinterface_1/1003@194.143.148.10) Callstate Change ACTIVE -> HANGUP
2013-09-04 11:58:07.556570 [DEBUG] switch_core_state_machine.c:449 (sofia/sipinterface_1/1003@194.143.148.10) State Change CS_HANGUP -> CS_REPORTING
2013-09-04 11:58:07.556570 [DEBUG] switch_core_session.c:1341 Send signal sofia/sipinterface_1/1003@194.143.148.10 [BREAK]
2013-09-04 11:58:07.556570 [DEBUG] switch_core_state_machine.c:418 (sofia/sipinterface_1/1003@194.143.148.10) Running State Change CS_REPORTING
2013-09-04 11:58:07.556570 [DEBUG] switch_core_state_machine.c:766 (sofia/sipinterface_1/1003@194.143.148.10) State REPORTING
2013-09-04 11:58:07.556570 [DEBUG] switch_core_state_machine.c:92 sofia/sipinterface_1/1003@194.143.148.10 Standard REPORTING, cause: NORMAL_CLEARING
2013-09-04 11:58:07.556570 [DEBUG] switch_core_state_machine.c:766 (sofia/sipinterface_1/1003@194.143.148.10) State REPORTING going to sleep
2013-09-04 11:58:07.556570 [DEBUG] switch_core_state_machine.c:443 (sofia/sipinterface_1/1003@194.143.148.10) State Change CS_REPORTING -> CS_DESTROY
2013-09-04 11:58:07.556570 [DEBUG] switch_core_session.c:1341 Send signal sofia/sipinterface_1/1003@194.143.148.10 [BREAK]
2013-09-04 11:58:07.556570 [DEBUG] switch_core_session.c:1549 Session 55 (sofia/sipinterface_1/1003@194.143.148.10) Locked, Waiting on external entities
2013-09-04 11:58:07.556570 [NOTICE] switch_core_session.c:1567 Session 55 (sofia/sipinterface_1/1003@194.143.148.10) Ended
2013-09-04 11:58:07.556570 [NOTICE] switch_core_session.c:1571 Close Channel sofia/sipinterface_1/1003@194.143.148.10 [CS_DESTROY]
2013-09-04 11:58:07.556570 [DEBUG] switch_core_state_machine.c:568 (sofia/sipinterface_1/1003@194.143.148.10) Callstate Change HANGUP -> DOWN
2013-09-04 11:58:07.556570 [DEBUG] switch_core_state_machine.c:571 (sofia/sipinterface_1/1003@194.143.148.10) Running State Change CS_DESTROY
2013-09-04 11:58:07.556570 [DEBUG] switch_core_state_machine.c:581 (sofia/sipinterface_1/1003@194.143.148.10) State DESTROY
2013-09-04 11:58:07.556570 [DEBUG] mod_sofia.c:375 sofia/sipinterface_1/1003@194.143.148.10 SOFIA DESTROY
2013-09-04 11:58:07.556570 [DEBUG] switch_core_state_machine.c:99 sofia/sipinterface_1/1003@194.143.148.10 Standard DESTROY
2013-09-04 11:58:07.556570 [DEBUG] switch_core_state_machine.c:581 (sofia/sipinterface_1/1003@194.143.148.10) State DESTROY going to sleep


expand hash_dump all ${domain}-CF
Код:
D/194.143.148.10-CF_1003/1001


Вернуться к началу
 Профиль  
 
 Заголовок сообщения: Re: Переадресация с IVR
СообщениеДобавлено: 04 сен 2013 07:24 
FreeSWITCH_GuRu

Зарегистрирован: 22 авг 2012 09:52
Сообщения: 1710
Vlad1983 писал(а):
и полный листинг вызова на номер на котором стоит переадресация

_________________
ЛС: @rostel
Сообщество: @ru_freeswitch


Вернуться к началу
 Профиль  
 
 Заголовок сообщения: Re: Переадресация с IVR
СообщениеДобавлено: 04 сен 2013 07:29 

Зарегистрирован: 07 июн 2013 10:17
Сообщения: 122
Да, да, просто не влезло сразу, превышен лимит символов на сообщение:) А второе сразу нельзя..

[+] 
Код:
2013-09-04 12:00:56.916569 [WARNING] sofia_reg.c:1632 SIP auth challenge (REGISTER) on sofia profile 'sipinterface_1' for [1001@194.143.148.10] from ip 10.1.4.156
2013-09-04 12:00:57.516570 [WARNING] sofia_reg.c:1632 SIP auth challenge (REGISTER) on sofia profile 'sipinterface_1' for [1002@194.143.148.10] from ip 10.1.4.157
2013-09-04 12:01:06.596568 [NOTICE] switch_channel.c:1030 New Channel sofia/sipinterface_1/1002@194.143.148.10 [51d9ad582a0396635186532149bbc557@10.1.4.157]
2013-09-04 12:01:06.596568 [DEBUG] switch_core_session.c:1006 Send signal sofia/sipinterface_1/1002@194.143.148.10 [BREAK]
2013-09-04 12:01:06.596568 [DEBUG] switch_core_session.c:1006 Send signal sofia/sipinterface_1/1002@194.143.148.10 [BREAK]
2013-09-04 12:01:06.596568 [DEBUG] switch_core_state_machine.c:418 (sofia/sipinterface_1/1002@194.143.148.10) Running State Change CS_NEW
2013-09-04 12:01:06.596568 [DEBUG] switch_core_state_machine.c:436 (sofia/sipinterface_1/1002@194.143.148.10) State NEW
2013-09-04 12:01:06.616573 [DEBUG] sofia.c:7958 1 acls to check for proxy
2013-09-04 12:01:06.616573 [DEBUG] sofia.c:7963 checking 10.1.4.157 against acl authoritative
2013-09-04 12:01:06.616573 [DEBUG] sofia.c:8003 IP 10.1.4.157 Rejected by acl "authoritative". Falling back to Digest auth.
2013-09-04 12:01:06.616573 [WARNING] sofia_reg.c:1632 SIP auth challenge (INVITE) on sofia profile 'sipinterface_1' for [1003@194.143.148.10] from ip 10.1.4.157
2013-09-04 12:01:06.616573 [DEBUG] switch_core_session.c:1006 Send signal sofia/sipinterface_1/1002@194.143.148.10 [BREAK]
2013-09-04 12:01:06.616573 [DEBUG] sofia.c:1788 detaching session 51d9ad582a0396635186532149bbc557@10.1.4.157
2013-09-04 12:01:07.056568 [DEBUG] sofia.c:1880 Re-attaching to session 51d9ad582a0396635186532149bbc557@10.1.4.157
2013-09-04 12:01:07.056568 [DEBUG] switch_core_session.c:1006 Send signal sofia/sipinterface_1/1002@194.143.148.10 [BREAK]
2013-09-04 12:01:07.056568 [DEBUG] switch_core_session.c:1006 Send signal sofia/sipinterface_1/1002@194.143.148.10 [BREAK]
2013-09-04 12:01:07.056568 [DEBUG] sofia.c:7958 1 acls to check for proxy
2013-09-04 12:01:07.056568 [DEBUG] sofia.c:7963 checking 10.1.4.157 against acl authoritative
2013-09-04 12:01:07.056568 [DEBUG] sofia.c:8003 IP 10.1.4.157 Rejected by acl "authoritative". Falling back to Digest auth.
2013-09-04 12:01:07.056568 [DEBUG] sofia.c:5834 Channel sofia/sipinterface_1/1002@194.143.148.10 entering state [received][100]
2013-09-04 12:01:07.056568 [DEBUG] sofia.c:5844 Remote SDP:
v=0
o=- 336 0 IN IP4 10.1.4.157
s=SIP CALL
c=IN IP4 10.1.4.157
t=0 0
m=audio 60000 RTP/AVP 8 0 18 101
a=rtpmap:8 PCMA/8000
a=rtpmap:0 PCMU/8000
a=rtpmap:18 G729/8000
a=rtpmap:101 telephone-event/8000
a=fmtp:101 0-15

2013-09-04 12:01:07.056568 [DEBUG] sofia.c:6056 (sofia/sipinterface_1/1002@194.143.148.10) State Change CS_NEW -> CS_INIT
2013-09-04 12:01:07.056568 [DEBUG] switch_core_session.c:1341 Send signal sofia/sipinterface_1/1002@194.143.148.10 [BREAK]
2013-09-04 12:01:07.056568 [DEBUG] switch_core_state_machine.c:418 (sofia/sipinterface_1/1002@194.143.148.10) Running State Change CS_INIT
2013-09-04 12:01:07.056568 [DEBUG] switch_core_state_machine.c:457 (sofia/sipinterface_1/1002@194.143.148.10) State INIT
2013-09-04 12:01:07.056568 [DEBUG] mod_sofia.c:87 sofia/sipinterface_1/1002@194.143.148.10 SOFIA INIT
2013-09-04 12:01:07.056568 [DEBUG] mod_sofia.c:114 (sofia/sipinterface_1/1002@194.143.148.10) State Change CS_INIT -> CS_ROUTING
2013-09-04 12:01:07.056568 [DEBUG] switch_core_session.c:1341 Send signal sofia/sipinterface_1/1002@194.143.148.10 [BREAK]
2013-09-04 12:01:07.056568 [DEBUG] switch_core_state_machine.c:457 (sofia/sipinterface_1/1002@194.143.148.10) State INIT going to sleep
2013-09-04 12:01:07.056568 [DEBUG] switch_core_state_machine.c:418 (sofia/sipinterface_1/1002@194.143.148.10) Running State Change CS_ROUTING
2013-09-04 12:01:07.056568 [DEBUG] switch_channel.c:2116 (sofia/sipinterface_1/1002@194.143.148.10) Callstate Change DOWN -> RINGING
2013-09-04 12:01:07.056568 [DEBUG] switch_core_state_machine.c:473 (sofia/sipinterface_1/1002@194.143.148.10) State ROUTING
2013-09-04 12:01:07.056568 [DEBUG] mod_sofia.c:137 sofia/sipinterface_1/1002@194.143.148.10 SOFIA ROUTING
2013-09-04 12:01:07.056568 [DEBUG] switch_core_state_machine.c:117 sofia/sipinterface_1/1002@194.143.148.10 Standard ROUTING
2013-09-04 12:01:07.056568 [INFO] mod_dialplan_xml.c:558 Processing 1002 <1002>->1003 in context default
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 parsing [default->record_session] continue=true
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Regex (PASS) [record_session] ${caller_id_number}(1002) =~ /^.+$/ break=on-false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action set(RECORD_TITLE=Recording ${destination_number} ${caller_id_number} ${strftime(%Y-%m-%d %H:%M)})
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action set(RECORD_SOFTWARE=FreeSWITCH)
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action set(RECORD_ARTIST=FreeSWITCH)
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action set(RECORD_COMMENT=FreeSWITCH)
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action set(RECORD_DATE=${strftime(%Y-%m-%d %H:%M)})
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action record_session(/usr/local/freeswitch/recordings/archive/${strftime(%Y)}/${strftime(%b)}/${strftime(%d)}/${strftime(%Y%m%d_%H%M%S)}_${caller_id_number}_${destination_number}.mp3)
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action set(RECORD_STEREO=true)
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 parsing [default->unloop] continue=false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Regex (PASS) [unloop] ${unroll_loops}(true) =~ /^true$/ break=on-false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Regex (FAIL) [unloop] ${sip_looped_call}() =~ /^true$/ break=on-false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 parsing [default->global-intercept] continue=false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Regex (FAIL) [global-intercept] destination_number(1003) =~ /^886$/ break=on-false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 parsing [default->group-intercept] continue=false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Regex (FAIL) [group-intercept] destination_number(1003) =~ /^\*8$/ break=on-false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 parsing [default->intercept-ext] continue=false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Regex (FAIL) [intercept-ext] destination_number(1003) =~ /^\*\*(\d+)$/ break=on-false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 parsing [default->redial] continue=false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Regex (FAIL) [redial] destination_number(1003) =~ /^(redial|870)$/ break=on-false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 parsing [default->global] continue=true
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Regex (FAIL) [global] ${call_debug}(false) =~ /^true$/ break=never
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Regex (FAIL) [global] ${rtp_has_crypto}() =~ /^(AES_CM_128_HMAC_SHA1_32|AES_CM_128_HMAC_SHA1_80)$/ break=never
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Regex (PASS) [global] ${endpoint_disposition}(DELAYED NEGOTIATION) =~ /^(DELAYED NEGOTIATION)/ break=on-false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Regex (FAIL) [global] ${switch_r_sdp}(v=0
o=- 336 0 IN IP4 10.1.4.157
s=SIP CALL
c=IN IP4 10.1.4.157
t=0 0
m=audio 60000 RTP/AVP 8 0 18 101
a=rtpmap:8 PCMA/8000
a=rtpmap:0 PCMU/8000
a=rtpmap:18 G729/8000
a=rtpmap:101 telephone-event/8000
a=fmtp:101 0-15
) =~ /(AES_CM_128_HMAC_SHA1_32|AES_CM_128_HMAC_SHA1_80)/ break=never
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Absolute Condition [global]
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action hash(insert/${domain_name}-spymap/${caller_id_number}/${uuid})
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action hash(insert/${domain_name}-last_dial/${caller_id_number}/${destination_number})
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action hash(insert/${domain_name}-last_dial/global/${uuid})
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action export(RFC2822_DATE=${strftime(%a, %d %b %Y %T %z)})
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 parsing [default->call_return] continue=false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Regex (FAIL) [call_return] destination_number(1003) =~ /^\*69$|^869$|^lcr$/ break=on-false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 parsing [default->del-group] continue=false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Regex (FAIL) [del-group] destination_number(1003) =~ /^80(\d{2})$/ break=on-false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 parsing [default->add-group] continue=false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Regex (FAIL) [add-group] destination_number(1003) =~ /^81(\d{2})$/ break=on-false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 parsing [default->call-group-simo] continue=false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Regex (FAIL) [call-group-simo] destination_number(1003) =~ /^82(\d{2})$/ break=on-false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 parsing [default->call-group-order] continue=false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Regex (FAIL) [call-group-order] destination_number(1003) =~ /^83(\d{2})$/ break=on-false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 parsing [default->extension-intercom] continue=false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Regex (FAIL) [extension-intercom] destination_number(1003) =~ /^8(10[01][0-9])$/ break=on-false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 parsing [default->Local_Extension] continue=false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Regex (PASS) [Local_Extension] destination_number(1003) =~ /^(10[01][0-9])$/ break=on-false
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action export(dialed_extension=1003)
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action bind_meta_app(1 b s execute_extension::dx XML features)
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action bind_meta_app(2 b s record_session::/usr/local/freeswitch/recordings/${caller_id_number}.${strftime(%Y-%m-%d-%H-%M-%S)}.wav)
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action bind_meta_app(3 b s execute_extension::cf XML features)
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action bind_meta_app(4 b s execute_extension::att_xfer XML features)
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action set(ringback=${us-ring})
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action set(transfer_ringback=local_stream://moh)
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action set(call_timeout=30)
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action set(hangup_after_bridge=true)
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action set(continue_on_fail=true)
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action hash(insert/${domain_name}-call_return/${dialed_extension}/${caller_id_number})
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action hash(insert/${domain_name}-last_dial_ext/${dialed_extension}/${uuid})
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action set(called_party_callgroup=${user_data(${dialed_extension}@${domain_name} var callgroup)})
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action hash(insert/${domain_name}-last_dial_ext/${called_party_callgroup}/${uuid})
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action hash(insert/${domain_name}-last_dial_ext/global/${uuid})
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action hash(insert/${domain_name}-last_dial/${called_party_callgroup}/${uuid})
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action bridge(user/${dialed_extension}@${domain_name})
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action answer()
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action sleep(1000)
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Action bridge(loopback/app=voicemail:default ${domain_name} ${dialed_extension})
2013-09-04 12:01:07.056568 [DEBUG] switch_core_state_machine.c:167 (sofia/sipinterface_1/1002@194.143.148.10) State Change CS_ROUTING -> CS_EXECUTE
2013-09-04 12:01:07.056568 [DEBUG] switch_core_session.c:1341 Send signal sofia/sipinterface_1/1002@194.143.148.10 [BREAK]
2013-09-04 12:01:07.056568 [DEBUG] switch_core_state_machine.c:473 (sofia/sipinterface_1/1002@194.143.148.10) State ROUTING going to sleep
2013-09-04 12:01:07.056568 [DEBUG] switch_core_state_machine.c:418 (sofia/sipinterface_1/1002@194.143.148.10) Running State Change CS_EXECUTE
2013-09-04 12:01:07.056568 [DEBUG] switch_core_state_machine.c:480 (sofia/sipinterface_1/1002@194.143.148.10) State EXECUTE
2013-09-04 12:01:07.056568 [DEBUG] mod_sofia.c:230 sofia/sipinterface_1/1002@194.143.148.10 SOFIA EXECUTE
2013-09-04 12:01:07.056568 [DEBUG] switch_core_state_machine.c:209 sofia/sipinterface_1/1002@194.143.148.10 Standard EXECUTE
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 set(RECORD_TITLE=Recording 1003 1002 2013-09-04 12:01)
2013-09-04 12:01:07.056568 [DEBUG] mod_dptools.c:1395 sofia/sipinterface_1/1002@194.143.148.10 SET [RECORD_TITLE]=[Recording 1003 1002 2013-09-04 12:01]
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 set(RECORD_SOFTWARE=FreeSWITCH)
2013-09-04 12:01:07.056568 [DEBUG] mod_dptools.c:1395 sofia/sipinterface_1/1002@194.143.148.10 SET [RECORD_SOFTWARE]=[FreeSWITCH]
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 set(RECORD_ARTIST=FreeSWITCH)
2013-09-04 12:01:07.076580 [DEBUG] mod_dptools.c:1395 sofia/sipinterface_1/1002@194.143.148.10 SET [RECORD_ARTIST]=[FreeSWITCH]
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 set(RECORD_COMMENT=FreeSWITCH)
2013-09-04 12:01:07.076580 [DEBUG] mod_dptools.c:1395 sofia/sipinterface_1/1002@194.143.148.10 SET [RECORD_COMMENT]=[FreeSWITCH]
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 set(RECORD_DATE=2013-09-04 12:01)
2013-09-04 12:01:07.076580 [DEBUG] mod_dptools.c:1395 sofia/sipinterface_1/1002@194.143.148.10 SET [RECORD_DATE]=[2013-09-04 12:01]
2013-09-04 12:01:07.076580 [DEBUG] switch_core_session.c:2597 Application record_session Requires media! pre_answering channel sofia/sipinterface_1/1002@194.143.148.10
2013-09-04 12:01:07.076580 [INFO] switch_core_session.c:2599 Sending early media
2013-09-04 12:01:07.076580 [DEBUG] switch_core_media.c:2885 Audio Codec Compare [PCMA:8:8000:20:64000]/[PCMU:0:8000:20:64000]
2013-09-04 12:01:07.076580 [DEBUG] switch_core_media.c:2885 Audio Codec Compare [PCMA:8:8000:20:64000]/[PCMA:8:8000:20:64000]
2013-09-04 12:01:07.076580 [DEBUG] switch_core_media.c:1918 Set Codec sofia/sipinterface_1/1002@194.143.148.10 PCMA/8000 20 ms 160 samples 64000 bits
2013-09-04 12:01:07.076580 [DEBUG] switch_core_codec.c:111 sofia/sipinterface_1/1002@194.143.148.10 Original read codec set to PCMA:8
2013-09-04 12:01:07.076580 [DEBUG] switch_core_media.c:3056 Set 2833 dtmf send/recv payload to 101
2013-09-04 12:01:07.076580 [INFO] switch_nat.c:590 NAT port mapping disabled
2013-09-04 12:01:07.076580 [DEBUG] switch_core_media.c:4087 AUDIO RTP [sofia/sipinterface_1/1002@194.143.148.10] 194.143.148.10 port 18768 -> 10.1.4.157 port 60000 codec: 8 ms: 20
2013-09-04 12:01:07.076580 [DEBUG] switch_rtp.c:2891 Starting timer [soft] 160 bytes per 20ms
2013-09-04 12:01:07.076580 [DEBUG] switch_core_media.c:4423 Set 2833 dtmf send payload to 101
2013-09-04 12:01:07.076580 [DEBUG] switch_core_media.c:4429 Set 2833 dtmf receive payload to 101
2013-09-04 12:01:07.076580 [NOTICE] sofia_media.c:92 Pre-Answer sofia/sipinterface_1/1002@194.143.148.10!
2013-09-04 12:01:07.076580 [DEBUG] switch_channel.c:3316 (sofia/sipinterface_1/1002@194.143.148.10) Callstate Change RINGING -> EARLY
2013-09-04 12:01:07.076580 [DEBUG] mod_sofia.c:2135 Ring SDP:
v=0
o=FreeSWITCH 1378244899 1378244900 IN IP4 194.143.148.10
s=FreeSWITCH
c=IN IP4 194.143.148.10
t=0 0
m=audio 18768 RTP/AVP 8 101
a=rtpmap:8 PCMA/8000
a=rtpmap:101 telephone-event/8000
a=fmtp:101 0-16
a=silenceSupp:off - - - -
a=ptime:20
a=sendrecv

2013-09-04 12:01:07.076580 [DEBUG] switch_core_session.c:861 Send signal sofia/sipinterface_1/1002@194.143.148.10 [BREAK]
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 record_session(/usr/local/freeswitch/recordings/archive/2013/Sep/04/20130904_120107_1002_1003.mp3)
2013-09-04 12:01:07.076580 [DEBUG] switch_core_session.c:1006 Send signal sofia/sipinterface_1/1002@194.143.148.10 [BREAK]
2013-09-04 12:01:07.076580 [DEBUG] sofia.c:5834 Channel sofia/sipinterface_1/1002@194.143.148.10 entering state [early][183]
2013-09-04 12:01:07.076580 [INFO] mod_shout.c:324 LAME 3.98.4 32bits (http://www.mp3dev.org/)
2013-09-04 12:01:07.076580 [INFO] mod_shout.c:324 Using polyphase lowpass filter, transition band:  3903 Hz -  4000 Hz
2013-09-04 12:01:07.076580 [DEBUG] switch_core_media_bug.c:532 Attaching BUG to sofia/sipinterface_1/1002@194.143.148.10
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 set(RECORD_STEREO=true)
2013-09-04 12:01:07.076580 [DEBUG] mod_dptools.c:1395 sofia/sipinterface_1/1002@194.143.148.10 SET [RECORD_STEREO]=[true]
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 hash(insert/194.143.148.10-spymap/1002/51d9ad582a0396635186532149bbc557@10.1.4.157)
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 hash(insert/194.143.148.10-last_dial/1002/1003)
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 hash(insert/194.143.148.10-last_dial/global/51d9ad582a0396635186532149bbc557@10.1.4.157)
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 export(RFC2822_DATE=Wed, 04 Sep 2013 12:01:07 +0900)
2013-09-04 12:01:07.076580 [DEBUG] switch_channel.c:1222 EXPORT (export_vars) [RFC2822_DATE]=[Wed, 04 Sep 2013 12:01:07 +0900]
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 export(dialed_extension=1003)
2013-09-04 12:01:07.076580 [DEBUG] switch_channel.c:1222 EXPORT (export_vars) [dialed_extension]=[1003]
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 bind_meta_app(1 b s execute_extension::dx XML features)
2013-09-04 12:01:07.076580 [INFO] switch_ivr_async.c:3628 Bound B-Leg: *1 execute_extension::dx XML features
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 bind_meta_app(2 b s record_session::/usr/local/freeswitch/recordings/1002.2013-09-04-12-01-07.wav)
2013-09-04 12:01:07.076580 [INFO] switch_ivr_async.c:3628 Bound B-Leg: *2 record_session::/usr/local/freeswitch/recordings/1002.2013-09-04-12-01-07.wav
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 bind_meta_app(3 b s execute_extension::cf XML features)
2013-09-04 12:01:07.096603 [INFO] switch_ivr_async.c:3628 Bound B-Leg: *3 execute_extension::cf XML features
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 bind_meta_app(4 b s execute_extension::att_xfer XML features)
2013-09-04 12:01:07.096603 [INFO] switch_ivr_async.c:3628 Bound B-Leg: *4 execute_extension::att_xfer XML features
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 set(ringback=%(2000,4000,440,480))
2013-09-04 12:01:07.096603 [DEBUG] mod_dptools.c:1395 sofia/sipinterface_1/1002@194.143.148.10 SET [ringback]=[%(2000,4000,440,480)]
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 set(transfer_ringback=local_stream://moh)
2013-09-04 12:01:07.096603 [DEBUG] mod_dptools.c:1395 sofia/sipinterface_1/1002@194.143.148.10 SET [transfer_ringback]=[local_stream://moh]
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 set(call_timeout=30)
2013-09-04 12:01:07.096603 [DEBUG] mod_dptools.c:1395 sofia/sipinterface_1/1002@194.143.148.10 SET [call_timeout]=[30]
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 set(hangup_after_bridge=true)
2013-09-04 12:01:07.096603 [DEBUG] mod_dptools.c:1395 sofia/sipinterface_1/1002@194.143.148.10 SET [hangup_after_bridge]=[true]
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 set(continue_on_fail=true)
2013-09-04 12:01:07.096603 [DEBUG] mod_dptools.c:1395 sofia/sipinterface_1/1002@194.143.148.10 SET [continue_on_fail]=[true]
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 hash(insert/194.143.148.10-call_return/1003/1002)
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 hash(insert/194.143.148.10-last_dial_ext/1003/51d9ad582a0396635186532149bbc557@10.1.4.157)
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 set(called_party_callgroup=)
2013-09-04 12:01:07.096603 [DEBUG] mod_dptools.c:1395 sofia/sipinterface_1/1002@194.143.148.10 SET [called_party_callgroup]=[UNDEF]
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 hash(insert/194.143.148.10-last_dial_ext//51d9ad582a0396635186532149bbc557@10.1.4.157)
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 hash(insert/194.143.148.10-last_dial_ext/global/51d9ad582a0396635186532149bbc557@10.1.4.157)
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 hash(insert/194.143.148.10-last_dial//51d9ad582a0396635186532149bbc557@10.1.4.157)
EXECUTE sofia/sipinterface_1/1002@194.143.148.10 bridge(user/1003@194.143.148.10)
2013-09-04 12:01:07.096603 [DEBUG] switch_channel.c:1176 sofia/sipinterface_1/1002@194.143.148.10 EXPORTING[export_vars] [domain_name]=[194.143.148.10] to event
2013-09-04 12:01:07.096603 [DEBUG] switch_channel.c:1176 sofia/sipinterface_1/1002@194.143.148.10 EXPORTING[export_vars] [RFC2822_DATE]=[Wed, 04 Sep 2013 12:01:07 +0900] to event
2013-09-04 12:01:07.096603 [DEBUG] switch_channel.c:1176 sofia/sipinterface_1/1002@194.143.148.10 EXPORTING[export_vars] [dialed_extension]=[1003] to event
2013-09-04 12:01:07.096603 [DEBUG] switch_ivr_originate.c:2060 Parsing global variables
2013-09-04 12:01:07.096603 [DEBUG] switch_channel.c:1176 sofia/sipinterface_1/1002@194.143.148.10 EXPORTING[export_vars] [domain_name]=[194.143.148.10] to event
2013-09-04 12:01:07.096603 [DEBUG] switch_channel.c:1176 sofia/sipinterface_1/1002@194.143.148.10 EXPORTING[export_vars] [RFC2822_DATE]=[Wed, 04 Sep 2013 12:01:07 +0900] to event
2013-09-04 12:01:07.096603 [DEBUG] switch_channel.c:1176 sofia/sipinterface_1/1002@194.143.148.10 EXPORTING[export_vars] [dialed_extension]=[1003] to event
2013-09-04 12:01:07.096603 [DEBUG] switch_ivr_originate.c:2060 Parsing global variables
2013-09-04 12:01:07.096603 [DEBUG] switch_event.c:1615 Parsing variable [sip_invite_domain]=[194.143.148.10]
2013-09-04 12:01:07.096603 [DEBUG] switch_event.c:1615 Parsing variable [leg_timeout]=[30]
2013-09-04 12:01:07.096603 [DEBUG] switch_event.c:1615 Parsing variable [presence_id]=[1003@194.143.148.10]
2013-09-04 12:01:07.096603 [NOTICE] switch_channel.c:1030 New Channel sofia/sipinterface_1/sip:1003@10.1.4.158:5060 [3e5a5da2-150e-11e3-8498-151e4fbc0d6e]
2013-09-04 12:01:07.096603 [DEBUG] mod_sofia.c:4468 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) State Change CS_NEW -> CS_INIT
2013-09-04 12:01:07.096603 [DEBUG] switch_core_session.c:1341 Send signal sofia/sipinterface_1/sip:1003@10.1.4.158:5060 [BREAK]
2013-09-04 12:01:07.096603 [DEBUG] switch_ivr_originate.c:2773 sofia/sipinterface_1/sip:1003@10.1.4.158:5060 Setting leg timeout to 30
2013-09-04 12:01:07.096603 [DEBUG] switch_core_state_machine.c:418 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) Running State Change CS_INIT
2013-09-04 12:01:07.096603 [DEBUG] switch_core_state_machine.c:457 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) State INIT
2013-09-04 12:01:07.096603 [DEBUG] mod_sofia.c:87 sofia/sipinterface_1/sip:1003@10.1.4.158:5060 SOFIA INIT
2013-09-04 12:01:07.096603 [INFO] switch_nat.c:590 NAT port mapping disabled
2013-09-04 12:01:07.096603 [DEBUG] sofia_glue.c:1190 sip:1003@10.1.4.158:5060 Setting proxy route to sofia/sipinterface_1/sip:1003@10.1.4.158:5060
2013-09-04 12:01:07.096603 [DEBUG] sofia_glue.c:1219 Local SDP:
v=0
o=FreeSWITCH 1378231409 1378231410 IN IP4 194.143.148.10
s=FreeSWITCH
c=IN IP4 194.143.148.10
t=0 0
m=audio 32258 RTP/AVP 8 101 13
a=rtpmap:101 telephone-event/8000
a=fmtp:101 0-16
a=ptime:20
a=sendrecv

2013-09-04 12:01:07.096603 [DEBUG] mod_sofia.c:114 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) State Change CS_INIT -> CS_ROUTING
2013-09-04 12:01:07.096603 [DEBUG] switch_core_session.c:1341 Send signal sofia/sipinterface_1/sip:1003@10.1.4.158:5060 [BREAK]
2013-09-04 12:01:07.096603 [DEBUG] switch_core_state_machine.c:457 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) State INIT going to sleep
2013-09-04 12:01:07.096603 [DEBUG] switch_core_state_machine.c:418 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) Running State Change CS_ROUTING
2013-09-04 12:01:07.096603 [DEBUG] switch_core_session.c:1006 Send signal sofia/sipinterface_1/sip:1003@10.1.4.158:5060 [BREAK]
2013-09-04 12:01:07.096603 [DEBUG] switch_core_state_machine.c:473 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) State ROUTING
2013-09-04 12:01:07.096603 [DEBUG] mod_sofia.c:137 sofia/sipinterface_1/sip:1003@10.1.4.158:5060 SOFIA ROUTING
2013-09-04 12:01:07.096603 [DEBUG] switch_ivr_originate.c:67 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) State Change CS_ROUTING -> CS_CONSUME_MEDIA
2013-09-04 12:01:07.096603 [DEBUG] switch_core_session.c:1341 Send signal sofia/sipinterface_1/sip:1003@10.1.4.158:5060 [BREAK]
2013-09-04 12:01:07.096603 [DEBUG] switch_core_state_machine.c:473 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) State ROUTING going to sleep
2013-09-04 12:01:07.096603 [DEBUG] switch_core_state_machine.c:418 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) Running State Change CS_CONSUME_MEDIA
2013-09-04 12:01:07.096603 [DEBUG] switch_core_state_machine.c:492 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) State CONSUME_MEDIA
2013-09-04 12:01:07.096603 [DEBUG] switch_core_state_machine.c:492 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) State CONSUME_MEDIA going to sleep
2013-09-04 12:01:07.096603 [DEBUG] sofia.c:5834 Channel sofia/sipinterface_1/sip:1003@10.1.4.158:5060 entering state [calling][0]
2013-09-04 12:01:07.496571 [DEBUG] switch_rtp.c:4918 Correct ip/port confirmed.
2013-09-04 12:01:07.496571 [DEBUG] switch_core_io.c:489 Setting BUG Codec PCMA:8
2013-09-04 12:01:07.556570 [DEBUG] switch_core_session.c:1006 Send signal sofia/sipinterface_1/sip:1003@10.1.4.158:5060 [BREAK]
2013-09-04 12:01:07.556570 [DEBUG] switch_core_session.c:1006 Send signal sofia/sipinterface_1/sip:1003@10.1.4.158:5060 [BREAK]
2013-09-04 12:01:07.556570 [DEBUG] sofia.c:5834 Channel sofia/sipinterface_1/sip:1003@10.1.4.158:5060 entering state [proceeding][180]
2013-09-04 12:01:07.556570 [NOTICE] sofia.c:5924 Ring-Ready sofia/sipinterface_1/sip:1003@10.1.4.158:5060!
2013-09-04 12:01:07.556570 [DEBUG] switch_channel.c:3180 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) Callstate Change DOWN -> RINGING
2013-09-04 12:01:07.596570 [DEBUG] switch_ivr_originate.c:1247 Raw Codec Activation Success L16@8000hz 1 channel 20ms
2013-09-04 12:01:07.596570 [DEBUG] switch_core_codec.c:219 sofia/sipinterface_1/1002@194.143.148.10 Push codec L16:70
2013-09-04 12:01:07.596570 [DEBUG] switch_ivr_originate.c:1315 Play Ringback Tone [%(2000,4000,440,480)]
2013-09-04 12:01:13.216568 [DEBUG] switch_core_session.c:1006 Send signal sofia/sipinterface_1/1002@194.143.148.10 [BREAK]
2013-09-04 12:01:13.216568 [DEBUG] switch_core_session.c:1006 Send signal sofia/sipinterface_1/1002@194.143.148.10 [BREAK]
2013-09-04 12:01:13.216568 [DEBUG] switch_core_session.c:1006 Send signal sofia/sipinterface_1/1002@194.143.148.10 [BREAK]
2013-09-04 12:01:13.236573 [DEBUG] sofia.c:5834 Channel sofia/sipinterface_1/1002@194.143.148.10 entering state [terminated][487]
2013-09-04 12:01:13.236573 [NOTICE] sofia.c:6642 Hangup sofia/sipinterface_1/1002@194.143.148.10 [CS_EXECUTE] [ORIGINATOR_CANCEL]
2013-09-04 12:01:13.236573 [DEBUG] switch_channel.c:3135 Send signal sofia/sipinterface_1/1002@194.143.148.10 [KILL]
2013-09-04 12:01:13.236573 [DEBUG] switch_core_session.c:1341 Send signal sofia/sipinterface_1/1002@194.143.148.10 [BREAK]
2013-09-04 12:01:13.236573 [DEBUG] switch_core_codec.c:244 sofia/sipinterface_1/1002@194.143.148.10 Restore previous codec PCMA:8.
2013-09-04 12:01:13.236573 [NOTICE] switch_ivr_originate.c:3410 Hangup sofia/sipinterface_1/sip:1003@10.1.4.158:5060 [CS_CONSUME_MEDIA] [ORIGINATOR_CANCEL]
2013-09-04 12:01:13.236573 [DEBUG] switch_channel.c:3135 Send signal sofia/sipinterface_1/sip:1003@10.1.4.158:5060 [KILL]
2013-09-04 12:01:13.236573 [DEBUG] switch_core_session.c:1341 Send signal sofia/sipinterface_1/sip:1003@10.1.4.158:5060 [BREAK]
2013-09-04 12:01:13.236573 [DEBUG] switch_ivr_originate.c:3626 Originate Cancelled by originator termination Cause: 487 [ORIGINATOR_CANCEL]
2013-09-04 12:01:13.236573 [DEBUG] switch_core_state_machine.c:418 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) Running State Change CS_HANGUP
2013-09-04 12:01:13.236573 [DEBUG] switch_core_state_machine.c:681 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) State HANGUP
2013-09-04 12:01:13.236573 [DEBUG] mod_sofia.c:459 sofia/sipinterface_1/sip:1003@10.1.4.158:5060 Overriding SIP cause 487 with 487 from the other leg
2013-09-04 12:01:13.236573 [DEBUG] mod_sofia.c:465 Channel sofia/sipinterface_1/sip:1003@10.1.4.158:5060 hanging up, cause: ORIGINATOR_CANCEL
2013-09-04 12:01:13.236573 [NOTICE] switch_ivr_originate.c:2661 Cannot create outgoing channel of type [user] cause: [ORIGINATOR_CANCEL]
2013-09-04 12:01:13.236573 [DEBUG] switch_ivr_originate.c:3632 Originate Resulted in Error Cause: 487 [ORIGINATOR_CANCEL]
2013-09-04 12:01:13.236573 [DEBUG] mod_sofia.c:527 Sending CANCEL to sofia/sipinterface_1/sip:1003@10.1.4.158:5060
2013-09-04 12:01:13.236573 [DEBUG] switch_core_state_machine.c:48 sofia/sipinterface_1/sip:1003@10.1.4.158:5060 Standard HANGUP, cause: ORIGINATOR_CANCEL
2013-09-04 12:01:13.236573 [DEBUG] switch_core_state_machine.c:681 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) State HANGUP going to sleep
2013-09-04 12:01:13.236573 [DEBUG] switch_core_state_machine.c:694 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) Callstate Change RINGING -> HANGUP
2013-09-04 12:01:13.236573 [DEBUG] switch_core_state_machine.c:449 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) State Change CS_HANGUP -> CS_REPORTING
2013-09-04 12:01:13.236573 [DEBUG] switch_core_session.c:1341 Send signal sofia/sipinterface_1/sip:1003@10.1.4.158:5060 [BREAK]
2013-09-04 12:01:13.236573 [DEBUG] switch_core_state_machine.c:418 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) Running State Change CS_REPORTING
2013-09-04 12:01:13.236573 [DEBUG] switch_core_state_machine.c:766 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) State REPORTING
2013-09-04 12:01:13.236573 [DEBUG] switch_core_state_machine.c:92 sofia/sipinterface_1/sip:1003@10.1.4.158:5060 Standard REPORTING, cause: ORIGINATOR_CANCEL
2013-09-04 12:01:13.236573 [DEBUG] switch_core_state_machine.c:766 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) State REPORTING going to sleep
2013-09-04 12:01:13.236573 [DEBUG] switch_core_state_machine.c:443 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) State Change CS_REPORTING -> CS_DESTROY
2013-09-04 12:01:13.236573 [DEBUG] switch_core_session.c:1341 Send signal sofia/sipinterface_1/sip:1003@10.1.4.158:5060 [BREAK]
2013-09-04 12:01:13.236573 [DEBUG] switch_core_session.c:1549 Session 57 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) Locked, Waiting on external entities
2013-09-04 12:01:13.236573 [NOTICE] switch_core_session.c:1567 Session 57 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) Ended
2013-09-04 12:01:13.236573 [NOTICE] switch_core_session.c:1571 Close Channel sofia/sipinterface_1/sip:1003@10.1.4.158:5060 [CS_DESTROY]
2013-09-04 12:01:13.236573 [DEBUG] switch_core_state_machine.c:568 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) Callstate Change HANGUP -> DOWN
2013-09-04 12:01:13.236573 [DEBUG] switch_core_state_machine.c:571 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) Running State Change CS_DESTROY
2013-09-04 12:01:13.236573 [INFO] mod_dptools.c:3194 Originate Failed.  Cause: ORIGINATOR_CANCEL
2013-09-04 12:01:13.236573 [DEBUG] switch_core_state_machine.c:581 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) State DESTROY
2013-09-04 12:01:13.236573 [DEBUG] mod_sofia.c:375 sofia/sipinterface_1/sip:1003@10.1.4.158:5060 SOFIA DESTROY
2013-09-04 12:01:13.236573 [DEBUG] switch_core_state_machine.c:99 sofia/sipinterface_1/sip:1003@10.1.4.158:5060 Standard DESTROY
2013-09-04 12:01:13.236573 [DEBUG] switch_core_state_machine.c:581 (sofia/sipinterface_1/sip:1003@10.1.4.158:5060) State DESTROY going to sleep
2013-09-04 12:01:13.236573 [DEBUG] switch_core_session.c:2760 sofia/sipinterface_1/1002@194.143.148.10 skip receive message [APPLICATION_EXEC_COMPLETE] (channel is hungup already)
2013-09-04 12:01:13.236573 [DEBUG] switch_core_state_machine.c:480 (sofia/sipinterface_1/1002@194.143.148.10) State EXECUTE going to sleep
2013-09-04 12:01:13.236573 [DEBUG] switch_core_state_machine.c:418 (sofia/sipinterface_1/1002@194.143.148.10) Running State Change CS_HANGUP
2013-09-04 12:01:13.236573 [DEBUG] switch_ivr_async.c:1175 Stop recording file /usr/local/freeswitch/recordings/archive/2013/Sep/04/20130904_120107_1002_1003.mp3
2013-09-04 12:01:13.276577 [DEBUG] switch_core_media_bug.c:780 Removing BUG from sofia/sipinterface_1/1002@194.143.148.10
2013-09-04 12:01:13.276577 [DEBUG] switch_core_state_machine.c:681 (sofia/sipinterface_1/1002@194.143.148.10) State HANGUP
2013-09-04 12:01:13.276577 [DEBUG] mod_sofia.c:465 Channel sofia/sipinterface_1/1002@194.143.148.10 hanging up, cause: ORIGINATOR_CANCEL
2013-09-04 12:01:13.276577 [DEBUG] switch_core_state_machine.c:48 sofia/sipinterface_1/1002@194.143.148.10 Standard HANGUP, cause: ORIGINATOR_CANCEL
2013-09-04 12:01:13.276577 [DEBUG] switch_core_state_machine.c:681 (sofia/sipinterface_1/1002@194.143.148.10) State HANGUP going to sleep
2013-09-04 12:01:13.276577 [DEBUG] switch_core_state_machine.c:694 (sofia/sipinterface_1/1002@194.143.148.10) Callstate Change EARLY -> HANGUP
2013-09-04 12:01:13.276577 [DEBUG] switch_core_state_machine.c:449 (sofia/sipinterface_1/1002@194.143.148.10) State Change CS_HANGUP -> CS_REPORTING
2013-09-04 12:01:13.276577 [DEBUG] switch_core_session.c:1341 Send signal sofia/sipinterface_1/1002@194.143.148.10 [BREAK]
2013-09-04 12:01:13.276577 [DEBUG] switch_core_state_machine.c:418 (sofia/sipinterface_1/1002@194.143.148.10) Running State Change CS_REPORTING
2013-09-04 12:01:13.276577 [DEBUG] switch_core_state_machine.c:766 (sofia/sipinterface_1/1002@194.143.148.10) State REPORTING
2013-09-04 12:01:13.276577 [DEBUG] switch_core_state_machine.c:92 sofia/sipinterface_1/1002@194.143.148.10 Standard REPORTING, cause: ORIGINATOR_CANCEL
2013-09-04 12:01:13.276577 [DEBUG] switch_core_state_machine.c:766 (sofia/sipinterface_1/1002@194.143.148.10) State REPORTING going to sleep
2013-09-04 12:01:13.276577 [DEBUG] switch_core_state_machine.c:443 (sofia/sipinterface_1/1002@194.143.148.10) State Change CS_REPORTING -> CS_DESTROY
2013-09-04 12:01:13.276577 [DEBUG] switch_core_session.c:1341 Send signal sofia/sipinterface_1/1002@194.143.148.10 [BREAK]
2013-09-04 12:01:13.276577 [DEBUG] switch_core_session.c:1549 Session 56 (sofia/sipinterface_1/1002@194.143.148.10) Locked, Waiting on external entities
2013-09-04 12:01:13.276577 [NOTICE] switch_core_session.c:1567 Session 56 (sofia/sipinterface_1/1002@194.143.148.10) Ended
2013-09-04 12:01:13.276577 [NOTICE] switch_core_session.c:1571 Close Channel sofia/sipinterface_1/1002@194.143.148.10 [CS_DESTROY]
2013-09-04 12:01:13.276577 [DEBUG] switch_core_state_machine.c:568 (sofia/sipinterface_1/1002@194.143.148.10) Callstate Change HANGUP -> DOWN
2013-09-04 12:01:13.276577 [DEBUG] switch_core_state_machine.c:571 (sofia/sipinterface_1/1002@194.143.148.10) Running State Change CS_DESTROY
2013-09-04 12:01:13.276577 [DEBUG] switch_core_state_machine.c:581 (sofia/sipinterface_1/1002@194.143.148.10) State DESTROY
2013-09-04 12:01:13.276577 [DEBUG] mod_sofia.c:375 sofia/sipinterface_1/1002@194.143.148.10 SOFIA DESTROY
2013-09-04 12:01:13.276577 [DEBUG] switch_core_state_machine.c:99 sofia/sipinterface_1/1002@194.143.148.10 Standard DESTROY
2013-09-04 12:01:13.276577 [DEBUG] switch_core_state_machine.c:581 (sofia/sipinterface_1/1002@194.143.148.10) State DESTROY going to sleep


Вернуться к началу
 Профиль  
 
 Заголовок сообщения: Re: Переадресация с IVR
СообщениеДобавлено: 04 сен 2013 07:55 
FreeSWITCH_GuRu

Зарегистрирован: 22 авг 2012 09:52
Сообщения: 1710
приземляется на
Dialplan: sofia/sipinterface_1/1002@194.143.148.10 Regex (PASS) [Local_Extension] destination_number(1003) =~ /^(10[01][0-9])$/ break=on-false

<extension name="Check IVR-based CF" continue="true"> нет перед ним

_________________
ЛС: @rostel
Сообщество: @ru_freeswitch


Вернуться к началу
 Профиль  
 
 Заголовок сообщения: Re: Переадресация с IVR
СообщениеДобавлено: 04 сен 2013 08:00 

Зарегистрирован: 07 июн 2013 10:17
Сообщения: 122
Вот жеж... Дурная привычка складывать всё в самый низ диалплана :) Теперь буду знать, что положение в диалплане имеет значение:)
Спасибо!


Вернуться к началу
 Профиль  
 
Показать сообщения за:  Поле сортировки  
Начать новую тему Ответить на тему  [ Сообщений: 19 ]  На страницу Пред.  1, 2

Часовой пояс: UTC + 4 часа


Кто сейчас на конференции

Сейчас этот форум просматривают: нет зарегистрированных пользователей и гости: 31


Вы не можете начинать темы
Вы не можете отвечать на сообщения
Вы не можете редактировать свои сообщения
Вы не можете удалять свои сообщения
Вы не можете добавлять вложения

Найти:
Перейти:  
cron
Powered by phpBB® Forum Software © phpBB Group
Русская поддержка phpBB