[2011-05-25 10:47:12] -- Executing [6500@debcomainbtn-management:100] Page("SIP/406-00001352", "Local/408@debcomainbtn-local-paging&Local/222@debcomainbtn-local-paging&Local/224@debcomainbtn-local-paging&Local/225@debcomainbtn-local-paging&Local/226@debcomainbtn-local-paging&Local/227@debcomainbtn-local-paging&Local/229@debcomainbtn-local-paging&Local/230@debcomainbtn-local-paging&Local/231@debcomainbtn-local-paging&Local/233@debcomainbtn-local-paging&Local/234@debcomainbtn-local-paging&Local/236@debcomainbtn-local-paging&Local/238@debcomainbtn-local-paging&Local/239@debcomainbtn-local-paging&Local/240@debcomainbtn-local-paging&Local/242@debcomainbtn-local-paging&Local/244@debcomainbtn-local-paging&Local/246@debcomainbtn-local-paging&Local/248@debcomainbtn-local-paging&Local/249@debcomainbtn-local-paging&Local/251@debcomainbtn-local-paging&Local/252@debcomainbtn-local-paging&Local/253@debcomainbtn-local-paging&Local/254@debcomainbtn-local-paging&Local/255@debcomainbtn-local-paging&Local/257@debcomainbtn-local-paging&Local/258@debcomainbtn-local-paging&Local/261@debcomainbtn-local-paging&Local/262@debcomainbtn-local-paging&Local/263@debcomainbtn-local-paging&Local/264@debcomainbtn-local-paging&Local/265@debcomainbtn-local-paging&Local/266@debcomainbtn-local-paging&Local/269@debcomainbtn-local-paging&Local/270@debcomainbtn-local-paging&Local/272@debcomainbtn-local-paging&Local/274@debcomainbtn-local-paging&Local/277@debcomainbtn-local-paging&Local/278@debcomainbtn-local-paging&Local/279@debcomainbtn-local-paging&Local/280@debcomainbtn-local-paging&Local/282@debcomainbtn-local-paging&Local/285@debcomainbtn-local-paging&Local/287@debcomainbtn-local-paging&Local/288@debcomainbtn-local-paging&Local/289@debcomainbtn-local-paging&Local/290@debcomainbtn-local-paging&Local/291@debcomainbtn-local-paging&Local/292@debcomainbtn-local-paging&Local/293@debcomainbtn-local-paging&Local/294@debcomainbtn-local-paging&Local/295@debcomainbtn-local-paging&Local/297@debcomainbtn-local-paging&Local/298@debcomainbtn-local-paging&Local/299@debcomainbtn-local-paging&Local/312@debcomainbtn-local-paging&Local/314@debcomainbtn-local-paging&Local/319@debcomainbtn-local-paging&Local/320@debcomainbtn-local-paging&Local/321@debcomainbtn-local-paging&Local/322@debcomainbtn-local-paging&Local/323@debcomainbtn-local-paging&Local/324@debcomainbtn-local-paging&Local/327@debcomainbtn-local-paging&Local/330@debcomainbtn-local-paging&Local/331@debcomainbtn-local-paging&Local/335@debcomainbtn-local-paging&Local/344@debcomainbtn-local-paging&Local/350@debcomainbtn-local-paging") in new stack [2011-05-25 10:47:12] -- Called 408@debcomainbtn-local-paging [2011-05-25 10:47:12] -- Called 222@debcomainbtn-local-paging [2011-05-25 10:47:12] -- Called 224@debcomainbtn-local-paging [2011-05-25 10:47:12] -- Executing [408@debcomainbtn-local-paging:1] NoCDR("Local/408@debcomainbtn-local-paging-691f,2", "") in new stack [2011-05-25 10:47:12] -- Executing [408@debcomainbtn-local-paging:2] Set("Local/408@debcomainbtn-local-paging-691f,2", "LOCAL_EXTEN=408") in new stack [2011-05-25 10:47:12] -- Executing [408@debcomainbtn-local-paging:3] SIPAddHeader("Local/408@debcomainbtn-local-paging-691f,2", "Alert-Info: Auto Answer") in new stack [2011-05-25 10:47:12] -- Executing [408@debcomainbtn-local-paging:4] SIPAddHeader("Local/408@debcomainbtn-local-paging-691f,2", "Alert-Info: ") in new stack [2011-05-25 10:47:12] -- Executing [222@debcomainbtn-local-paging:1] NoCDR("Local/222@debcomainbtn-local-paging-bce9,2", "") in new stack [2011-05-25 10:47:12] -- Executing [408@debcomainbtn-local-paging:5] Set("Local/408@debcomainbtn-local-paging-691f,2", "LOCAL_CHANNEL=SIP/408") in new stack [2011-05-25 10:47:12] -- Executing [408@debcomainbtn-local-paging:6] Gosub("Local/408@debcomainbtn-local-paging-691f,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:12] -- Executing [222@debcomainbtn-local-paging:2] Set("Local/222@debcomainbtn-local-paging-bce9,2", "LOCAL_EXTEN=222") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:1] Set("Local/408@debcomainbtn-local-paging-691f,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [224@debcomainbtn-local-paging:1] NoCDR("Local/224@debcomainbtn-local-paging-8722,2", "") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:2] Set("Local/408@debcomainbtn-local-paging-691f,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [224@debcomainbtn-local-paging:2] Set("Local/224@debcomainbtn-local-paging-8722,2", "LOCAL_EXTEN=224") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:3] GotoIf("Local/408@debcomainbtn-local-paging-691f,2", "0?6") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:4] Set("Local/408@debcomainbtn-local-paging-691f,2", "OUTBOUND_GROUP=408@INCOMING") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:5] Dial("Local/408@debcomainbtn-local-paging-691f,2", "SIP/408|5") in new stack [2011-05-25 10:47:12] -- Called 408 [2011-05-25 10:47:12] Extension Changed 408[debcomainbtn-local] new state Ringing for Notify User 335 [2011-05-25 10:47:12] -- Executing [222@debcomainbtn-local-paging:3] SIPAddHeader("Local/222@debcomainbtn-local-paging-bce9,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:12] -- Executing [222@debcomainbtn-local-paging:4] Set("Local/222@debcomainbtn-local-paging-bce9,2", "LOCAL_CHANNEL=SIP/222") in new stack [2011-05-25 10:47:12] -- Executing [222@debcomainbtn-local-paging:5] Gosub("Local/222@debcomainbtn-local-paging-bce9,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:1] Set("Local/222@debcomainbtn-local-paging-bce9,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:2] Set("Local/222@debcomainbtn-local-paging-bce9,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:3] GotoIf("Local/222@debcomainbtn-local-paging-bce9,2", "0?6") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:4] Set("Local/222@debcomainbtn-local-paging-bce9,2", "OUTBOUND_GROUP=222@INCOMING") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:5] Dial("Local/222@debcomainbtn-local-paging-bce9,2", "SIP/222|5") in new stack [2011-05-25 10:47:12] WARNING[23490]: app_dial.c:1323 dial_exec_full: Unable to create channel of type 'SIP' (cause 20 - Unknown) [2011-05-25 10:47:12] == Everyone is busy/congested at this time (1:0/0/1) [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:6] Hangup("Local/222@debcomainbtn-local-paging-bce9,2", "20") in new stack [2011-05-25 10:47:12] == Spawn extension (all-local-extension, paging, 6) exited non-zero on 'Local/222@debcomainbtn-local-paging-bce9,2' [2011-05-25 10:47:12] -- Executing [224@debcomainbtn-local-paging:3] SIPAddHeader("Local/224@debcomainbtn-local-paging-8722,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:12] -- Executing [224@debcomainbtn-local-paging:4] Set("Local/224@debcomainbtn-local-paging-8722,2", "LOCAL_CHANNEL=SIP/224") in new stack [2011-05-25 10:47:12] -- Executing [224@debcomainbtn-local-paging:5] Gosub("Local/224@debcomainbtn-local-paging-8722,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:1] Set("Local/224@debcomainbtn-local-paging-8722,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:2] Set("Local/224@debcomainbtn-local-paging-8722,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:3] GotoIf("Local/224@debcomainbtn-local-paging-8722,2", "0?6") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:4] Set("Local/224@debcomainbtn-local-paging-8722,2", "OUTBOUND_GROUP=224@INCOMING") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:5] Dial("Local/224@debcomainbtn-local-paging-8722,2", "SIP/224|5") in new stack [2011-05-25 10:47:12] -- Called 224 [2011-05-25 10:47:12] -- Called 225@debcomainbtn-local-paging [2011-05-25 10:47:12] NOTICE[23487]: chan_local.c:612 local_call: No such extension/context 226@debcomainbtn-local-paging while calling Local channel [2011-05-25 10:47:12] -- Executing [225@debcomainbtn-local-paging:1] NoCDR("Local/225@debcomainbtn-local-paging-1060,2", "") in new stack [2011-05-25 10:47:12] -- Executing [225@debcomainbtn-local-paging:2] Set("Local/225@debcomainbtn-local-paging-1060,2", "LOCAL_EXTEN=225") in new stack [2011-05-25 10:47:12] -- Executing [225@debcomainbtn-local-paging:3] SIPAddHeader("Local/225@debcomainbtn-local-paging-1060,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:12] -- Executing [225@debcomainbtn-local-paging:4] Set("Local/225@debcomainbtn-local-paging-1060,2", "LOCAL_CHANNEL=SIP/225") in new stack [2011-05-25 10:47:12] Extension Changed 224[debcomainbtn-local] new state Ringing for Notify User 335 [2011-05-25 10:47:12] -- Executing [225@debcomainbtn-local-paging:5] Gosub("Local/225@debcomainbtn-local-paging-1060,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:1] Set("Local/225@debcomainbtn-local-paging-1060,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:2] Set("Local/225@debcomainbtn-local-paging-1060,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:3] GotoIf("Local/225@debcomainbtn-local-paging-1060,2", "0?6") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:4] Set("Local/225@debcomainbtn-local-paging-1060,2", "OUTBOUND_GROUP=225@INCOMING") in new stack [2011-05-25 10:47:12] -- Called 227@debcomainbtn-local-paging [2011-05-25 10:47:12] -- Called 229@debcomainbtn-local-paging [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:5] Dial("Local/225@debcomainbtn-local-paging-1060,2", "SIP/225|5") in new stack [2011-05-25 10:47:12] -- Executing [227@debcomainbtn-local-paging:1] NoCDR("Local/227@debcomainbtn-local-paging-d7b4,2", "") in new stack [2011-05-25 10:47:12] -- Executing [227@debcomainbtn-local-paging:2] Set("Local/227@debcomainbtn-local-paging-d7b4,2", "LOCAL_EXTEN=227") in new stack [2011-05-25 10:47:12] -- Executing [227@debcomainbtn-local-paging:3] SIPAddHeader("Local/227@debcomainbtn-local-paging-d7b4,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:12] -- Executing [227@debcomainbtn-local-paging:4] Set("Local/227@debcomainbtn-local-paging-d7b4,2", "LOCAL_CHANNEL=SIP/227") in new stack [2011-05-25 10:47:12] -- Executing [227@debcomainbtn-local-paging:5] Gosub("Local/227@debcomainbtn-local-paging-d7b4,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:1] Set("Local/227@debcomainbtn-local-paging-d7b4,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:2] Set("Local/227@debcomainbtn-local-paging-d7b4,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:3] GotoIf("Local/227@debcomainbtn-local-paging-d7b4,2", "0?6") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:4] Set("Local/227@debcomainbtn-local-paging-d7b4,2", "OUTBOUND_GROUP=227@INCOMING") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:5] Dial("Local/227@debcomainbtn-local-paging-d7b4,2", "SIP/227|5") in new stack [2011-05-25 10:47:12] -- Called 227 [2011-05-25 10:47:12] -- Executing [229@debcomainbtn-local-paging:1] NoCDR("Local/229@debcomainbtn-local-paging-5ed7,2", "") in new stack [2011-05-25 10:47:12] -- Executing [229@debcomainbtn-local-paging:2] Set("Local/229@debcomainbtn-local-paging-5ed7,2", "LOCAL_EXTEN=229") in new stack [2011-05-25 10:47:12] -- Executing [229@debcomainbtn-local-paging:3] SIPAddHeader("Local/229@debcomainbtn-local-paging-5ed7,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:12] -- Executing [229@debcomainbtn-local-paging:4] Set("Local/229@debcomainbtn-local-paging-5ed7,2", "LOCAL_CHANNEL=SIP/229") in new stack [2011-05-25 10:47:12] -- Executing [229@debcomainbtn-local-paging:5] Gosub("Local/229@debcomainbtn-local-paging-5ed7,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:1] Set("Local/229@debcomainbtn-local-paging-5ed7,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:2] Set("Local/229@debcomainbtn-local-paging-5ed7,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:3] GotoIf("Local/229@debcomainbtn-local-paging-5ed7,2", "0?6") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:4] Set("Local/229@debcomainbtn-local-paging-5ed7,2", "OUTBOUND_GROUP=229@INCOMING") in new stack [2011-05-25 10:47:12] Extension Changed 227[debcomainbtn-local] new state Ringing for Notify User 335 [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:5] Dial("Local/229@debcomainbtn-local-paging-5ed7,2", "SIP/229|5") in new stack [2011-05-25 10:47:12] -- Called 229 [2011-05-25 10:47:12] -- Called 230@debcomainbtn-local-paging [2011-05-25 10:47:12] -- Called 231@debcomainbtn-local-paging [2011-05-25 10:47:12] Extension Changed 225[debcomainbtn-local] new state Ringing for Notify User 335 [2011-05-25 10:47:12] NOTICE[23487]: chan_local.c:612 local_call: No such extension/context 233@debcomainbtn-local-paging while calling Local channel [2011-05-25 10:47:12] -- Executing [230@debcomainbtn-local-paging:1] NoCDR("Local/230@debcomainbtn-local-paging-3459,2", "") in new stack [2011-05-25 10:47:12] -- Executing [230@debcomainbtn-local-paging:2] Set("Local/230@debcomainbtn-local-paging-3459,2", "LOCAL_EXTEN=230") in new stack [2011-05-25 10:47:12] -- Executing [230@debcomainbtn-local-paging:3] SIPAddHeader("Local/230@debcomainbtn-local-paging-3459,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:12] -- Executing [230@debcomainbtn-local-paging:4] Set("Local/230@debcomainbtn-local-paging-3459,2", "LOCAL_CHANNEL=SIP/230") in new stack [2011-05-25 10:47:12] -- Executing [230@debcomainbtn-local-paging:5] Gosub("Local/230@debcomainbtn-local-paging-3459,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:1] Set("Local/230@debcomainbtn-local-paging-3459,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:2] Set("Local/230@debcomainbtn-local-paging-3459,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:3] GotoIf("Local/230@debcomainbtn-local-paging-3459,2", "0?6") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:4] Set("Local/230@debcomainbtn-local-paging-3459,2", "OUTBOUND_GROUP=230@INCOMING") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:5] Dial("Local/230@debcomainbtn-local-paging-3459,2", "SIP/230|5") in new stack [2011-05-25 10:47:12] -- Called 230 [2011-05-25 10:47:12] -- Called 234@debcomainbtn-local-paging [2011-05-25 10:47:12] -- Called 236@debcomainbtn-local-paging [2011-05-25 10:47:12] -- Executing [234@debcomainbtn-local-paging:1] NoCDR("Local/234@debcomainbtn-local-paging-2429,2", "") in new stack [2011-05-25 10:47:12] -- Executing [234@debcomainbtn-local-paging:2] Set("Local/234@debcomainbtn-local-paging-2429,2", "LOCAL_EXTEN=234") in new stack [2011-05-25 10:47:12] -- Executing [234@debcomainbtn-local-paging:3] SIPAddHeader("Local/234@debcomainbtn-local-paging-2429,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:12] -- Executing [234@debcomainbtn-local-paging:4] Set("Local/234@debcomainbtn-local-paging-2429,2", "LOCAL_CHANNEL=SIP/234") in new stack [2011-05-25 10:47:12] -- Executing [234@debcomainbtn-local-paging:5] Gosub("Local/234@debcomainbtn-local-paging-2429,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:1] Set("Local/234@debcomainbtn-local-paging-2429,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] Extension Changed 230[debcomainbtn-local] new state Ringing for Notify User 335 [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:2] Set("Local/234@debcomainbtn-local-paging-2429,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:3] GotoIf("Local/234@debcomainbtn-local-paging-2429,2", "0?6") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:4] Set("Local/234@debcomainbtn-local-paging-2429,2", "OUTBOUND_GROUP=234@INCOMING") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:5] Dial("Local/234@debcomainbtn-local-paging-2429,2", "SIP/234|5") in new stack [2011-05-25 10:47:12] -- Called 234 [2011-05-25 10:47:12] -- Executing [236@debcomainbtn-local-paging:1] NoCDR("Local/236@debcomainbtn-local-paging-dee9,2", "") in new stack [2011-05-25 10:47:12] -- Executing [236@debcomainbtn-local-paging:2] Set("Local/236@debcomainbtn-local-paging-dee9,2", "LOCAL_EXTEN=236") in new stack [2011-05-25 10:47:12] -- Executing [236@debcomainbtn-local-paging:3] SIPAddHeader("Local/236@debcomainbtn-local-paging-dee9,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:12] -- Executing [236@debcomainbtn-local-paging:4] Set("Local/236@debcomainbtn-local-paging-dee9,2", "LOCAL_CHANNEL=SIP/236") in new stack [2011-05-25 10:47:12] -- Called 225 [2011-05-25 10:47:12] -- Executing [231@debcomainbtn-local-paging:1] NoCDR("Local/231@debcomainbtn-local-paging-413b,2", "") in new stack [2011-05-25 10:47:12] -- Executing [236@debcomainbtn-local-paging:5] Gosub("Local/236@debcomainbtn-local-paging-dee9,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:12] -- Executing [231@debcomainbtn-local-paging:2] Set("Local/231@debcomainbtn-local-paging-413b,2", "LOCAL_EXTEN=231") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:1] Set("Local/236@debcomainbtn-local-paging-dee9,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [231@debcomainbtn-local-paging:3] SIPAddHeader("Local/231@debcomainbtn-local-paging-413b,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:2] Set("Local/236@debcomainbtn-local-paging-dee9,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:3] GotoIf("Local/236@debcomainbtn-local-paging-dee9,2", "0?6") in new stack [2011-05-25 10:47:12] -- Executing [231@debcomainbtn-local-paging:4] Set("Local/231@debcomainbtn-local-paging-413b,2", "LOCAL_CHANNEL=SIP/231") in new stack [2011-05-25 10:47:12] -- Called 238@debcomainbtn-local-paging [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:4] Set("Local/236@debcomainbtn-local-paging-dee9,2", "OUTBOUND_GROUP=236@INCOMING") in new stack [2011-05-25 10:47:12] -- Executing [238@debcomainbtn-local-paging:1] NoCDR("Local/238@debcomainbtn-local-paging-2ae0,2", "") in new stack [2011-05-25 10:47:12] -- Executing [231@debcomainbtn-local-paging:5] Gosub("Local/231@debcomainbtn-local-paging-413b,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:12] -- Called 239@debcomainbtn-local-paging [2011-05-25 10:47:12] -- SIP/408-00001353 is ringing [2011-05-25 10:47:12] -- Executing [238@debcomainbtn-local-paging:2] Set("Local/238@debcomainbtn-local-paging-2ae0,2", "LOCAL_EXTEN=238") in new stack [2011-05-25 10:47:12] -- Executing [239@debcomainbtn-local-paging:1] NoCDR("Local/239@debcomainbtn-local-paging-486b,2", "") in new stack [2011-05-25 10:47:12] -- Local/408@debcomainbtn-local-paging-691f,1 is ringing [2011-05-25 10:47:12] NOTICE[23487]: chan_local.c:612 local_call: No such extension/context 240@debcomainbtn-local-paging while calling Local channel [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:5] Dial("Local/236@debcomainbtn-local-paging-dee9,2", "SIP/236|5") in new stack [2011-05-25 10:47:12] -- SIP/224-00001354 answered Local/224@debcomainbtn-local-paging-8722,2 [2011-05-25 10:47:12] -- Local/224@debcomainbtn-local-paging-8722,1 answered [2011-05-25 10:47:12] -- Created MeetMe conference 1023 for conference '920363340d' [2011-05-25 10:47:12] -- Called 242@debcomainbtn-local-paging [2011-05-25 10:47:12] -- Called 244@debcomainbtn-local-paging [2011-05-25 10:47:12] -- Executing [242@debcomainbtn-local-paging:1] NoCDR("Local/242@debcomainbtn-local-paging-a014,2", "") in new stack [2011-05-25 10:47:12] -- Executing [238@debcomainbtn-local-paging:3] SIPAddHeader("Local/238@debcomainbtn-local-paging-2ae0,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:12] -- Executing [242@debcomainbtn-local-paging:2] Set("Local/242@debcomainbtn-local-paging-a014,2", "LOCAL_EXTEN=242") in new stack [2011-05-25 10:47:12] -- Executing [244@debcomainbtn-local-paging:1] NoCDR("Local/244@debcomainbtn-local-paging-ab9c,2", "") in new stack [2011-05-25 10:47:12] -- Executing [239@debcomainbtn-local-paging:2] Set("Local/239@debcomainbtn-local-paging-486b,2", "LOCAL_EXTEN=239") in new stack [2011-05-25 10:47:12] Extension Changed 224[debcomainbtn-local] new state InUse for Notify User 335 [2011-05-25 10:47:12] -- Called 236 [2011-05-25 10:47:12] -- Executing [244@debcomainbtn-local-paging:2] Set("Local/244@debcomainbtn-local-paging-ab9c,2", "LOCAL_EXTEN=244") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:1] Set("Local/231@debcomainbtn-local-paging-413b,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [238@debcomainbtn-local-paging:4] Set("Local/238@debcomainbtn-local-paging-2ae0,2", "LOCAL_CHANNEL=SIP/238") in new stack [2011-05-25 10:47:12] -- Called 246@debcomainbtn-local-paging [2011-05-25 10:47:12] -- Executing [244@debcomainbtn-local-paging:3] SIPAddHeader("Local/244@debcomainbtn-local-paging-ab9c,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:2] Set("Local/231@debcomainbtn-local-paging-413b,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [239@debcomainbtn-local-paging:3] SIPAddHeader("Local/239@debcomainbtn-local-paging-486b,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:12] -- Executing [238@debcomainbtn-local-paging:5] Gosub("Local/238@debcomainbtn-local-paging-2ae0,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:12] -- Executing [244@debcomainbtn-local-paging:4] Set("Local/244@debcomainbtn-local-paging-ab9c,2", "LOCAL_CHANNEL=SIP/244") in new stack [2011-05-25 10:47:12] -- Executing [246@debcomainbtn-local-paging:1] NoCDR("Local/246@debcomainbtn-local-paging-197f,2", "") in new stack [2011-05-25 10:47:12] -- Called 248@debcomainbtn-local-paging [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:1] Set("Local/238@debcomainbtn-local-paging-2ae0,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:2] Set("Local/238@debcomainbtn-local-paging-2ae0,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:3] GotoIf("Local/238@debcomainbtn-local-paging-2ae0,2", "0?6") in new stack [2011-05-25 10:47:12] -- Executing [248@debcomainbtn-local-paging:1] NoCDR("Local/248@debcomainbtn-local-paging-1271,2", "") in new stack [2011-05-25 10:47:12] -- Executing [242@debcomainbtn-local-paging:3] SIPAddHeader("Local/242@debcomainbtn-local-paging-a014,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:12] -- Executing [248@debcomainbtn-local-paging:2] Set("Local/248@debcomainbtn-local-paging-1271,2", "LOCAL_EXTEN=248") in new stack [2011-05-25 10:47:12] Extension Changed 236[debcomainbtn-local] new state Ringing for Notify User 335 [2011-05-25 10:47:12] -- Executing [248@debcomainbtn-local-paging:3] SIPAddHeader("Local/248@debcomainbtn-local-paging-1271,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:4] Set("Local/238@debcomainbtn-local-paging-2ae0,2", "OUTBOUND_GROUP=238@INCOMING") in new stack [2011-05-25 10:47:12] -- Called 249@debcomainbtn-local-paging [2011-05-25 10:47:12] -- Executing [248@debcomainbtn-local-paging:4] Set("Local/248@debcomainbtn-local-paging-1271,2", "LOCAL_CHANNEL=SIP/248") in new stack [2011-05-25 10:47:12] -- Executing [244@debcomainbtn-local-paging:5] Gosub("Local/244@debcomainbtn-local-paging-ab9c,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:12] -- Executing [249@debcomainbtn-local-paging:1] NoCDR("Local/249@debcomainbtn-local-paging-54b5,2", "") in new stack [2011-05-25 10:47:12] -- Executing [248@debcomainbtn-local-paging:5] Gosub("Local/248@debcomainbtn-local-paging-1271,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:12] -- Executing [246@debcomainbtn-local-paging:2] Set("Local/246@debcomainbtn-local-paging-197f,2", "LOCAL_EXTEN=246") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:1] Set("Local/244@debcomainbtn-local-paging-ab9c,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [246@debcomainbtn-local-paging:3] SIPAddHeader("Local/246@debcomainbtn-local-paging-197f,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:12] -- Executing [242@debcomainbtn-local-paging:4] Set("Local/242@debcomainbtn-local-paging-a014,2", "LOCAL_CHANNEL=SIP/242") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:3] GotoIf("Local/231@debcomainbtn-local-paging-413b,2", "0?6") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:1] Set("Local/248@debcomainbtn-local-paging-1271,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [239@debcomainbtn-local-paging:4] Set("Local/239@debcomainbtn-local-paging-486b,2", "LOCAL_CHANNEL=SIP/239") in new stack [2011-05-25 10:47:12] -- Executing [242@debcomainbtn-local-paging:5] Gosub("Local/242@debcomainbtn-local-paging-a014,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:12] -- Executing [246@debcomainbtn-local-paging:4] Set("Local/246@debcomainbtn-local-paging-197f,2", "LOCAL_CHANNEL=SIP/246") in new stack [2011-05-25 10:47:12] -- Executing [246@debcomainbtn-local-paging:5] Gosub("Local/246@debcomainbtn-local-paging-197f,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:1] Set("Local/246@debcomainbtn-local-paging-197f,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:4] Set("Local/231@debcomainbtn-local-paging-413b,2", "OUTBOUND_GROUP=231@INCOMING") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:2] Set("Local/244@debcomainbtn-local-paging-ab9c,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [239@debcomainbtn-local-paging:5] Gosub("Local/239@debcomainbtn-local-paging-486b,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:5] Dial("Local/238@debcomainbtn-local-paging-2ae0,2", "SIP/238|5") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:1] Set("Local/239@debcomainbtn-local-paging-486b,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] WARNING[23508]: app_dial.c:1323 dial_exec_full: Unable to create channel of type 'SIP' (cause 20 - Unknown) [2011-05-25 10:47:12] == Everyone is busy/congested at this time (1:0/0/1) [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:2] Set("Local/248@debcomainbtn-local-paging-1271,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [249@debcomainbtn-local-paging:2] Set("Local/249@debcomainbtn-local-paging-54b5,2", "LOCAL_EXTEN=249") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:2] Set("Local/246@debcomainbtn-local-paging-197f,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:2] Set("Local/239@debcomainbtn-local-paging-486b,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:3] GotoIf("Local/246@debcomainbtn-local-paging-197f,2", "0?6") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:3] GotoIf("Local/244@debcomainbtn-local-paging-ab9c,2", "0?6") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:3] GotoIf("Local/239@debcomainbtn-local-paging-486b,2", "0?6") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:6] Hangup("Local/238@debcomainbtn-local-paging-2ae0,2", "20") in new stack [2011-05-25 10:47:12] Extension Changed 227[debcomainbtn-local] new state InUse for Notify User 335 (queued) [2011-05-25 10:47:12] -- SIP/227-00001356 answered Local/227@debcomainbtn-local-paging-d7b4,2 [2011-05-25 10:47:12] -- Called 251@debcomainbtn-local-paging [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:5] Dial("Local/231@debcomainbtn-local-paging-413b,2", "SIP/231|5") in new stack [2011-05-25 10:47:12] == Spawn extension (all-local-extension, paging, 6) exited non-zero on 'Local/238@debcomainbtn-local-paging-2ae0,2' [2011-05-25 10:47:12] -- Local/227@debcomainbtn-local-paging-d7b4,1 answered [2011-05-25 10:47:12] -- Executing [251@debcomainbtn-local-paging:1] NoCDR("Local/251@debcomainbtn-local-paging-cb43,2", "") in new stack [2011-05-25 10:47:12] -- PROGRESS with cause code 127 received [2011-05-25 10:47:12] -- Zap/69-1 is making progress passing it to SIP/411-00001351 [2011-05-25 10:47:12] -- Called 231 [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:1] Set("Local/242@debcomainbtn-local-paging-a014,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:2] Set("Local/242@debcomainbtn-local-paging-a014,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:3] GotoIf("Local/242@debcomainbtn-local-paging-a014,2", "0?6") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:4] Set("Local/239@debcomainbtn-local-paging-486b,2", "OUTBOUND_GROUP=239@INCOMING") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:4] Set("Local/242@debcomainbtn-local-paging-a014,2", "OUTBOUND_GROUP=242@INCOMING") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:4] Set("Local/244@debcomainbtn-local-paging-ab9c,2", "OUTBOUND_GROUP=244@INCOMING") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:5] Dial("Local/242@debcomainbtn-local-paging-a014,2", "SIP/242|5") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:3] GotoIf("Local/248@debcomainbtn-local-paging-1271,2", "0?6") in new stack [2011-05-25 10:47:12] -- Executing [249@debcomainbtn-local-paging:3] SIPAddHeader("Local/249@debcomainbtn-local-paging-54b5,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:12] -- Executing [249@debcomainbtn-local-paging:4] Set("Local/249@debcomainbtn-local-paging-54b5,2", "LOCAL_CHANNEL=SIP/249") in new stack [2011-05-25 10:47:12] -- Called 252@debcomainbtn-local-paging [2011-05-25 10:47:12] -- SIP/229-00001357 answered Local/229@debcomainbtn-local-paging-5ed7,2 [2011-05-25 10:47:12] -- Local/229@debcomainbtn-local-paging-5ed7,1 answered [2011-05-25 10:47:12] -- Called 253@debcomainbtn-local-paging [2011-05-25 10:47:12] Extension Changed 231[debcomainbtn-local] new state Ringing for Notify User 335 [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:5] Dial("Local/239@debcomainbtn-local-paging-486b,2", "SIP/239|5") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:5] Dial("Local/244@debcomainbtn-local-paging-ab9c,2", "SIP/244|5") in new stack [2011-05-25 10:47:12] -- Executing [249@debcomainbtn-local-paging:5] Gosub("Local/249@debcomainbtn-local-paging-54b5,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:12] -- Called 254@debcomainbtn-local-paging [2011-05-25 10:47:12] -- Executing [251@debcomainbtn-local-paging:2] Set("Local/251@debcomainbtn-local-paging-cb43,2", "LOCAL_EXTEN=251") in new stack [2011-05-25 10:47:12] -- Executing [253@debcomainbtn-local-paging:1] NoCDR("Local/253@debcomainbtn-local-paging-dce1,2", "") in new stack [2011-05-25 10:47:12] -- Executing [254@debcomainbtn-local-paging:1] NoCDR("Local/254@debcomainbtn-local-paging-3500,2", "") in new stack [2011-05-25 10:47:12] -- Called 242 [2011-05-25 10:47:12] -- Executing [254@debcomainbtn-local-paging:2] Set("Local/254@debcomainbtn-local-paging-3500,2", "LOCAL_EXTEN=254") in new stack [2011-05-25 10:47:12] -- SIP/230-00001358 answered Local/230@debcomainbtn-local-paging-3459,2 [2011-05-25 10:47:12] -- Executing [254@debcomainbtn-local-paging:3] SIPAddHeader("Local/254@debcomainbtn-local-paging-3500,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:12] -- Local/230@debcomainbtn-local-paging-3459,1 answered [2011-05-25 10:47:12] -- Executing [254@debcomainbtn-local-paging:4] Set("Local/254@debcomainbtn-local-paging-3500,2", "LOCAL_CHANNEL=SIP/254") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:4] Set("Local/246@debcomainbtn-local-paging-197f,2", "OUTBOUND_GROUP=246@INCOMING") in new stack [2011-05-25 10:47:12] -- Executing [252@debcomainbtn-local-paging:1] NoCDR("Local/252@debcomainbtn-local-paging-bcab,2", "") in new stack [2011-05-25 10:47:12] Extension Changed 242[debcomainbtn-local] new state Ringing for Notify User 335 [2011-05-25 10:47:12] -- Called 255@debcomainbtn-local-paging [2011-05-25 10:47:12] -- Called 239 [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:4] Set("Local/248@debcomainbtn-local-paging-1271,2", "OUTBOUND_GROUP=248@INCOMING") in new stack [2011-05-25 10:47:12] -- Executing [251@debcomainbtn-local-paging:3] SIPAddHeader("Local/251@debcomainbtn-local-paging-cb43,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:12] -- Called 244 [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:1] Set("Local/249@debcomainbtn-local-paging-54b5,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [253@debcomainbtn-local-paging:2] Set("Local/253@debcomainbtn-local-paging-dce1,2", "LOCAL_EXTEN=253") in new stack [2011-05-25 10:47:12] -- Executing [252@debcomainbtn-local-paging:2] Set("Local/252@debcomainbtn-local-paging-bcab,2", "LOCAL_EXTEN=252") in new stack [2011-05-25 10:47:12] -- Executing [252@debcomainbtn-local-paging:3] SIPAddHeader("Local/252@debcomainbtn-local-paging-bcab,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:12] -- Executing [252@debcomainbtn-local-paging:4] Set("Local/252@debcomainbtn-local-paging-bcab,2", "LOCAL_CHANNEL=SIP/252") in new stack [2011-05-25 10:47:12] -- Executing [252@debcomainbtn-local-paging:5] Gosub("Local/252@debcomainbtn-local-paging-bcab,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:1] Set("Local/252@debcomainbtn-local-paging-bcab,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:2] Set("Local/252@debcomainbtn-local-paging-bcab,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:3] GotoIf("Local/252@debcomainbtn-local-paging-bcab,2", "0?6") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:4] Set("Local/252@debcomainbtn-local-paging-bcab,2", "OUTBOUND_GROUP=252@INCOMING") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:5] Dial("Local/252@debcomainbtn-local-paging-bcab,2", "SIP/252|5") in new stack [2011-05-25 10:47:12] -- Called 252 [2011-05-25 10:47:12] -- Executing [254@debcomainbtn-local-paging:5] Gosub("Local/254@debcomainbtn-local-paging-3500,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:1] Set("Local/254@debcomainbtn-local-paging-3500,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:2] Set("Local/254@debcomainbtn-local-paging-3500,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- SIP/234-00001359 answered Local/234@debcomainbtn-local-paging-2429,2 [2011-05-25 10:47:12] -- Called 257@debcomainbtn-local-paging [2011-05-25 10:47:12] -- Local/234@debcomainbtn-local-paging-2429,1 answered [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:5] Dial("Local/248@debcomainbtn-local-paging-1271,2", "SIP/248|5") in new stack [2011-05-25 10:47:12] -- Executing [257@debcomainbtn-local-paging:1] NoCDR("Local/257@debcomainbtn-local-paging-727a,2", "") in new stack [2011-05-25 10:47:12] -- SIP/408-00001353 answered Local/408@debcomainbtn-local-paging-691f,2 [2011-05-25 10:47:12] -- Executing [255@debcomainbtn-local-paging:1] NoCDR("Local/255@debcomainbtn-local-paging-4409,2", "") in new stack [2011-05-25 10:47:12] -- Local/408@debcomainbtn-local-paging-691f,1 answered [2011-05-25 10:47:12] -- Executing [255@debcomainbtn-local-paging:2] Set("Local/255@debcomainbtn-local-paging-4409,2", "LOCAL_EXTEN=255") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:5] Dial("Local/246@debcomainbtn-local-paging-197f,2", "SIP/246|5") in new stack [2011-05-25 10:47:12] -- SIP/225-00001355 answered Local/225@debcomainbtn-local-paging-1060,2 [2011-05-25 10:47:12] -- Local/225@debcomainbtn-local-paging-1060,1 answered [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:2] Set("Local/249@debcomainbtn-local-paging-54b5,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [253@debcomainbtn-local-paging:3] SIPAddHeader("Local/253@debcomainbtn-local-paging-dce1,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:12] -- Executing [257@debcomainbtn-local-paging:2] Set("Local/257@debcomainbtn-local-paging-727a,2", "LOCAL_EXTEN=257") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:3] GotoIf("Local/254@debcomainbtn-local-paging-3500,2", "0?6") in new stack [2011-05-25 10:47:12] -- Executing [251@debcomainbtn-local-paging:4] Set("Local/251@debcomainbtn-local-paging-cb43,2", "LOCAL_CHANNEL=SIP/251") in new stack [2011-05-25 10:47:12] -- Executing [251@debcomainbtn-local-paging:5] Gosub("Local/251@debcomainbtn-local-paging-cb43,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:12] -- Executing [255@debcomainbtn-local-paging:3] SIPAddHeader("Local/255@debcomainbtn-local-paging-4409,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:12] -- Executing [255@debcomainbtn-local-paging:4] Set("Local/255@debcomainbtn-local-paging-4409,2", "LOCAL_CHANNEL=SIP/255") in new stack [2011-05-25 10:47:12] -- Executing [255@debcomainbtn-local-paging:5] Gosub("Local/255@debcomainbtn-local-paging-4409,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:12] Extension Changed 230[debcomainbtn-local] new state InUse for Notify User 335 (queued) [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:1] Set("Local/255@debcomainbtn-local-paging-4409,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Called 258@debcomainbtn-local-paging [2011-05-25 10:47:12] -- Called 248 [2011-05-25 10:47:12] -- Called 246 [2011-05-25 10:47:12] -- Executing [253@debcomainbtn-local-paging:4] Set("Local/253@debcomainbtn-local-paging-dce1,2", "LOCAL_CHANNEL=SIP/253") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:3] GotoIf("Local/249@debcomainbtn-local-paging-54b5,2", "0?6") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:4] Set("Local/254@debcomainbtn-local-paging-3500,2", "OUTBOUND_GROUP=254@INCOMING") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:5] Dial("Local/254@debcomainbtn-local-paging-3500,2", "SIP/254|5") in new stack [2011-05-25 10:47:12] -- Executing [253@debcomainbtn-local-paging:5] Gosub("Local/253@debcomainbtn-local-paging-dce1,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:1] Set("Local/253@debcomainbtn-local-paging-dce1,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- SIP/236-0000135a answered Local/236@debcomainbtn-local-paging-dee9,2 [2011-05-25 10:47:12] -- Local/236@debcomainbtn-local-paging-dee9,1 answered [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:2] Set("Local/255@debcomainbtn-local-paging-4409,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:1] Set("Local/251@debcomainbtn-local-paging-cb43,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:3] GotoIf("Local/255@debcomainbtn-local-paging-4409,2", "0?6") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:2] Set("Local/253@debcomainbtn-local-paging-dce1,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:4] Set("Local/249@debcomainbtn-local-paging-54b5,2", "OUTBOUND_GROUP=249@INCOMING") in new stack [2011-05-25 10:47:12] -- Called 261@debcomainbtn-local-paging [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:2] Set("Local/251@debcomainbtn-local-paging-cb43,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [257@debcomainbtn-local-paging:3] SIPAddHeader("Local/257@debcomainbtn-local-paging-727a,2", "Alert-Info: Auto Answer") in new stack [2011-05-25 10:47:12] -- Executing [261@debcomainbtn-local-paging:1] NoCDR("Local/261@debcomainbtn-local-paging-c9f0,2", "") in new stack [2011-05-25 10:47:12] -- Called 262@debcomainbtn-local-paging [2011-05-25 10:47:12] -- Executing [258@debcomainbtn-local-paging:1] NoCDR("Local/258@debcomainbtn-local-paging-75c5,2", "") in new stack [2011-05-25 10:47:12] -- Executing [262@debcomainbtn-local-paging:1] NoCDR("Local/262@debcomainbtn-local-paging-75ac,2", "") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:5] Dial("Local/249@debcomainbtn-local-paging-54b5,2", "SIP/249|5") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:3] GotoIf("Local/251@debcomainbtn-local-paging-cb43,2", "0?6") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:3] GotoIf("Local/253@debcomainbtn-local-paging-dce1,2", "0?6") in new stack [2011-05-25 10:47:12] -- Executing [257@debcomainbtn-local-paging:4] SIPAddHeader("Local/257@debcomainbtn-local-paging-727a,2", "Alert-Info: ") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:4] Set("Local/255@debcomainbtn-local-paging-4409,2", "OUTBOUND_GROUP=255@INCOMING") in new stack [2011-05-25 10:47:12] -- Executing [257@debcomainbtn-local-paging:5] Set("Local/257@debcomainbtn-local-paging-727a,2", "LOCAL_CHANNEL=SIP/257") in new stack [2011-05-25 10:47:12] -- Called 263@debcomainbtn-local-paging [2011-05-25 10:47:12] -- Executing [258@debcomainbtn-local-paging:2] Set("Local/258@debcomainbtn-local-paging-75c5,2", "LOCAL_EXTEN=258") in new stack [2011-05-25 10:47:12] -- Executing [258@debcomainbtn-local-paging:3] SIPAddHeader("Local/258@debcomainbtn-local-paging-75c5,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:12] -- Called 264@debcomainbtn-local-paging [2011-05-25 10:47:12] -- Executing [258@debcomainbtn-local-paging:4] Set("Local/258@debcomainbtn-local-paging-75c5,2", "LOCAL_CHANNEL=SIP/258") in new stack [2011-05-25 10:47:12] -- Executing [258@debcomainbtn-local-paging:5] Gosub("Local/258@debcomainbtn-local-paging-75c5,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:1] Set("Local/258@debcomainbtn-local-paging-75c5,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:4] Set("Local/253@debcomainbtn-local-paging-dce1,2", "OUTBOUND_GROUP=253@INCOMING") in new stack [2011-05-25 10:47:12] -- Executing [paging@all-local-extension:5] Dial("Local/255@debcomainbtn-local-paging-4409,2", "SIP/255|5") in new stack [2011-05-25 10:47:12] -- Called 249 [2011-05-25 10:47:12] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/408@debcomainbtn-local-paging-691f,2' [2011-05-25 10:47:13] Extension Changed 408[debcomainbtn-local] new state InUse for Notify User 335 [2011-05-25 10:47:13] -- Called 254 [2011-05-25 10:47:13] -- SIP/231-0000135b answered Local/231@debcomainbtn-local-paging-413b,2 [2011-05-25 10:47:13] Extension Changed 236[debcomainbtn-local] new state InUse for Notify User 335 (queued) [2011-05-25 10:47:13] Extension Changed 225[debcomainbtn-local] new state InUse for Notify User 335 (queued) [2011-05-25 10:47:13] Extension Changed 227[debcomainbtn-local] new state InUse for Notify Use r 335 [2011-05-25 10:47:13] -- Local/231@debcomainbtn-local-paging-413b,1 answered [2011-05-25 10:47:13] Extension Changed 231[debcomainbtn-local] new state InUse for Notify User 335 (queued) [2011-05-25 10:47:13] -- Executing [262@debcomainbtn-local-paging:2] Set("Local/262@debcomainbtn-local-paging-75ac,2", "LOCAL_EXTEN=262") in new stack [2011-05-25 10:47:13] -- SIP/242-0000135c answered Local/242@debcomainbtn-local-paging-a014,2 [2011-05-25 10:47:13] -- Local/242@debcomainbtn-local-paging-a014,1 answered [2011-05-25 10:47:13] -- SIP/239-0000135e answered Local/239@debcomainbtn-local-paging-486b,2 [2011-05-25 10:47:13] -- Executing [262@debcomainbtn-local-paging:3] SIPAddHeader("Local/262@debcomainbtn-local-paging-75ac,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:4] Set("Local/251@debcomainbtn-local-paging-cb43,2", "OUTBOUND_GROUP=251@INCOMING") in new stack [2011-05-25 10:47:13] -- Executing [257@debcomainbtn-local-paging:6] Gosub("Local/257@debcomainbtn-local-paging-727a,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:5] Dial("Local/253@debcomainbtn-local-paging-dce1,2", "SIP/253|5") in new stack [2011-05-25 10:47:13] -- Executing [262@debcomainbtn-local-paging:4] Set("Local/262@debcomainbtn-local-paging-75ac,2", "LOCAL_CHANNEL=SIP/262") in new stack [2011-05-25 10:47:13] -- Executing [262@debcomainbtn-local-paging:5] Gosub("Local/262@debcomainbtn-local-paging-75ac,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:1] Set("Local/262@debcomainbtn-local-paging-75ac,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:2] Set("Local/262@debcomainbtn-local-paging-75ac,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:3] GotoIf("Local/262@debcomainbtn-local-paging-75ac,2", "0?6") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:4] Set("Local/262@debcomainbtn-local-paging-75ac,2", "OUTBOUND_GROUP=262@INCOMING") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:5] Dial("Local/262@debcomainbtn-local-paging-75ac,2", "SIP/262|5") in new stack [2011-05-25 10:47:13] -- Executing [261@debcomainbtn-local-paging:2] Set("Local/261@debcomainbtn-local-paging-c9f0,2", "LOCAL_EXTEN=261") in new stack [2011-05-25 10:47:13] -- Called 265@debcomainbtn-local-paging [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:5] Dial("Local/251@debcomainbtn-local-paging-cb43,2", "SIP/251|5") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:1] Set("Local/257@debcomainbtn-local-paging-727a,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [261@debcomainbtn-local-paging:3] SIPAddHeader("Local/261@debcomainbtn-local-paging-c9f0,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:13] -- Local/239@debcomainbtn-local-paging-486b,1 answered [2011-05-25 10:47:13] -- Called 266@debcomainbtn-local-paging [2011-05-25 10:47:13] -- Called 255 [2011-05-25 10:47:13] -- Executing [261@debcomainbtn-local-paging:4] Set("Local/261@debcomainbtn-local-paging-c9f0,2", "LOCAL_CHANNEL=SIP/261") in new stack [2011-05-25 10:47:13] -- Executing [261@debcomainbtn-local-paging:5] Gosub("Local/261@debcomainbtn-local-paging-c9f0,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:1] Set("Local/261@debcomainbtn-local-paging-c9f0,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:2] Set("Local/261@debcomainbtn-local-paging-c9f0,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:3] GotoIf("Local/261@debcomainbtn-local-paging-c9f0,2", "0?6") in new stack [2011-05-25 10:47:13] Extension Changed 242[debcomainbtn-local] new state InUse for Notify User 335 (queued) [2011-05-25 10:47:13] -- SIP/252-0000135f answered Local/252@debcomainbtn-local-paging-bcab,2 [2011-05-25 10:47:13] -- Local/252@debcomainbtn-local-paging-bcab,1 answered [2011-05-25 10:47:13] -- SIP/248-00001360 answered Local/248@debcomainbtn-local-paging-1271,2 [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:2] Set("Local/257@debcomainbtn-local-paging-727a,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- SIP/244-0000135d answered Local/244@debcomainbtn-local-paging-ab9c,2 [2011-05-25 10:47:13] -- Executing [264@debcomainbtn-local-paging:1] NoCDR("Local/264@debcomainbtn-local-paging-3587,2", "") in new stack [2011-05-25 10:47:13] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/224@debcomainbtn-local-paging-8722,2' [2011-05-25 10:47:13] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/229@debcomainbtn-local-paging-5ed7,2' [2011-05-25 10:47:13] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/227@debcomainbtn-local-paging-d7b4,2' [2011-05-25 10:47:13] -- Executing [265@debcomainbtn-local-paging:1] NoCDR("Local/265@debcomainbtn-local-paging-410d,2", "") in new stack [2011-05-25 10:47:13] -- Executing [263@debcomainbtn-local-paging:1] NoCDR("Local/263@debcomainbtn-local-paging-e802,2", "") in new stack [2011-05-25 10:47:13] -- Local/248@debcomainbtn-local-paging-1271,1 answered [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:3] GotoIf("Local/257@debcomainbtn-local-paging-727a,2", "0?6") in new stack [2011-05-25 10:47:13] -- Local/244@debcomainbtn-local-paging-ab9c,1 answered [2011-05-25 10:47:13] Extension Changed 225[debcomainbtn-local] new state InUse for Notify User 335 [2011-05-25 10:47:13] -- SIP/254-00001362 answered Local/254@debcomainbtn-local-paging-3500,2 [2011-05-25 10:47:13] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/225@debcomainbtn-local-paging-1060,2' [2011-05-25 10:47:13] -- Executing [264@debcomainbtn-local-paging:2] Set("Local/264@debcomainbtn-local-paging-3587,2", "LOCAL_EXTEN=264") in new stack [2011-05-25 10:47:13] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/230@debcomainbtn-local-paging-3459,2' [2011-05-25 10:47:13] -- Local/254@debcomainbtn-local-paging-3500,1 answered [2011-05-25 10:47:13] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/234@debcomainbtn-local-paging-2429,2' [2011-05-25 10:47:13] Extension Changed 230[debcomainbtn-local] new state InUse for Notify User 335 [2011-05-25 10:47:13] Extension Changed 236[debcomainbtn-local] new state InUse for Notify User 335 [2011-05-25 10:47:13] Extension Changed 231[debcomainbtn-local] new state InUse for Notify User 335 [2011-05-25 10:47:13] Extension Changed 242[debcomainbtn-local] new state InUse for Notify User 335 [2011-05-25 10:47:13] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/236@debcomainbtn-local-paging-dee9,2' [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:2] Set("Local/258@debcomainbtn-local-paging-75c5,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [266@debcomainbtn-local-paging:1] NoCDR("Local/266@debcomainbtn-local-paging-b7b5,2", "") in new stack [2011-05-25 10:47:13] -- SIP/246-00001361 answered Local/246@debcomainbtn-local-paging-197f,2 [2011-05-25 10:47:13] -- Local/246@debcomainbtn-local-paging-197f,1 answered [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:4] Set("Local/261@debcomainbtn-local-paging-c9f0,2", "OUTBOUND_GROUP=261@INCOMING") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:3] GotoIf("Local/258@debcomainbtn-local-paging-75c5,2", "0?6") in new stack [2011-05-25 10:47:13] -- Executing [264@debcomainbtn-local-paging:3] SIPAddHeader("Local/264@debcomainbtn-local-paging-3587,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:13] -- Executing [265@debcomainbtn-local-paging:2] Set("Local/265@debcomainbtn-local-paging-410d,2", "LOCAL_EXTEN=265") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:5] Dial("Local/261@debcomainbtn-local-paging-c9f0,2", "SIP/261|5") in new stack [2011-05-25 10:47:13] -- SIP/249-00001363 answered Local/249@debcomainbtn-local-paging-54b5,2 [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:4] Set("Local/258@debcomainbtn-local-paging-75c5,2", "OUTBOUND_GROUP=258@INCOMING") in new stack [2011-05-25 10:47:13] -- Called 251 [2011-05-25 10:47:13] -- Executing [265@debcomainbtn-local-paging:3] SIPAddHeader("Local/265@debcomainbtn-local-paging-410d,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:13] -- Executing [264@debcomainbtn-local-paging:4] Set("Local/264@debcomainbtn-local-paging-3587,2", "LOCAL_CHANNEL=SIP/264") in new stack [2011-05-25 10:47:13] -- Executing [264@debcomainbtn-local-paging:5] Gosub("Local/264@debcomainbtn-local-paging-3587,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:1] Set("Local/264@debcomainbtn-local-paging-3587,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:2] Set("Local/264@debcomainbtn-local-paging-3587,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:3] GotoIf("Local/264@debcomainbtn-local-paging-3587,2", "0?6") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:4] Set("Local/264@debcomainbtn-local-paging-3587,2", "OUTBOUND_GROUP=264@INCOMING") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:5] Dial("Local/264@debcomainbtn-local-paging-3587,2", "SIP/264|5") in new stack [2011-05-25 10:47:13] WARNING[23542]: app_dial.c:1323 dial_exec_full: Unable to create channel of type 'SIP' (cause 20 - Unknown) [2011-05-25 10:47:13] == Everyone is busy/congested at this time (1:0/0/1) [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:6] Hangup("Local/264@debcomainbtn-local-paging-3587,2", "20") in new stack [2011-05-25 10:47:13] == Spawn extension (all-local-extension, paging, 6) exited non-zero on 'Local/264@debcomainbtn-local-paging-3587,2' [2011-05-25 10:47:13] -- Local/249@debcomainbtn-local-paging-54b5,1 answered [2011-05-25 10:47:13] -- Executing [263@debcomainbtn-local-paging:2] Set("Local/263@debcomainbtn-local-paging-e802,2", "LOCAL_EXTEN=263") in new stack [2011-05-25 10:47:13] -- Called 253 [2011-05-25 10:47:13] -- Called 262 [2011-05-25 10:47:13] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/231@debcomainbtn-local-paging-413b,2' [2011-05-25 10:47:13] -- SIP/255-00001364 answered Local/255@debcomainbtn-local-paging-4409,2 [2011-05-25 10:47:13] -- Local/255@debcomainbtn-local-paging-4409,1 answered [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:4] Set("Local/257@debcomainbtn-local-paging-727a,2", "OUTBOUND_GROUP=257@INCOMING") in new stack [2011-05-25 10:47:13] Extension Changed 253[debcomainbtn-local] new state Ringing for Notify User 335 [2011-05-25 10:47:13] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/252@debcomainbtn-local-paging-bcab,2' [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:5] Dial("Local/257@debcomainbtn-local-paging-727a,2", "SIP/257|5") in new stack [2011-05-25 10:47:13] -- Executing [263@debcomainbtn-local-paging:3] SIPAddHeader("Local/263@debcomainbtn-local-paging-e802,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:13] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/248@debcomainbtn-local-paging-1271,2' [2011-05-25 10:47:13] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/246@debcomainbtn-local-paging-197f,2' [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:5] Dial("Local/258@debcomainbtn-local-paging-75c5,2", "SIP/258|5") in new stack [2011-05-25 10:47:13] -- SIP/251-00001365 answered Local/251@debcomainbtn-local-paging-cb43,2 [2011-05-25 10:47:13] -- Local/251@debcomainbtn-local-paging-cb43,1 answered [2011-05-25 10:47:13] -- SIP/253-00001366 answered Local/253@debcomainbtn-local-paging-dce1,2 [2011-05-25 10:47:13] -- Local/253@debcomainbtn-local-paging-dce1,1 answered [2011-05-25 10:47:13] -- Executing [263@debcomainbtn-local-paging:4] Set("Local/263@debcomainbtn-local-paging-e802,2", "LOCAL_CHANNEL=SIP/263") in new stack [2011-05-25 10:47:13] -- Called 269@debcomainbtn-local-paging ======================================================================= === Currently Held Locks ============================================== ======================================================================= === === (times locked) === === Thread ID: 0xb7f0fb90 (accept_thread started at [ 3439] manager.c init_manager()) === ---> Waiting for Lock #0 (manager.c): MUTEX 2542 accept_thread &(&sessions)->lock 0x81879c8 (1) === --- ---> Locked Here: manager.c line 2698 (manager_event) === ------------------------------------------------------------------- === === Thread ID: 0xb7ed3b90 (do_devstate_changes started at [ 363] devicestate.c ast_device_state_engine_init()) === ---> Lock #0 (pbx.c): MUTEX 6294 ast_rdlock_contexts &conlock 0x8189ec0 (1) === ---> Lock #1 (pbx.c): MUTEX 2060 ast_hint_state_changed hints 0x9e309d8 (1) === ---> Lock #2 (pbx.c): MUTEX 2061 ast_hint_state_changed hint 0xb3e35e38 (1) === ---> Waiting for Lock #3 (manager.c): MUTEX 2698 manager_event &(&sessions)->lock 0x81879c8 (1) === --- ---> Locked Here: manager.c line 2698 (manager_event) === ------------------------------------------------------------------- === === Thread ID: 0xb4bb7b90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Lock #0 (dial.c): MUTEX 239 begin_dial &(&dial->channels)->lock 0xb746cb54 (1) === ---> Waiting for Lock #1 (manager.c): MUTEX 2698 manager_event &(&sessions)->lock 0x81879c8 (1) === --- ---> Locked Here: manager.c line 2698 (manager_event) === ------------------------------------------------------------------- === === Thread ID: 0xb4b7bb90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Waiting for Lock #0 (manager.c): MUTEX 2698 manager_event &(&sessions)->lock 0x81879c8 (1) === --- ---> Locked Here: manager.c line 2698 (manager_event) === ------------------------------------------------------------------- === === Thread ID: 0xb454bb90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Waiting for Lock #0 (manager.c): MUTEX 2698 manager_event &(&sessions)->lock 0x81879c8 (1) === --- ---> Locked Here: manager.c line 2698 (manager_event) === ------------------------------------------------------------------- === === Thread ID: 0xb4effb90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Waiting for Lock #0 (manager.c): MUTEX 2698 manager_event &(&sessions)->lock 0x81879c8 (1) === --- ---> Locked Here: manager.c line 2698 (manager_event) === ------------------------------------------------------------------- === === Thread ID: 0xb59e7b90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Waiting for Lock #0 (manager.c): MUTEX 2698 manager_event &(&sessions)->lock 0x81879c8 (1) === --- ---> Locked Here: manager.c line 2698 (manager_event) === ------------------------------------------------------------------- === === Thread ID: 0xb48e7b90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Waiting for Lock #0 (manager.c): MUTEX 2698 manager_event &(&sessions)->lock 0x81879c8 (1) === --- ---> Locked Here: manager.c line 2698 (manager_event) === ------------------------------------------------------------------- === === Thread ID: 0xb4c6bb90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Waiting for Lock #0 (pbx.c): MUTEX 6294 ast_rdlock_contexts &conlock 0x8189ec0 (1) === --- ---> Locked Here: pbx.c line 6294 (ast_rdlock_contexts) === ------------------------------------------------------------------- === === Thread ID: 0xb43a7b90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Lock #0 (chan_sip.c): MUTEX 4385 sip_new &i->lock 0xb46004d0 (1) === ---> Waiting for Lock #1 (pbx.c): MUTEX 6294 ast_rdlock_contexts &conlock 0x8189ec0 (1) === --- ---> Locked Here: pbx.c line 6294 (ast_rdlock_contexts) === ------------------------------------------------------------------- === === Thread ID: 0xb587fb90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Lock #0 (chan_sip.c): MUTEX 4385 sip_new &i->lock 0xa0722f8 (1) === ---> Waiting for Lock #1 (pbx.c): MUTEX 6294 ast_rdlock_contexts &conlock 0x8189ec0 (1) === --- ---> Locked Here: pbx.c line 6294 (ast_rdlock_contexts) === ------------------------------------------------------------------- === === Thread ID: 0xb4e87b90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Lock #0 (chan_sip.c): MUTEX 4385 sip_new &i->lock 0xa0b9308 (1) === ---> Waiting for Lock #1 (pbx.c): MUTEX 6294 ast_rdlock_contexts &conlock 0x8189ec0 (1) === --- ---> Locked Here: pbx.c line 6294 (ast_rdlock_contexts) === ------------------------------------------------------------------- === === Thread ID: 0xb5a9bb90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Lock #0 (manager.c): MUTEX 2698 manager_event &(&sessions)->lock 0x81879c8 (1) === ------------------------------------------------------------------- === === Thread ID: 0xb477fb90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Waiting for Lock #0 (pbx.c): MUTEX 6294 ast_rdlock_contexts &conlock 0x8189ec0 (1) === --- ---> Locked Here: pbx.c line 6294 (ast_rdlock_contexts) === ------------------------------------------------------------------- === === Thread ID: 0xb4e4bb90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Waiting for Lock #0 (pbx.c): MUTEX 6294 ast_rdlock_contexts &conlock 0x8189ec0 (1) === --- ---> Locked Here: pbx.c line 6294 (ast_rdlock_contexts) === ------------------------------------------------------------------- === === Thread ID: 0xb5b4fb90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Waiting for Lock #0 (pbx.c): MUTEX 6294 ast_rdlock_contexts &conlock 0x8189ec0 (1) === --- ---> Locked Here: pbx.c line 6294 (ast_rdlock_contexts) === ------------------------------------------------------------------- === ======================================================================= [2011-05-25 10:47:13] Extension Changed 253[debcomainbtn-local] new state InUse for Notify User 335 (queued) [2011-05-25 10:47:13] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/249@debcomainbtn-local-paging-54b5,2' [2011-05-25 10:47:13] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/242@debcomainbtn-local-paging-a014,2' [2011-05-25 10:47:13] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/244@debcomainbtn-local-paging-ab9c,2' [2011-05-25 10:47:13] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/239@debcomainbtn-local-paging-486b,2' [2011-05-25 10:47:13] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/254@debcomainbtn-local-paging-3500,2' [2011-05-25 10:47:13] -- SIP/262-00001367 answered Local/262@debcomainbtn-local-paging-75ac,2 [2011-05-25 10:47:13] -- Local/262@debcomainbtn-local-paging-75ac,1 answered [2011-05-25 10:47:13] -- Called 258 [2011-05-25 10:47:13] -- Called 270@debcomainbtn-local-paging [2011-05-25 10:47:13] -- Called 272@debcomainbtn-local-paging [2011-05-25 10:47:13] -- Executing [270@debcomainbtn-local-paging:1] NoCDR("Local/270@debcomainbtn-local-paging-6a7e,2", "") in new stack [2011-05-25 10:47:13] -- Executing [270@debcomainbtn-local-paging:2] Set("Local/270@debcomainbtn-local-paging-6a7e,2", "LOCAL_EXTEN=270") in new stack [2011-05-25 10:47:13] -- Executing [270@debcomainbtn-local-paging:3] SIPAddHeader("Local/270@debcomainbtn-local-paging-6a7e,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:13] -- Called 274@debcomainbtn-local-paging [2011-05-25 10:47:13] -- Executing [266@debcomainbtn-local-paging:2] Set("Local/266@debcomainbtn-local-paging-b7b5,2", "LOCAL_EXTEN=266") in new stack [2011-05-25 10:47:13] -- Executing [266@debcomainbtn-local-paging:3] SIPAddHeader("Local/266@debcomainbtn-local-paging-b7b5,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:13] -- Executing [266@debcomainbtn-local-paging:4] Set("Local/266@debcomainbtn-local-paging-b7b5,2", "LOCAL_CHANNEL=SIP/266") in new stack [2011-05-25 10:47:13] -- Executing [266@debcomainbtn-local-paging:5] Gosub("Local/266@debcomainbtn-local-paging-b7b5,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:1] Set("Local/266@debcomainbtn-local-paging-b7b5,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [265@debcomainbtn-local-paging:4] Set("Local/265@debcomainbtn-local-paging-410d,2", "LOCAL_CHANNEL=SIP/265") in new stack [2011-05-25 10:47:13] -- Executing [263@debcomainbtn-local-paging:5] Gosub("Local/263@debcomainbtn-local-paging-e802,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:1] Set("Local/263@debcomainbtn-local-paging-e802,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [265@debcomainbtn-local-paging:5] Gosub("Local/265@debcomainbtn-local-paging-410d,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:13] -- Executing [270@debcomainbtn-local-paging:4] Set("Local/270@debcomainbtn-local-paging-6a7e,2", "LOCAL_CHANNEL=SIP/270") in new stack [2011-05-25 10:47:13] -- Executing [272@debcomainbtn-local-paging:1] NoCDR("Local/272@debcomainbtn-local-paging-df21,2", "") in new stack [2011-05-25 10:47:13] -- Executing [274@debcomainbtn-local-paging:1] NoCDR("Local/274@debcomainbtn-local-paging-442b,2", "") in new stack [2011-05-25 10:47:13] -- Called 277@debcomainbtn-local-paging [2011-05-25 10:47:13] -- Called 257 [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:2] Set("Local/266@debcomainbtn-local-paging-b7b5,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Called 261 [2011-05-25 10:47:13] -- Executing [269@debcomainbtn-local-paging:1] NoCDR("Local/269@debcomainbtn-local-paging-74d4,2", "") in new stack [2011-05-25 10:47:13] -- Executing [269@debcomainbtn-local-paging:2] Set("Local/269@debcomainbtn-local-paging-74d4,2", "LOCAL_EXTEN=269") in new stack [2011-05-25 10:47:13] -- Executing [274@debcomainbtn-local-paging:2] Set("Local/274@debcomainbtn-local-paging-442b,2", "LOCAL_EXTEN=274") in new stack [2011-05-25 10:47:13] -- Executing [269@debcomainbtn-local-paging:3] SIPAddHeader("Local/269@debcomainbtn-local-paging-74d4,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:1] Set("Local/265@debcomainbtn-local-paging-410d,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:2] Set("Local/265@debcomainbtn-local-paging-410d,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:3] GotoIf("Local/265@debcomainbtn-local-paging-410d,2", "0?6") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:4] Set("Local/265@debcomainbtn-local-paging-410d,2", "OUTBOUND_GROUP=265@INCOMING") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:5] Dial("Local/265@debcomainbtn-local-paging-410d,2", "SIP/265|5") in new stack [2011-05-25 10:47:13] -- Executing [270@debcomainbtn-local-paging:5] Gosub("Local/270@debcomainbtn-local-paging-6a7e,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:1] Set("Local/270@debcomainbtn-local-paging-6a7e,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:2] Set("Local/270@debcomainbtn-local-paging-6a7e,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:3] GotoIf("Local/270@debcomainbtn-local-paging-6a7e,2", "0?6") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:4] Set("Local/270@debcomainbtn-local-paging-6a7e,2", "OUTBOUND_GROUP=270@INCOMING") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:5] Dial("Local/270@debcomainbtn-local-paging-6a7e,2", "SIP/270|5") in new stack [2011-05-25 10:47:13] -- Executing [277@debcomainbtn-local-paging:1] NoCDR("Local/277@debcomainbtn-local-paging-3a7c,2", "") in new stack [2011-05-25 10:47:13] -- Executing [277@debcomainbtn-local-paging:2] Set("Local/277@debcomainbtn-local-paging-3a7c,2", "LOCAL_EXTEN=277") in new stack [2011-05-25 10:47:13] -- Executing [277@debcomainbtn-local-paging:3] SIPAddHeader("Local/277@debcomainbtn-local-paging-3a7c,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:13] -- Executing [277@debcomainbtn-local-paging:4] Set("Local/277@debcomainbtn-local-paging-3a7c,2", "LOCAL_CHANNEL=SIP/277") in new stack [2011-05-25 10:47:13] -- Executing [277@debcomainbtn-local-paging:5] Gosub("Local/277@debcomainbtn-local-paging-3a7c,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:1] Set("Local/277@debcomainbtn-local-paging-3a7c,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:2] Set("Local/277@debcomainbtn-local-paging-3a7c,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:3] GotoIf("Local/277@debcomainbtn-local-paging-3a7c,2", "0?6") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:4] Set("Local/277@debcomainbtn-local-paging-3a7c,2", "OUTBOUND_GROUP=277@INCOMING") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:5] Dial("Local/277@debcomainbtn-local-paging-3a7c,2", "SIP/277|5") in new stack [2011-05-25 10:47:13] Extension Changed 261[debcomainbtn-local] new state Ringing for Notify User 335 [2011-05-25 10:47:13] Extension Changed 257[debcomainbtn-local] new state Ringing for Notify User 335 [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:3] GotoIf("Local/266@debcomainbtn-local-paging-b7b5,2", "0?6") in new stack [2011-05-25 10:47:13] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/255@debcomainbtn-local-paging-4409,2' [2011-05-25 10:47:13] Extension Changed 253[debcomainbtn-local] new state InUse for Notify User 335 [2011-05-25 10:47:13] -- Called 265 [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:4] Set("Local/266@debcomainbtn-local-paging-b7b5,2", "OUTBOUND_GROUP=266@INCOMING") in new stack [2011-05-25 10:47:13] -- Executing [269@debcomainbtn-local-paging:4] Set("Local/269@debcomainbtn-local-paging-74d4,2", "LOCAL_CHANNEL=SIP/269") in new stack [2011-05-25 10:47:13] -- Executing [269@debcomainbtn-local-paging:5] Gosub("Local/269@debcomainbtn-local-paging-74d4,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:5] Dial("Local/266@debcomainbtn-local-paging-b7b5,2", "SIP/266|5") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:2] Set("Local/263@debcomainbtn-local-paging-e802,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:1] Set("Local/269@debcomainbtn-local-paging-74d4,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:3] GotoIf("Local/263@debcomainbtn-local-paging-e802,2", "0?6") in new stack [2011-05-25 10:47:13] -- Executing [272@debcomainbtn-local-paging:2] Set("Local/272@debcomainbtn-local-paging-df21,2", "LOCAL_EXTEN=272") in new stack [2011-05-25 10:47:13] -- Executing [274@debcomainbtn-local-paging:3] SIPAddHeader("Local/274@debcomainbtn-local-paging-442b,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:4] Set("Local/263@debcomainbtn-local-paging-e802,2", "OUTBOUND_GROUP=263@INCOMING") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:5] Dial("Local/263@debcomainbtn-local-paging-e802,2", "SIP/263|5") in new stack [2011-05-25 10:47:13] -- Called 263 [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:2] Set("Local/269@debcomainbtn-local-paging-74d4,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [274@debcomainbtn-local-paging:4] Set("Local/274@debcomainbtn-local-paging-442b,2", "LOCAL_CHANNEL=SIP/274") in new stack [2011-05-25 10:47:13] -- Called 278@debcomainbtn-local-paging [2011-05-25 10:47:13] -- Executing [278@debcomainbtn-local-paging:1] NoCDR("Local/278@debcomainbtn-local-paging-f557,2", "") in new stack [2011-05-25 10:47:13] -- Called 277 [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:3] GotoIf("Local/269@debcomainbtn-local-paging-74d4,2", "0?6") in new stack [2011-05-25 10:47:13] -- Called 270 [2011-05-25 10:47:13] -- SIP/258-0000136a answered Local/258@debcomainbtn-local-paging-75c5,2 [2011-05-25 10:47:13] -- Local/258@debcomainbtn-local-paging-75c5,1 answered [2011-05-25 10:47:13] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/253@debcomainbtn-local-paging-dce1,2' [2011-05-25 10:47:13] -- Called 266 [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:4] Set("Local/269@debcomainbtn-local-paging-74d4,2", "OUTBOUND_GROUP=269@INCOMING") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:5] Dial("Local/269@debcomainbtn-local-paging-74d4,2", "SIP/269|5") in new stack [2011-05-25 10:47:13] -- Executing [274@debcomainbtn-local-paging:5] Gosub("Local/274@debcomainbtn-local-paging-442b,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:1] Set("Local/274@debcomainbtn-local-paging-442b,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:2] Set("Local/274@debcomainbtn-local-paging-442b,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/251@debcomainbtn-local-paging-cb43,2' [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:3] GotoIf("Local/274@debcomainbtn-local-paging-442b,2", "0?6") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:4] Set("Local/274@debcomainbtn-local-paging-442b,2", "OUTBOUND_GROUP=274@INCOMING") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:5] Dial("Local/274@debcomainbtn-local-paging-442b,2", "SIP/274|5") in new stack [2011-05-25 10:47:13] -- Executing [272@debcomainbtn-local-paging:3] SIPAddHeader("Local/272@debcomainbtn-local-paging-df21,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:13] Extension Changed 270[debcomainbtn-local] new state Ringing for Notify User 335 [2011-05-25 10:47:13] Extension Changed 263[debcomainbtn-local] new state Ringing for Notify User 335 [2011-05-25 10:47:13] -- Called 279@debcomainbtn-local-paging [2011-05-25 10:47:13] -- Executing [279@debcomainbtn-local-paging:1] NoCDR("Local/279@debcomainbtn-local-paging-7ed1,2", "") in new stack [2011-05-25 10:47:13] -- Executing [272@debcomainbtn-local-paging:4] Set("Local/272@debcomainbtn-local-paging-df21,2", "LOCAL_CHANNEL=SIP/272") in new stack [2011-05-25 10:47:13] -- Executing [272@debcomainbtn-local-paging:5] Gosub("Local/272@debcomainbtn-local-paging-df21,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:1] Set("Local/272@debcomainbtn-local-paging-df21,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:2] Set("Local/272@debcomainbtn-local-paging-df21,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:3] GotoIf("Local/272@debcomainbtn-local-paging-df21,2", "0?6") in new stack [2011-05-25 10:47:13] -- Executing [278@debcomainbtn-local-paging:2] Set("Local/278@debcomainbtn-local-paging-f557,2", "LOCAL_EXTEN=278") in new stack [2011-05-25 10:47:13] Extension Changed 261[debcomainbtn-local] new state InUse for Notify User 335 (queued) [2011-05-25 10:47:13] -- SIP/261-00001368 answered Local/261@debcomainbtn-local-paging-c9f0,2 [2011-05-25 10:47:13] -- Local/261@debcomainbtn-local-paging-c9f0,1 answered [2011-05-25 10:47:13] -- Executing [278@debcomainbtn-local-paging:3] SIPAddHeader("Local/278@debcomainbtn-local-paging-f557,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:4] Set("Local/272@debcomainbtn-local-paging-df21,2", "OUTBOUND_GROUP=272@INCOMING") in new stack [2011-05-25 10:47:13] -- Executing [279@debcomainbtn-local-paging:2] Set("Local/279@debcomainbtn-local-paging-7ed1,2", "LOCAL_EXTEN=279") in new stack [2011-05-25 10:47:13] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/262@debcomainbtn-local-paging-75ac,2' [2011-05-25 10:47:13] -- Called 269 [2011-05-25 10:47:13] -- Called 274 [2011-05-25 10:47:13] -- Executing [279@debcomainbtn-local-paging:3] SIPAddHeader("Local/279@debcomainbtn-local-paging-7ed1,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:13] -- Executing [279@debcomainbtn-local-paging:4] Set("Local/279@debcomainbtn-local-paging-7ed1,2", "LOCAL_CHANNEL=SIP/279") in new stack 2011-05-25 10:47:13] -- Executing [279@debcomainbtn-local-paging:5] Gosub("Local/279@debcomainbtn-local-paging-7ed1,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:1] Set("Local/279@debcomainbtn-local-paging-7ed1,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [278@debcomainbtn-local-paging:4] Set("Local/278@debcomainbtn-local-paging-f557,2", "LOCAL_CHANNEL=SIP/278") in new stack [2011-05-25 10:47:13] -- Executing [278@debcomainbtn-local-paging:5] Gosub("Local/278@debcomainbtn-local-paging-f557,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:13] -- SIP/257-00001369 is ringing [2011-05-25 10:47:13] -- Local/257@debcomainbtn-local-paging-727a,1 is ringing [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:1] Set("Local/278@debcomainbtn-local-paging-f557,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:2] Set("Local/278@debcomainbtn-local-paging-f557,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:3] GotoIf("Local/278@debcomainbtn-local-paging-f557,2", "0?6") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:4] Set("Local/278@debcomainbtn-local-paging-f557,2", "OUTBOUND_GROUP=278@INCOMING") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:5] Dial("Local/278@debcomainbtn-local-paging-f557,2", "SIP/278|5") in new stack [2011-05-25 10:47:13] Extension Changed 274[debcomainbtn-local] new state Ringing for Notify User 335 [2011-05-25 10:47:13] -- Called 278 [2011-05-25 10:47:13] -- Called 280@debcomainbtn-local-paging [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:2] Set("Local/279@debcomainbtn-local-paging-7ed1,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [280@debcomainbtn-local-paging:1] NoCDR("Local/280@debcomainbtn-local-paging-066d,2", "") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:3] GotoIf("Local/279@debcomainbtn-local-paging-7ed1,2", "0?6") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:4] Set("Local/279@debcomainbtn-local-paging-7ed1,2", "OUTBOUND_GROUP=279@INCOMING") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:5] Dial("Local/279@debcomainbtn-local-paging-7ed1,2", "SIP/279|5") in new stack [2011-05-25 10:47:13] -- SIP/265-0000136b answered Local/265@debcomainbtn-local-paging-410d,2 [2011-05-25 10:47:13] -- Local/265@debcomainbtn-local-paging-410d,1 answered [2011-05-25 10:47:13] -- Called 279 [2011-05-25 10:47:13] -- Executing [280@debcomainbtn-local-paging:2] Set("Local/280@debcomainbtn-local-paging-066d,2", "LOCAL_EXTEN=280") in new stack [2011-05-25 10:47:13] -- Called 282@debcomainbtn-local-paging [2011-05-25 10:47:13] -- Called 285@debcomainbtn-local-paging [2011-05-25 10:47:13] -- Executing [282@debcomainbtn-local-paging:1] NoCDR("Local/282@debcomainbtn-local-paging-3cc5,2", "") in new stack [2011-05-25 10:47:13] -- Executing [285@debcomainbtn-local-paging:1] NoCDR("Local/285@debcomainbtn-local-paging-eddd,2", "") in new stack [2011-05-25 10:47:13] -- Executing [280@debcomainbtn-local-paging:3] SIPAddHeader("Local/280@debcomainbtn-local-paging-066d,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:13] -- Called 287@debcomainbtn-local-paging [2011-05-25 10:47:13] -- Executing [282@debcomainbtn-local-paging:2] Set("Local/282@debcomainbtn-local-paging-3cc5,2", "LOCAL_EXTEN=282") in new stack [2011-05-25 10:47:13] -- SIP/270-0000136c answered Local/270@debcomainbtn-local-paging-6a7e,2 [2011-05-25 10:47:13] -- Executing [287@debcomainbtn-local-paging:1] NoCDR("Local/287@debcomainbtn-local-paging-78e2,2", "") in new stack [2011-05-25 10:47:13] -- Executing [287@debcomainbtn-local-paging:2] Set("Local/287@debcomainbtn-local-paging-78e2,2", "LOCAL_EXTEN=287") in new stack [2011-05-25 10:47:13] -- Executing [285@debcomainbtn-local-paging:2] Set("Local/285@debcomainbtn-local-paging-eddd,2", "LOCAL_EXTEN=285") in new stack [2011-05-25 10:47:13] -- Executing [285@debcomainbtn-local-paging:3] SIPAddHeader("Local/285@debcomainbtn-local-paging-eddd,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:13] -- Local/270@debcomainbtn-local-paging-6a7e,1 answered [2011-05-25 10:47:13] -- Called 288@debcomainbtn-local-paging [2011-05-25 10:47:13] -- Called 289@debcomainbtn-local-paging [2011-05-25 10:47:13] -- Executing [287@debcomainbtn-local-paging:3] SIPAddHeader("Local/287@debcomainbtn-local-paging-78e2,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:13] -- Executing [288@debcomainbtn-local-paging:1] NoCDR("Local/288@debcomainbtn-local-paging-f57d,2", "") in new stack [2011-05-25 10:47:13] -- Executing [288@debcomainbtn-local-paging:2] Set("Local/288@debcomainbtn-local-paging-f57d,2", "LOCAL_EXTEN=288") in new stack [2011-05-25 10:47:13] -- Executing [288@debcomainbtn-local-paging:3] SIPAddHeader("Local/288@debcomainbtn-local-paging-f57d,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:13] -- Executing [285@debcomainbtn-local-paging:4] Set("Local/285@debcomainbtn-local-paging-eddd,2", "LOCAL_CHANNEL=SIP/285") in new stack [2011-05-25 10:47:13] -- Executing [288@debcomainbtn-local-paging:4] Set("Local/288@debcomainbtn-local-paging-f57d,2", "LOCAL_CHANNEL=SIP/288") in new stack [2011-05-25 10:47:13] -- Executing [288@debcomainbtn-local-paging:5] Gosub("Local/288@debcomainbtn-local-paging-f57d,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:13] -- Executing [282@debcomainbtn-local-paging:3] SIPAddHeader("Local/282@debcomainbtn-local-paging-3cc5,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:13] -- SIP/263-0000136f answered Local/263@debcomainbtn-local-paging-e802,2 [2011-05-25 10:47:13] -- Executing [285@debcomainbtn-local-paging:5] Gosub("Local/285@debcomainbtn-local-paging-eddd,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:1] Set("Local/285@debcomainbtn-local-paging-eddd,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:2] Set("Local/285@debcomainbtn-local-paging-eddd,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:3] GotoIf("Local/285@debcomainbtn-local-paging-eddd,2", "0?6") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:4] Set("Local/285@debcomainbtn-local-paging-eddd,2", "OUTBOUND_GROUP=285@INCOMING") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:5] Dial("Local/285@debcomainbtn-local-paging-eddd,2", "SIP/285|5") in new stack [2011-05-25 10:47:13] -- Executing [282@debcomainbtn-local-paging:4] Set("Local/282@debcomainbtn-local-paging-3cc5,2", "LOCAL_CHANNEL=SIP/282") in new stack [2011-05-25 10:47:13] -- Local/263@debcomainbtn-local-paging-e802,1 answered [2011-05-25 10:47:13] -- Executing [282@debcomainbtn-local-paging:5] Gosub("Local/282@debcomainbtn-local-paging-3cc5,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:1] Set("Local/282@debcomainbtn-local-paging-3cc5,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:2] Set("Local/282@debcomainbtn-local-paging-3cc5,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:3] GotoIf("Local/282@debcomainbtn-local-paging-3cc5,2", "0?6") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:4] Set("Local/282@debcomainbtn-local-paging-3cc5,2", "OUTBOUND_GROUP=282@INCOMING") in new stack [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:5] Dial("Local/282@debcomainbtn-local-paging-3cc5,2", "SIP/282|5") in new stack [2011-05-25 10:47:13] Extension Changed 270[debcomainbtn-local] new state InUse for Notify User 335 (queued) [2011-05-25 10:47:13] -- Executing [paging@all-local-extension:5] Dial("Local/272@debcomainbtn-local-paging-df21,2", "SIP/272|5") in new stack [2011-05-25 10:47:13] -- Executing [289@debcomainbtn-local-paging:1] NoCDR("Local/289@debcomainbtn-local-paging-bef4,2", "") in new stack [2011-05-25 10:47:13] Extension Changed 263[debcomainbtn-local] new state InUse for Notify User 335 (queued) [2011-05-25 10:47:13] -- SIP/277-0000136e answered Local/277@debcomainbtn-local-paging-3a7c,2 [2011-05-25 10:47:13] -- Called 282 [2011-05-25 10:47:13] Extension Changed 261[debcomainbtn-local] new state InUse for Notify User 335 [2011-05-25 10:47:13] -- SIP/266-0000136d answered Local/266@debcomainbtn-local-paging-b7b5,2 [2011-05-25 10:47:13] Extension Changed 282[debcomainbtn-local] new state Ringing for Notify User 335 [2011-05-25 10:47:13] Extension Changed 257[debcomainbtn-local] new state InUse for Notify User 335 [2011-05-25 10:47:13] -- Local/266@debcomainbtn-local-paging-b7b5,1 answered [2011-05-25 10:47:13] -- SIP/274-00001371 answered Local/274@debcomainbtn-local-paging-442b,2 [2011-05-25 10:47:13] Extension Changed 274[debcomainbtn-local] new state InUse for Notify User 335 (queued) [2011-05-25 10:47:13] -- Local/274@debcomainbtn-local-paging-442b,1 answered [2011-05-25 10:47:13] -- Local/277@debcomainbtn-local-paging-3a7c,1 answered [2011-05-25 10:47:13] -- Called 272 [2011-05-25 10:47:14] -- SIP/279-00001373 answered Local/279@debcomainbtn-local-paging-7ed1,2 [2011-05-25 10:47:14] -- SIP/257-00001369 answered Local/257@debcomainbtn-local-paging-727a,2 [2011-05-25 10:47:14] -- Local/279@debcomainbtn-local-paging-7ed1,1 answered 2011-05-25 10:47:14] -- Local/257@debcomainbtn-local-paging-727a,1 answered [2011-05-25 10:47:14] -- SIP/282-00001375 answered Local/282@debcomainbtn-local-paging-3cc5,2 [2011-05-25 10:47:14] -- Local/282@debcomainbtn-local-paging-3cc5,1 answered [2011-05-25 10:47:14] -- SIP/269-00001370 answered Local/269@debcomainbtn-local-paging-74d4,2 [2011-05-25 10:47:14] -- Called 285 [2011-05-25 10:47:14] -- SIP/278-00001372 answered Local/278@debcomainbtn-local-paging-f557,2 [2011-05-25 10:47:14] -- Local/269@debcomainbtn-local-paging-74d4,1 answered [2011-05-25 10:47:14] -- Executing [287@debcomainbtn-local-paging:4] Set("Local/287@debcomainbtn-local-paging-78e2,2", "LOCAL_CHANNEL=SIP/287") in new stack [2011-05-25 10:47:14] -- Local/278@debcomainbtn-local-paging-f557,1 answered [2011-05-25 10:47:14] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/263@debcomainbtn-local-paging-e802,2' [2011-05-25 10:47:14] Extension Changed 282[debcomainbtn-local] new state InUse for Notify User 335 (queued) [2011-05-25 10:47:14] -- Called 290@debcomainbtn-local-paging [2011-05-25 10:47:14] -- Executing [280@debcomainbtn-local-paging:4] Set("Local/280@debcomainbtn-local-paging-066d,2", "LOCAL_CHANNEL=SIP/280") in new stack [2011-05-25 10:47:14] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/257@debcomainbtn-local-paging-727a,2' [2011-05-25 10:47:14] -- Executing [280@debcomainbtn-local-paging:5] Gosub("Local/280@debcomainbtn-local-paging-066d,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:14] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/266@debcomainbtn-local-paging-b7b5,2' [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:1] Set("Local/280@debcomainbtn-local-paging-066d,2", "GROUPCOUNT=1") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:2] Set("Local/280@debcomainbtn-local-paging-066d,2", "GROUPCOUNT=1") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:3] GotoIf("Local/280@debcomainbtn-local-paging-066d,2", "1?6") in new stack [2011-05-25 10:47:14] -- Goto (all-local-extension,paging,6) [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:6] Hangup("Local/280@debcomainbtn-local-paging-066d,2", "0") in new stack [2011-05-25 10:47:14] == Spawn extension (all-local-extension, paging, 6) exited non-zero on 'Local/280@debcomainbtn-local-paging-066d,2' [2011-05-25 10:47:14] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/258@debcomainbtn-local-paging-75c5,2' [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:1] Set("Local/288@debcomainbtn-local-paging-f57d,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Called 291@debcomainbtn-local-paging [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:2] Set("Local/288@debcomainbtn-local-paging-f57d,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:3] GotoIf("Local/288@debcomainbtn-local-paging-f57d,2", "0?6") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:4] Set("Local/288@debcomainbtn-local-paging-f57d,2", "OUTBOUND_GROUP=288@INCOMING") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:5] Dial("Local/288@debcomainbtn-local-paging-f57d,2", "SIP/288|5") in new stack [2011-05-25 10:47:14] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/261@debcomainbtn-local-paging-c9f0,2' [2011-05-25 10:47:14] -- Executing [291@debcomainbtn-local-paging:1] NoCDR("Local/291@debcomainbtn-local-paging-6a2c,2", "") in new stack [2011-05-25 10:47:14] -- Executing [290@debcomainbtn-local-paging:1] NoCDR("Local/290@debcomainbtn-local-paging-7686,2", "") in new stack [2011-05-25 10:47:14] WARNING[23570]: app_dial.c:1323 dial_exec_full: Unable to create channel of type 'SIP' (cause 20 - Unknown) [2011-05-25 10:47:14] == Everyone is busy/congested at this time (1:0/0/1) [2011-05-25 10:47:14] -- Executing [289@debcomainbtn-local-paging:2] Set("Local/289@debcomainbtn-local-paging-bef4,2", "LOCAL_EXTEN=289") in new stack [2011-05-25 10:47:14] -- Executing [287@debcomainbtn-local-paging:5] Gosub("Local/287@debcomainbtn-local-paging-78e2,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:14] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/270@debcomainbtn-local-paging-6a7e,2' [2011-05-25 10:47:14] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/277@debcomainbtn-local-paging-3a7c,2' [2011-05-25 10:47:14] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/265@debcomainbtn-local-paging-410d,2' [2011-05-25 10:47:14] -- SIP/272-00001376 answered Local/272@debcomainbtn-local-paging-df21,2 [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:6] Hangup("Local/288@debcomainbtn-local-paging-f57d,2", "20") in new stack [2011-05-25 10:47:14] == Spawn extension (all-local-extension, paging, 6) exited non-zero on 'Local/288@debcomainbtn-local-paging-f57d,2' [2011-05-25 10:47:14] -- Executing [289@debcomainbtn-local-paging:3] SIPAddHeader("Local/289@debcomainbtn-local-paging-bef4,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:14] -- Executing [289@debcomainbtn-local-paging:4] Set("Local/289@debcomainbtn-local-paging-bef4,2", "LOCAL_CHANNEL=SIP/289") in new stack [2011-05-25 10:47:14] -- Executing [289@debcomainbtn-local-paging:5] Gosub("Local/289@debcomainbtn-local-paging-bef4,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:14] -- Local/272@debcomainbtn-local-paging-df21,1 answered [2011-05-25 10:47:14] -- Executing [291@debcomainbtn-local-paging:2] Set("Local/291@debcomainbtn-local-paging-6a2c,2", "LOCAL_EXTEN=291") in new stack [2011-05-25 10:47:14] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/269@debcomainbtn-local-paging-74d4,2' [2011-05-25 10:47:14] -- SIP/285-00001374 answered Local/285@debcomainbtn-local-paging-eddd,2 [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:1] Set("Local/287@debcomainbtn-local-paging-78e2,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [290@debcomainbtn-local-paging:2] Set("Local/290@debcomainbtn-local-paging-7686,2", "LOCAL_EXTEN=290") in new stack [2011-05-25 10:47:14] Extension Changed 270[debcomainbtn-local] new state InUse for Notify User 335 [2011-05-25 10:47:14] Extension Changed 263[debcomainbtn-local] new state InUse for Notify User 335 [2011-05-25 10:47:14] Extension Changed 274[debcomainbtn-local] new state InUse for Notify User 335 [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:1] Set("Local/289@debcomainbtn-local-paging-bef4,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] Extension Changed 282[debcomainbtn-local] new state InUse for Notify User 335 [2011-05-25 10:47:14] -- Called 292@debcomainbtn-local-paging [2011-05-25 10:47:14] -- Executing [292@debcomainbtn-local-paging:1] NoCDR("Local/292@debcomainbtn-local-paging-8647,2", "") in new stack [2011-05-25 10:47:14] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/274@debcomainbtn-local-paging-442b,2' [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:2] Set("Local/287@debcomainbtn-local-paging-78e2,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:2] Set("Local/289@debcomainbtn-local-paging-bef4,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [291@debcomainbtn-local-paging:3] Set("Local/291@debcomainbtn-local-paging-6a2c,2", "LOCAL_CHANNEL=SIP/291") in new stack [2011-05-25 10:47:14] -- Local/285@debcomainbtn-local-paging-eddd,1 answered [2011-05-25 10:47:14] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/278@debcomainbtn-local-paging-f557,2' [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:3] GotoIf("Local/289@debcomainbtn-local-paging-bef4,2", "0?6") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:4] Set("Local/289@debcomainbtn-local-paging-bef4,2", "OUTBOUND_GROUP=289@INCOMING") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:5] Dial("Local/289@debcomainbtn-local-paging-bef4,2", "SIP/289|5") in new stack [2011-05-25 10:47:14] -- Called 293@debcomainbtn-local-paging [2011-05-25 10:47:14] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/279@debcomainbtn-local-paging-7ed1,2' [2011-05-25 10:47:14] -- Called 294@debcomainbtn-local-paging [2011-05-25 10:47:14] -- Called 295@debcomainbtn-local-paging [2011-05-25 10:47:14] -- Called 297@debcomainbtn-local-paging [2011-05-25 10:47:14] -- Executing [293@debcomainbtn-local-paging:1] NoCDR("Local/293@debcomainbtn-local-paging-384f,2", "") in new stack [2011-05-25 10:47:14] -- Executing [293@debcomainbtn-local-paging:2] Set("Local/293@debcomainbtn-local-paging-384f,2", "LOCAL_EXTEN=293") in new stack [2011-05-25 10:47:14] -- Executing [293@debcomainbtn-local-paging:3] SIPAddHeader("Local/293@debcomainbtn-local-paging-384f,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:14] -- Executing [293@debcomainbtn-local-paging:4] Set("Local/293@debcomainbtn-local-paging-384f,2", "LOCAL_CHANNEL=SIP/293") in new stack [2011-05-25 10:47:14] -- Executing [294@debcomainbtn-local-paging:1] NoCDR("Local/294@debcomainbtn-local-paging-e9c2,2", "") in new stack [2011-05-25 10:47:14] -- Executing [295@debcomainbtn-local-paging:1] NoCDR("Local/295@debcomainbtn-local-paging-6596,2", "") in new stack [2011-05-25 10:47:14] -- Executing [293@debcomainbtn-local-paging:5] Gosub("Local/293@debcomainbtn-local-paging-384f,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:3] GotoIf("Local/287@debcomainbtn-local-paging-78e2,2", "0?6") in new stack [2011-05-25 10:47:14] -- Executing [290@debcomainbtn-local-paging:3] SIPAddHeader("Local/290@debcomainbtn-local-paging-7686,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:4] Set("Local/287@debcomainbtn-local-paging-78e2,2", "OUTBOUND_GROUP=287@INCOMING") in new stack [2011-05-25 10:47:14] -- Executing [297@debcomainbtn-local-paging:1] NoCDR("Local/297@debcomainbtn-local-paging-5a0f,2", "") in new stack [2011-05-25 10:47:14] -- Executing [297@debcomainbtn-local-paging:2] Set("Local/297@debcomainbtn-local-paging-5a0f,2", "LOCAL_EXTEN=297") in new stack [2011-05-25 10:47:14] -- Executing [290@debcomainbtn-local-paging:4] Set("Local/290@debcomainbtn-local-paging-7686,2", "LOCAL_CHANNEL=SIP/290") in new stack [2011-05-25 10:47:14] -- Executing [291@debcomainbtn-local-paging:4] Gosub("Local/291@debcomainbtn-local-paging-6a2c,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:14] -- Called 289 [2011-05-25 10:47:14] -- Executing [290@debcomainbtn-local-paging:5] Gosub("Local/290@debcomainbtn-local-paging-7686,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:5] Dial("Local/287@debcomainbtn-local-paging-78e2,2", "SIP/287|5") in new stack [2011-05-25 10:47:14] -- Called 287 [2011-05-25 10:47:14] -- Executing [292@debcomainbtn-local-paging:2] Set("Local/292@debcomainbtn-local-paging-8647,2", "LOCAL_EXTEN=292") in new stack [2011-05-25 10:47:14] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/282@debcomainbtn-local-paging-3cc5,2' [2011-05-25 10:47:14] -- Executing [292@debcomainbtn-local-paging:3] SIPAddHeader("Local/292@debcomainbtn-local-paging-8647,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:14] -- Executing [292@debcomainbtn-local-paging:4] Set("Local/292@debcomainbtn-local-paging-8647,2", "LOCAL_CHANNEL=SIP/292") in new stack [2011-05-25 10:47:14] -- Executing [292@debcomainbtn-local-paging:5] Gosub("Local/292@debcomainbtn-local-paging-8647,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:14] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/285@debcomainbtn-local-paging-eddd,2' [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:1] Set("Local/290@debcomainbtn-local-paging-7686,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:2] Set("Local/290@debcomainbtn-local-paging-7686,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:3] GotoIf("Local/290@debcomainbtn-local-paging-7686,2", "0?6") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:4] Set("Local/290@debcomainbtn-local-paging-7686,2", "OUTBOUND_GROUP=290@INCOMING") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:5] Dial("Local/290@debcomainbtn-local-paging-7686,2", "SIP/290|5") in new stack [2011-05-25 10:47:14] -- Called 290 [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:1] Set("Local/291@debcomainbtn-local-paging-6a2c,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:1] Set("Local/293@debcomainbtn-local-paging-384f,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:2] Set("Local/293@debcomainbtn-local-paging-384f,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:2] Set("Local/291@debcomainbtn-local-paging-6a2c,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [295@debcomainbtn-local-paging:2] Set("Local/295@debcomainbtn-local-paging-6596,2", "LOCAL_EXTEN=295") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:3] GotoIf("Local/291@debcomainbtn-local-paging-6a2c,2", "0?6") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:4] Set("Local/291@debcomainbtn-local-paging-6a2c,2", "OUTBOUND_GROUP=291@INCOMING") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:5] Dial("Local/291@debcomainbtn-local-paging-6a2c,2", "SIP/291|5") in new stack [2011-05-25 10:47:14] -- Executing [295@debcomainbtn-local-paging:3] SIPAddHeader("Local/295@debcomainbtn-local-paging-6596,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:1] Set("Local/292@debcomainbtn-local-paging-8647,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] WARNING[23584]: app_dial.c:1323 dial_exec_full: Unable to create channel of type 'SIP' (cause 20 - Unknown) [2011-05-25 10:47:14] == Everyone is busy/congested at this time (1:0/0/1) [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:6] Hangup("Local/291@debcomainbtn-local-paging-6a2c,2", "20") in new stack [2011-05-25 10:47:14] -- Executing [297@debcomainbtn-local-paging:3] SIPAddHeader("Local/297@debcomainbtn-local-paging-5a0f,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:14] -- Called 298@debcomainbtn-local-paging [2011-05-25 10:47:14] -- Executing [298@debcomainbtn-local-paging:1] NoCDR("Local/298@debcomainbtn-local-paging-c628,2", "") in new stack [2011-05-25 10:47:14] Extension Changed 287[debcomainbtn-local] new state Ringing for Notify User 335 [2011-05-25 10:47:14] -- Executing [295@debcomainbtn-local-paging:4] Set("Local/295@debcomainbtn-local-paging-6596,2", "LOCAL_CHANNEL=SIP/295") in new stack [2011-05-25 10:47:14] == Spawn extension (all-local-extension, paging, 6) exited non-zero on 'Local/291@debcomainbtn-local-paging-6a2c,2' 2011-05-25 10:47:14] -- Executing [297@debcomainbtn-local-paging:4] Set("Local/297@debcomainbtn-local-paging-5a0f,2", "LOCAL_CHANNEL=SIP/297") in new stack [2011-05-25 10:47:14] -- Executing [297@debcomainbtn-local-paging:5] Gosub("Local/297@debcomainbtn-local-paging-5a0f,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:3] GotoIf("Local/293@debcomainbtn-local-paging-384f,2", "0?6") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:1] Set("Local/297@debcomainbtn-local-paging-5a0f,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Called 299@debcomainbtn-local-paging [2011-05-25 10:47:14] -- Called 312@debcomainbtn-local-paging [2011-05-25 10:47:14] -- Executing [298@debcomainbtn-local-paging:2] Set("Local/298@debcomainbtn-local-paging-c628,2", "LOCAL_EXTEN=298") in new stack [2011-05-25 10:47:14] -- Executing [298@debcomainbtn-local-paging:3] SIPAddHeader("Local/298@debcomainbtn-local-paging-c628,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:14] -- Executing [298@debcomainbtn-local-paging:4] Set("Local/298@debcomainbtn-local-paging-c628,2", "LOCAL_CHANNEL=SIP/298") in new stack [2011-05-25 10:47:14] -- Executing [298@debcomainbtn-local-paging:5] Gosub("Local/298@debcomainbtn-local-paging-c628,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:1] Set("Local/298@debcomainbtn-local-paging-c628,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:2] Set("Local/298@debcomainbtn-local-paging-c628,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:3] GotoIf("Local/298@debcomainbtn-local-paging-c628,2", "0?6") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:4] Set("Local/298@debcomainbtn-local-paging-c628,2", "OUTBOUND_GROUP=298@INCOMING") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:5] Dial("Local/298@debcomainbtn-local-paging-c628,2", "SIP/298|5") in new stack [2011-05-25 10:47:14] -- Called 298 [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:2] Set("Local/292@debcomainbtn-local-paging-8647,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:3] GotoIf("Local/292@debcomainbtn-local-paging-8647,2", "0?6") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:4] Set("Local/292@debcomainbtn-local-paging-8647,2", "OUTBOUND_GROUP=292@INCOMING") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:5] Dial("Local/292@debcomainbtn-local-paging-8647,2", "SIP/292|5") in new stack [2011-05-25 10:47:14] -- SIP/289-00001377 answered Local/289@debcomainbtn-local-paging-bef4,2 [2011-05-25 10:47:14] -- Executing [299@debcomainbtn-local-paging:1] NoCDR("Local/299@debcomainbtn-local-paging-62d3,2", "") in new stack [2011-05-25 10:47:14] -- Called 314@debcomainbtn-local-paging [2011-05-25 10:47:14] -- Local/289@debcomainbtn-local-paging-bef4,1 answered [2011-05-25 10:47:14] -- Executing [294@debcomainbtn-local-paging:2] Set("Local/294@debcomainbtn-local-paging-e9c2,2", "LOCAL_EXTEN=294") in new stack [2011-05-25 10:47:14] -- Executing [294@debcomainbtn-local-paging:3] SIPAddHeader("Local/294@debcomainbtn-local-paging-e9c2,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:14] -- Executing [312@debcomainbtn-local-paging:1] NoCDR("Local/312@debcomainbtn-local-paging-be65,2", "") in new stack [2011-05-25 10:47:14] -- Executing [295@debcomainbtn-local-paging:5] Gosub("Local/295@debcomainbtn-local-paging-6596,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:14] -- Called 319@debcomainbtn-local-paging [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:1] Set("Local/295@debcomainbtn-local-paging-6596,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Called 320@debcomainbtn-local-paging [2011-05-25 10:47:14] -- Executing [314@debcomainbtn-local-paging:1] NoCDR("Local/314@debcomainbtn-local-paging-2f5d,2", "") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:2] Set("Local/297@debcomainbtn-local-paging-5a0f,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Called 292 [2011-05-25 10:47:14] -- Executing [294@debcomainbtn-local-paging:4] Set("Local/294@debcomainbtn-local-paging-e9c2,2", "LOCAL_CHANNEL=SIP/294") in new stack [2011-05-25 10:47:14] -- Executing [319@debcomainbtn-local-paging:1] NoCDR("Local/319@debcomainbtn-local-paging-0534,2", "") in new stack [2011-05-25 10:47:14] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/272@debcomainbtn-local-paging-df21,2' [2011-05-25 10:47:14] -- SIP/287-00001378 answered Local/287@debcomainbtn-local-paging-78e2,2 [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:2] Set("Local/295@debcomainbtn-local-paging-6596,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Local/287@debcomainbtn-local-paging-78e2,1 answered [2011-05-25 10:47:14] -- Executing [319@debcomainbtn-local-paging:2] Set("Local/319@debcomainbtn-local-paging-0534,2", "LOCAL_EXTEN=319") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:3] GotoIf("Local/297@debcomainbtn-local-paging-5a0f,2", "0?6") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:4] Set("Local/297@debcomainbtn-local-paging-5a0f,2", "OUTBOUND_GROUP=297@INCOMING") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:5] Dial("Local/297@debcomainbtn-local-paging-5a0f,2", "SIP/297|5") in new stack [2011-05-25 10:47:14] -- Executing [294@debcomainbtn-local-paging:5] Gosub("Local/294@debcomainbtn-local-paging-e9c2,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:14] -- Called 321@debcomainbtn-local-paging [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:3] GotoIf("Local/295@debcomainbtn-local-paging-6596,2", "0?6") in new stack [2011-05-25 10:47:14] -- Called 297 [2011-05-25 10:47:14] -- Executing [319@debcomainbtn-local-paging:3] SIPAddHeader("Local/319@debcomainbtn-local-paging-0534,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:14] Extension Changed 287[debcomainbtn-local] new state InUse for Notify User 335 [2011-05-25 10:47:14] -- Executing [319@debcomainbtn-local-paging:4] Set("Local/319@debcomainbtn-local-paging-0534,2", "LOCAL_CHANNEL=SIP/319") in new stack [2011-05-25 10:47:14] -- Executing [319@debcomainbtn-local-paging:5] Gosub("Local/319@debcomainbtn-local-paging-0534,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:4] Set("Local/293@debcomainbtn-local-paging-384f,2", "OUTBOUND_GROUP=293@INCOMING") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:1] Set("Local/319@debcomainbtn-local-paging-0534,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [320@debcomainbtn-local-paging:1] NoCDR("Local/320@debcomainbtn-local-paging-f0ac,2", "") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:2] Set("Local/319@debcomainbtn-local-paging-0534,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [322@debcomainbtn-local-paging:1] NoCDR("Local/322@debcomainbtn-local-paging-eb7b,2", "") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:3] GotoIf("Local/319@debcomainbtn-local-paging-0534,2", "0?6") in new stack [2011-05-25 10:47:14] -- Executing [299@debcomainbtn-local-paging:2] Set("Local/299@debcomainbtn-local-paging-62d3,2", "LOCAL_EXTEN=299") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:4] Set("Local/295@debcomainbtn-local-paging-6596,2", "OUTBOUND_GROUP=295@INCOMING") in new stack [2011-05-25 10:47:14] -- Executing [299@debcomainbtn-local-paging:3] SIPAddHeader("Local/299@debcomainbtn-local-paging-62d3,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:14] -- Executing [321@debcomainbtn-local-paging:1] NoCDR("Local/321@debcomainbtn-local-paging-e6e7,2", "") in new stack [2011-05-25 10:47:14] -- SIP/290-00001379 answered Local/290@debcomainbtn-local-paging-7686,2 [2011-05-25 10:47:14] -- Executing [299@debcomainbtn-local-paging:4] Set("Local/299@debcomainbtn-local-paging-62d3,2", "LOCAL_CHANNEL=SIP/299") in new stack [2011-05-25 10:47:14] -- Executing [299@debcomainbtn-local-paging:5] Gosub("Local/299@debcomainbtn-local-paging-62d3,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:5] Dial("Local/293@debcomainbtn-local-paging-384f,2", "SIP/293|5") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:1] Set("Local/294@debcomainbtn-local-paging-e9c2,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [322@debcomainbtn-local-paging:2] Set("Local/322@debcomainbtn-local-paging-eb7b,2", "LOCAL_EXTEN=322") in new stack [2011-05-25 10:47:14] -- Executing [312@debcomainbtn-local-paging:2] Set("Local/312@debcomainbtn-local-paging-be65,2", "LOCAL_EXTEN=312") in new stack [2011-05-25 10:47:14] -- Local/290@debcomainbtn-local-paging-7686,1 answered alled 322@debcomainbtn-local-paging [2011-05-25 10:47:14] -- Executing [320@debcomainbtn-local-paging:2] Set("Local/320@debcomainbtn-local-paging-f0ac,2", "LOCAL_EXTEN=320") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:5] Dial("Local/295@debcomainbtn-local-paging-6596,2", "SIP/295|5") in new stack [2011-05-25 10:47:14] -- Executing [321@debcomainbtn-local-paging:2] Set("Local/321@debcomainbtn-local-paging-e6e7,2", "LOCAL_EXTEN=321") in new stack [2011-05-25 10:47:14] -- Called 323@debcomainbtn-local-paging [2011-05-25 10:47:14] -- Executing [323@debcomainbtn-local-paging:1] NoCDR("Local/323@debcomainbtn-local-paging-c4bb,2", "") in new stack [2011-05-25 10:47:14] -- Executing [320@debcomainbtn-local-paging:3] SIPAddHeader("Local/320@debcomainbtn-local-paging-f0ac,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:14] -- Executing [320@debcomainbtn-local-paging:4] Set("Local/320@debcomainbtn-local-paging-f0ac,2", "LOCAL_CHANNEL=SIP/320") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:2] Set("Local/294@debcomainbtn-local-paging-e9c2,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:3] GotoIf("Local/294@debcomainbtn-local-paging-e9c2,2", "0?6") in new stack [2011-05-25 10:47:14] -- Executing [320@debcomainbtn-local-paging:5] Gosub("Local/320@debcomainbtn-local-paging-f0ac,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:1] Set("Local/299@debcomainbtn-local-paging-62d3,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [312@debcomainbtn-local-paging:3] SIPAddHeader("Local/312@debcomainbtn-local-paging-be65,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:4] Set("Local/319@debcomainbtn-local-paging-0534,2", "OUTBOUND_GROUP=319@INCOMING") in new stack [2011-05-25 10:47:14] -- Called 295 [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:2] Set("Local/299@debcomainbtn-local-paging-62d3,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [314@debcomainbtn-local-paging:2] Set("Local/314@debcomainbtn-local-paging-2f5d,2", "LOCAL_EXTEN=314") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:3] GotoIf("Local/299@debcomainbtn-local-paging-62d3,2", "0?6") in new stack [2011-05-25 10:47:14] -- SIP/298-0000137a answered Local/298@debcomainbtn-local-paging-c628,2 [2011-05-25 10:47:14] -- Executing [323@debcomainbtn-local-paging:2] Set("Local/323@debcomainbtn-local-paging-c4bb,2", "LOCAL_EXTEN=323") in new stack [2011-05-25 10:47:14] -- Executing [321@debcomainbtn-local-paging:3] SIPAddHeader("Local/321@debcomainbtn-local-paging-e6e7,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:5] Dial("Local/319@debcomainbtn-local-paging-0534,2", "SIP/319|5") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:1] Set("Local/320@debcomainbtn-local-paging-f0ac,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Local/298@debcomainbtn-local-paging-c628,1 answered [2011-05-25 10:47:14] -- Called 293 [2011-05-25 10:47:14] Extension Changed 295[debcomainbtn-local] new state Ringing for Notify User 335 [2011-05-25 10:47:14] -- Called 324@debcomainbtn-local-paging [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:4] Set("Local/299@debcomainbtn-local-paging-62d3,2", "OUTBOUND_GROUP=299@INCOMING") in new stack [2011-05-25 10:47:14] -- Executing [312@debcomainbtn-local-paging:4] Set("Local/312@debcomainbtn-local-paging-be65,2", "LOCAL_CHANNEL=SIP/312") in new stack [2011-05-25 10:47:14] -- Executing [314@debcomainbtn-local-paging:3] SIPAddHeader("Local/314@debcomainbtn-local-paging-2f5d,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:4] Set("Local/294@debcomainbtn-local-paging-e9c2,2", "OUTBOUND_GROUP=294@INCOMING") in new stack [2011-05-25 10:47:14] -- SIP/292-0000137b is ringing [2011-05-25 10:47:14] -- Executing [324@debcomainbtn-local-paging:1] NoCDR("Local/324@debcomainbtn-local-paging-b37f,2", "") in new stack [2011-05-25 10:47:14] -- Executing [323@debcomainbtn-local-paging:3] SIPAddHeader("Local/323@debcomainbtn-local-paging-c4bb,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:14] -- Executing [322@debcomainbtn-local-paging:3] SIPAddHeader("Local/322@debcomainbtn-local-paging-eb7b,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:5] Dial("Local/299@debcomainbtn-local-paging-62d3,2", "SIP/299|5") in new stack [2011-05-25 10:47:14] -- Executing [321@debcomainbtn-local-paging:4] Set("Local/321@debcomainbtn-local-paging-e6e7,2", "LOCAL_CHANNEL=SIP/321") in new stack [2011-05-25 10:47:14] -- Local/292@debcomainbtn-local-paging-8647,1 is ringing [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:5] Dial("Local/294@debcomainbtn-local-paging-e9c2,2", "SIP/294|5") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:2] Set("Local/320@debcomainbtn-local-paging-f0ac,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] WARNING[23599]: app_dial.c:1323 dial_exec_full: Unable to create channel of type 'SIP' (cause 20 - Unknown) [2011-05-25 10:47:14] == Everyone is busy/congested at this time (1:0/0/1) [2011-05-25 10:47:14] -- Executing [321@debcomainbtn-local-paging:5] Gosub("Local/321@debcomainbtn-local-paging-e6e7,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:1] Set("Local/321@debcomainbtn-local-paging-e6e7,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:2] Set("Local/321@debcomainbtn-local-paging-e6e7,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:3] GotoIf("Local/321@debcomainbtn-local-paging-e6e7,2", "0?6") in new stack [2011-05-25 10:47:14] -- Called 294 [2011-05-25 10:47:14] -- Executing [312@debcomainbtn-local-paging:5] Gosub("Local/312@debcomainbtn-local-paging-be65,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:1] Set("Local/312@debcomainbtn-local-paging-be65,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [323@debcomainbtn-local-paging:4] Set("Local/323@debcomainbtn-local-paging-c4bb,2", "LOCAL_CHANNEL=SIP/323") in new stack [2011-05-25 10:47:14] -- Executing [314@debcomainbtn-local-paging:4] Set("Local/314@debcomainbtn-local-paging-2f5d,2", "LOCAL_CHANNEL=SIP/314") in new stack [2011-05-25 10:47:14] -- Called 327@debcomainbtn-local-paging [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:6] Hangup("Local/299@debcomainbtn-local-paging-62d3,2", "20") in new stack [2011-05-25 10:47:14] -- Executing [327@debcomainbtn-local-paging:1] NoCDR("Local/327@debcomainbtn-local-paging-e1a1,2", "") in new stack [2011-05-25 10:47:14] == CDR updated on Zap/28-1 [2011-05-25 10:47:14] -- Executing [245@debcomainbtn-aa-businessopen:1] Set("Zap/28-1", "LOCAL_EXTEN=245") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:2] Set("Local/312@debcomainbtn-local-paging-be65,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:3] GotoIf("Local/312@debcomainbtn-local-paging-be65,2", "0?6") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:4] Set("Local/312@debcomainbtn-local-paging-be65,2", "OUTBOUND_GROUP=312@INCOMING") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:5] Dial("Local/312@debcomainbtn-local-paging-be65,2", "SIP/312|5") in new stack [2011-05-25 10:47:14] -- Called 312 [2011-05-25 10:47:14] -- Executing [314@debcomainbtn-local-paging:5] Gosub("Local/314@debcomainbtn-local-paging-2f5d,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:14] == Spawn extension (all-local-extension, paging, 6) exited non-zero on 'Local/299@debcomainbtn-local-paging-62d3,2' [2011-05-25 10:47:14] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/287@debcomainbtn-local-paging-78e2,2' [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:3] GotoIf("Local/320@debcomainbtn-local-paging-f0ac,2", "0?6") in new stack [2011-05-25 10:47:14] -- Executing [245@debcomainbtn-aa-businessopen:2] Gosub("Zap/28-1", "all-local-extension|s|1") in new stack [2011-05-25 10:47:14] -- Called 330@debcomainbtn-local-paging [2011-05-25 10:47:14] -- Executing [327@debcomainbtn-local-paging:2] Set("Local/327@debcomainbtn-local-paging-e1a1,2", "LOCAL_EXTEN=327") in new stack [2011-05-25 10:47:14] -- Executing [327@debcomainbtn-local-paging:3] SIPAddHeader("Local/327@debcomainbtn-local-paging-e1a1,2", " ;40mCall-Info:;answer-after=0") in new stack [2011-05-25 10:47:14] -- Executing [327@debcomainbtn-local-paging:4] Set("Local/327@debcomainbtn-local-paging-e1a1,2", "LOCAL_CHANNEL=SIP/327") in new stack [2011-05-25 10:47:14] -- Executing [327@debcomainbtn-local-paging:5] Gosub("Local/327@debcomainbtn-local-paging-e1a1,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:1] Set("Local/327@debcomainbtn-local-paging-e1a1,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:2] Set("Local/327@debcomainbtn-local-paging-e1a1,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:3] GotoIf("Local/327@debcomainbtn-local-paging-e1a1,2", "0?6") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:4] Set("Local/327@debcomainbtn-local-paging-e1a1,2", "OUTBOUND_GROUP=327@INCOMING") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:5] Dial("Local/327@debcomainbtn-local-paging-e1a1,2", "SIP/327|5") in new stack [2011-05-25 10:47:14] -- Executing [s@all-local-extension:1] Set("Zap/28-1", "__PICKUPMARK=245") in new stack [2011-05-25 10:47:14] -- Executing [s@all-local-extension:2] GotoIf("Zap/28-1", "0?4") in new stack [2011-05-25 10:47:14] -- Executing [s@all-local-extension:3] Set("Zap/28-1", "GROUP(OUTGOING)=9056371578") in new stack [2011-05-25 10:47:14] -- Executing [s@all-local-extension:4] Set("Zap/28-1", "OUTBOUND_GROUP_ONCE=245@INCOMING") in new stack [2011-05-25 10:47:14] -- Executing [s@all-local-extension:5] GotoIf("Zap/28-1", "1?8") in new stack [2011-05-25 10:47:14] -- Goto (all-local-extension,s,8) [2011-05-25 10:47:14] -- Executing [s@all-local-extension:8] Return("Zap/28-1", "") in new stack [2011-05-25 10:47:14] -- Executing [245@debcomainbtn-aa-businessopen:3] Ringing("Zap/28-1", "") in new stack [2011-05-25 10:47:14] -- Executing [245@debcomainbtn-aa-businessopen:4] Goto("Zap/28-1", "debcomainbtn-aa-followme-245|s|1") in new stack [2011-05-25 10:47:14] -- SIP/297-0000137c is ringing [2011-05-25 10:47:14] -- Executing [330@debcomainbtn-local-paging:1] NoCDR("Local/330@debcomainbtn-local-paging-d2d7,2", "") in new stack [2011-05-25 10:47:14] -- Goto (debcomainbtn-aa-followme-245,s,1) [2011-05-25 10:47:14] -- Executing [s@debcomainbtn-aa-followme-245:1] Set("Zap/28-1", "GLOBAL(__SCREEN_EXTENSION)=DEBCOMAINBTN_ONCALL_245") in new stack [2011-05-25 10:47:14] -- Local/297@debcomainbtn-local-paging-5a0f,1 is ringing [2011-05-25 10:47:14] -- Executing [330@debcomainbtn-local-paging:2] Set("Local/330@debcomainbtn-local-paging-d2d7,2", "LOCAL_EXTEN=330") in new stack [2011-05-25 10:47:14] -- Executing [323@debcomainbtn-local-paging:5] Gosub("Local/323@debcomainbtn-local-paging-c4bb,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:1] Set("Local/323@debcomainbtn-local-paging-c4bb,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:2] Set("Local/323@debcomainbtn-local-paging-c4bb,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:3] GotoIf("Local/323@debcomainbtn-local-paging-c4bb,2", "0?6") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:4] Set("Local/323@debcomainbtn-local-paging-c4bb,2", "OUTBOUND_GROUP=323@INCOMING") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:5] Dial("Local/323@debcomainbtn-local-paging-c4bb,2", "SIP/323|5") in new stack [2011-05-25 10:47:14] -- Called 323 [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:4] Set("Local/320@debcomainbtn-local-paging-f0ac,2", "OUTBOUND_GROUP=320@INCOMING") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:5] Dial("Local/320@debcomainbtn-local-paging-f0ac,2", "SIP/320|5") in new stack [2011-05-25 10:47:14] -- Called 320 [2011-05-25 10:47:14] == Setting global variable '__SCREEN_EXTENSION' to 'DEBCOMAINBTN_ONCALL_245' [2011-05-25 10:47:14] -- Called 327 [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:1] Set("Local/314@debcomainbtn-local-paging-2f5d,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:2] Set("Local/314@debcomainbtn-local-paging-2f5d,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:3] GotoIf("Local/314@debcomainbtn-local-paging-2f5d,2", "0?6") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:4] Set("Local/314@debcomainbtn-local-paging-2f5d,2", "OUTBOUND_GROUP=314@INCOMING") in new stack [2011-05-25 10:47:14] -- Executing [paging@all-local-extension:5] Dial("Local/314@debcomainbtn-local-paging-2f5d,2", "SIP/314|5") in new stack [2011-05-25 10:47:14] -- SIP/293-0000137e answered Local/293@debcomainbtn-local-paging-384f,2 [2011-05-25 10:47:14] -- Executing [322@debcomainbtn-local-paging:4] Set("Local/322@debcomainbtn-local-paging-eb7b,2", "LOCAL_CHANNEL=SIP/322") in new stack [2011-05-25 10:47:14] -- Local/293@debcomainbtn-local-paging-384f,1 answered [2011-05-25 10:47:14] -- SIP/295-0000137d answered Local/295@debcomainbtn-local-paging-6596,2 [2011-05-25 10:47:14] -- Local/295@debcomainbtn-local-paging-6596,1 answered [2011-05-25 10:47:14] -- Called 331@debcomainbtn-local-paging [2011-05-25 10:47:14] -- Called 314 [2011-05-25 10:47:14] -- Called 319 [2011-05-25 10:47:14] -- SIP/319-0000137f answered Local/319@debcomainbtn-local-paging-0534,2 [2011-05-25 10:47:14] -- SIP/323-00001383 answered Local/323@debcomainbtn-local-paging-c4bb,2 [2011-05-25 10:47:14] -- Local/323@debcomainbtn-local-paging-c4bb,1 answered [2011-05-25 10:47:14] -- SIP/320-00001384 answered Local/320@debcomainbtn-local-paging-f0ac,2 ======================================================================= === Currently Held Locks ============================================== ======================================================================= === === (times locked) === === Thread ID: 0xb7ed3b90 (do_devstate_changes started at [ 363] devicestate.c ast_device_state_engine_init()) === ---> Waiting for Lock #0 (pbx.c): MUTEX 6294 ast_rdlock_contexts &conlock 0x8189ec0 (1) === --- ---> Locked Here: pbx.c line 6294 (ast_rdlock_contexts) === ------------------------------------------------------------------- === === Thread ID: 0xb5447b90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Waiting for Lock #0 (pbx.c): MUTEX 6294 ast_rdlock_contexts &conlock 0x8189ec0 (1) === --- ---> Locked Here: pbx.c line 6294 (ast_rdlock_contexts) === ------------------------------------------------------------------- === === Thread ID: 0xb4bb7b90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Lock #0 (dial.c): MUTEX 239 begin_dial &(&dial->channels)->lock 0xb3c915dc (1) === ---> Lock #1 (channel.c): MUTEX 3807 ast_call &chan->lock 0xb4671be0 (1) === ---> Lock #2 (chan_local.c): MUTEX 577 local_call p 0xb4671950 (1) === ---> Waiting for Lock #3 (pbx.c): MUTEX 6294 ast_rdlock_contexts &conlock 0x8189ec0 (1) === --- ---> Locked Here: pbx.c line 6294 (ast_rdlock_contexts) === ------------------------------------------------------------------- === === Thread ID: 0xb445bb90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Waiting for Lock #0 (pbx.c): MUTEX 6294 ast_rdlock_contexts &conlock 0x8189ec0 (1) === --- ---> Locked Here: pbx.c line 6294 (ast_rdlock_contexts) === ------------------------------------------------------------------- === === Thread ID: 0xb5a9bb90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Waiting for Lock #0 (pbx.c): MUTEX 6294 ast_rdlock_contexts &conlock 0x8189ec0 (1) === --- ---> Locked Here: pbx.c line 6294 (ast_rdlock_contexts) === ------------------------------------------------------------------- === === Thread ID: 0xb531bb90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Waiting for Lock #0 (pbx.c): MUTEX 6294 ast_rdlock_contexts &conlock 0x8189ec0 (1) === --- ---> Locked Here: pbx.c line 6294 (ast_rdlock_contexts) === ------------------------------------------------------------------- === === Thread ID: 0xb4587b90 (async_dial started at [ 603] dial.c ast_dial_run()) === ---> Tried and failed to get Lock #0 (channel.c): MUTEX 2235 __ast_read &chan->lock 0xb3c91d28 (0) === ------------------------------------------------------------------- === === Thread ID: 0xb454bb90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Waiting for Lock #0 (pbx.c): MUTEX 6294 ast_rdlock_contexts &conlock 0x8189ec0 (1) === --- ---> Locked Here: pbx.c line 6294 (ast_rdlock_contexts) === ------------------------------------------------------------------- === === Thread ID: 0xb5357b90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Waiting for Lock #0 (pbx.c): MUTEX 6294 ast_rdlock_contexts &conlock 0x8189ec0 (1) === --- ---> Locked Here: pbx.c line 6294 (ast_rdlock_contexts) === ------------------------------------------------------------------- === === Thread ID: 0xb5843b90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Lock #0 (pbx.c): MUTEX 6294 ast_rdlock_contexts &conlock 0x8189ec0 (1) === ------------------------------------------------------------------- === === Thread ID: 0xb54fbb90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Waiting for Lock #0 (pbx.c): MUTEX 6294 ast_rdlock_contexts &conlock 0x8189ec0 (1) === --- ---> Locked Here: pbx.c line 6294 (ast_rdlock_contexts) === ------------------------------------------------------------------- === === Thread ID: 0xb4d5bb90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Waiting for Lock #0 (pbx.c): MUTEX 6294 ast_rdlock_contexts &conlock 0x8189ec0 (1) === --- ---> Locked Here: pbx.c line 6294 (ast_rdlock_contexts) === ------------------------------------------------------------------- === === Thread ID: 0xb504bb90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Waiting for Lock #0 (pbx.c): MUTEX 6294 ast_rdlock_contexts &conlock 0x8189ec0 (1) === --- ---> Locked Here: pbx.c line 6294 (ast_rdlock_contexts) === ------------------------------------------------------------------- === ======================================================================= [2011-05-25 10:47:15] -- SIP/294-00001380 is ringing [2011-05-25 10:47:15] -- Local/320@debcomainbtn-local-paging-f0ac,1 answered [2011-05-25 10:47:15] -- Local/319@debcomainbtn-local-paging-0534,1 answered [2011-05-25 10:47:15] -- SIP/314-00001385 answered Local/314@debcomainbtn-local-paging-2f5d,2 [2011-05-25 10:47:15] -- Local/294@debcomainbtn-local-paging-e9c2,1 is ringing [2011-05-25 10:47:15] -- Local/314@debcomainbtn-local-paging-2f5d,1 answered [2011-05-25 10:47:15] -- Executing [330@debcomainbtn-local-paging:3] SIPAddHeader("Local/330@debcomainbtn-local-paging-d2d7,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:15] -- Executing [s@debcomainbtn-aa-followme-245:2] Set("Zap/28-1", "__FOLLOWME=YES") in new stack [2011-05-25 10:47:15] -- Executing [330@debcomainbtn-local-paging:4] Set("Local/330@debcomainbtn-local-paging-d2d7,2", "LOCAL_CHANNEL=SIP/330") in new stack [2011-05-25 10:47:15] -- Executing [s@debcomainbtn-aa-followme-245:3] Set("Zap/28-1", "QUEUE_PRIO=0") in new stack [2011-05-25 10:47:15] -- Executing [330@debcomainbtn-local-paging:5] Gosub("Local/330@debcomainbtn-local-paging-d2d7,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:15] -- Executing [s@debcomainbtn-aa-followme-245:4] Gosub("Zap/28-1", "debcomainbtn-application-acd-rondaking|s|1") in new stack [2011-05-25 10:47:15] -- Executing [s@debcomainbtn-application-acd-rondaking:1] Set("Zap/28-1", "AUDIOHOOK_INHERIT(MixMonitor)=yes") in new stack [2011-05-25 10:47:15] -- Executing [s@debcomainbtn-application-acd-rondaking:2] NoOp("Zap/28-1", ""=== START QUEUE (debcomainbtn-rondaking) ==="") in new stack [2011-05-25 10:47:15] -- Executing [s@debcomainbtn-application-acd-rondaking:3] Set("Zap/28-1", "__QUEUENAME=debcomainbtn-rondaking") in new stack [2011-05-25 10:47:15] -- Executing [s@debcomainbtn-application-acd-rondaking:4] GotoIf("Zap/28-1", "1?7") in new stack [2011-05-25 10:47:15] -- Goto (debcomainbtn-application-acd-rondaking,s,7) [2011-05-25 10:47:15] -- Executing [s@debcomainbtn-application-acd-rondaking:7] Set("Zap/28-1", "MONITOR_FILENAME=1306334828.13543") in new stack [2011-05-25 10:47:15] -- Executing [s@debcomainbtn-application-acd-rondaking:8] Set("Zap/28-1", "TIMEOUT(digit)=1") in new stack [2011-05-25 10:47:15] -- Digit timeout set to 1 [2011-05-25 10:47:15] -- Executing [s@debcomainbtn-application-acd-rondaking:9] Set("Zap/28-1", "TIMEOUT(response)=1") in new stack [2011-05-25 10:47:15] -- Executing [322@debcomainbtn-local-paging:5] Gosub("Local/322@debcomainbtn-local-paging-eb7b,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:15] -- Response timeout set to 1 [2011-05-25 10:47:15] -- Executing [331@debcomainbtn-local-paging:1] NoCDR("Local/331@debcomainbtn-local-paging-f40a,2", "") in new stack [2011-05-25 10:47:15] -- Called 335@debcomainbtn-local-paging [2011-05-25 10:47:15] -- Executing [s@debcomainbtn-application-acd-rondaking:10] BackGround("Zap/28-1", "custom/0055") in new stack [2011-05-25 10:47:15] -- Executing [paging@all-local-extension:4] Set("Local/321@debcomainbtn-local-paging-e6e7,2", "OUTBOUND_GROUP=321@INCOMING") in new stack [2011-05-25 10:47:15] -- Executing [335@debcomainbtn-local-paging:1] NoCDR("Local/335@debcomainbtn-local-paging-7556,2", "") in new stack [2011-05-25 10:47:15] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/289@debcomainbtn-local-paging-bef4,2' [2011-05-25 10:47:15] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/290@debcomainbtn-local-paging-7686,2' [2011-05-25 10:47:15] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/298@debcomainbtn-local-paging-c628,2' [2011-05-25 10:47:15] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/295@debcomainbtn-local-paging-6596,2' [2011-05-25 10:47:15] -- Playing 'custom/0055' (language 'en') [2011-05-25 10:47:15] -- SIP/327-00001382 answered Local/327@debcomainbtn-local-paging-e1a1,2 [2011-05-25 10:47:15] -- Called 344@debcomainbtn-local-paging [2011-05-25 10:47:15] -- Local/327@debcomainbtn-local-paging-e1a1,1 answered [2011-05-25 10:47:15] -- SIP/404-00001350 answered Local/404@debcomainbtn-agent-a3e3,2 [2011-05-25 10:47:15] -- Executing [paging@all-local-extension:1] Set("Local/322@debcomainbtn-local-paging-eb7b,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:15] -- Executing [paging@all-local-extension:2] Set("Local/322@debcomainbtn-local-paging-eb7b,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:15] -- Executing [paging@all-local-extension:3] GotoIf("Local/322@debcomainbtn-local-paging-eb7b,2", "0?6") in new stack [2011-05-25 10:47:15] -- Local/404@debcomainbtn-agent-a3e3,1 answered Zap/44-1 [2011-05-25 10:47:15] -- Stopped music on hold on Zap/44-1 [2011-05-25 10:47:15] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/293@debcomainbtn-local-paging-384f,2' [2011-05-25 10:47:15] -- Executing [paging@all-local-extension:5] Dial("Local/321@debcomainbtn-local-paging-e6e7,2", "SIP/321|5") in new stack [2011-05-25 10:47:15] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/319@debcomainbtn-local-paging-0534,2' [2011-05-25 10:47:15] Extension Changed 295[debcomainbtn-local] new state InUse for Notify User 335 [2011-05-25 10:47:15] -- Executing [335@debcomainbtn-local-paging:2] Set("Local/335@debcomainbtn-local-paging-7556,2", "LOCAL_EXTEN=335") in new stack [2011-05-25 10:47:15] -- Executing [331@debcomainbtn-local-paging:2] Set("Local/331@debcomainbtn-local-paging-f40a,2", "LOCAL_EXTEN=331") in new stack [2011-05-25 10:47:15] -- Executing [paging@all-local-extension:4] Set("Local/322@debcomainbtn-local-paging-eb7b,2", "OUTBOUND_GROUP=322@INCOMING") in new stack [2011-05-25 10:47:15] -- Executing [paging@all-local-extension:5] Dial("Local/322@debcomainbtn-local-paging-eb7b,2", "SIP/322|5") in new stack [2011-05-25 10:47:15] -- Called 322 [2011-05-25 10:47:15] -- Executing [331@debcomainbtn-local-paging:3] SIPAddHeader("Local/331@debcomainbtn-local-paging-f40a,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:15] -- SIP/312-00001381 answered Local/312@debcomainbtn-local-paging-be65,2 [2011-05-25 10:47:15] -- Called 321 [2011-05-25 10:47:15] -- Executing [331@debcomainbtn-local-paging:4] Set("Local/331@debcomainbtn-local-paging-f40a,2", "LOCAL_CHANNEL=SIP/331") in new stack [2011-05-25 10:47:15] -- Executing [331@debcomainbtn-local-paging:5] Gosub("Local/331@debcomainbtn-local-paging-f40a,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:15] -- Executing [paging@all-local-extension:1] Set("Local/331@debcomainbtn-local-paging-f40a,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:15] -- Local/312@debcomainbtn-local-paging-be65,1 answered [2011-05-25 10:47:15] -- Executing [paging@all-local-extension:2] Set("Local/331@debcomainbtn-local-paging-f40a,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:15] Extension Changed 404[debcomainbtn-local] new state InUse for Notify User 335 [2011-05-25 10:47:15] -- Executing [335@debcomainbtn-local-paging:3] SIPAddHeader("Local/335@debcomainbtn-local-paging-7556,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:15] -- Executing [335@debcomainbtn-local-paging:4] Set("Local/335@debcomainbtn-local-paging-7556,2", "LOCAL_CHANNEL=SIP/335") in new stack [2011-05-25 10:47:15] -- Executing [335@debcomainbtn-local-paging:5] Gosub("Local/335@debcomainbtn-local-paging-7556,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:15] -- Called 350@debcomainbtn-local-paging [2011-05-25 10:47:15] -- Playing 'beep' (language 'en') [2011-05-25 10:47:15] -- Executing [344@debcomainbtn-local-paging:1] NoCDR("Local/344@debcomainbtn-local-paging-e4e2,2", "") in new stack [2011-05-25 10:47:15] -- SIP/322-00001387 answered Local/322@debcomainbtn-local-paging-eb7b,2 [2011-05-25 10:47:15] -- Executing [344@debcomainbtn-local-paging:2] Set("Local/344@debcomainbtn-local-paging-e4e2,2", "LOCAL_EXTEN=344") in new stack [2011-05-25 10:47:15] -- Executing [344@debcomainbtn-local-paging:3] SIPAddHeader("Local/344@debcomainbtn-local-paging-e4e2,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:15] -- SIP/321-00001386 answered Local/321@debcomainbtn-local-paging-e6e7,2 [2011-05-25 10:47:15] -- Executing [344@debcomainbtn-local-paging:4] Set("Local/344@debcomainbtn-local-paging-e4e2,2", "LOCAL_CHANNEL=SIP/344") in new stack [2011-05-25 10:47:15] -- Executing [350@debcomainbtn-local-paging:1] NoCDR("Local/350@debcomainbtn-local-paging-ee57,2", "") in new stack [2011-05-25 10:47:15] -- Local/321@debcomainbtn-local-paging-e6e7,1 answered [2011-05-25 10:47:15] -- Executing [paging@all-local-extension:3] GotoIf("Local/331@debcomainbtn-local-paging-f40a,2", "0?6") in new stack [2011-05-25 10:47:15] -- Executing [paging@all-local-extension:4] Set("Local/331@debcomainbtn-local-paging-f40a,2", "OUTBOUND_GROUP=331@INCOMING") in new stack [2011-05-25 10:47:15] -- Executing [paging@all-local-extension:5] Dial("Local/331@debcomainbtn-local-paging-f40a,2", "SIP/331|5") in new stack [2011-05-25 10:47:15] WARNING[23623]: app_dial.c:1323 dial_exec_full: Unable to create channel of type 'SIP' (cause 20 - Unknown) [2011-05-25 10:47:15] == Everyone is busy/congested at this time (1:0/0/1) [2011-05-25 10:47:15] -- Executing [paging@all-local-extension:6] Hangup("Local/331@debcomainbtn-local-paging-f40a,2", "20") in new stack [2011-05-25 10:47:15] == Spawn extension (all-local-extension, paging, 6) exited non-zero on 'Local/331@debcomainbtn-local-paging-f40a,2' [2011-05-25 10:47:15] -- Executing [344@debcomainbtn-local-paging:5] Gosub("Local/344@debcomainbtn-local-paging-e4e2,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:15] -- Executing [350@debcomainbtn-local-paging:2] Set("Local/350@debcomainbtn-local-paging-ee57,2", "LOCAL_EXTEN=350") in new stack [2011-05-25 10:47:15] -- Executing [350@debcomainbtn-local-paging:3] Set("Local/350@debcomainbtn-local-paging-ee57,2", "LOCAL_CHANNEL=Zap/24") in new stack [2011-05-25 10:47:15] -- Executing [350@debcomainbtn-local-paging:4] Gosub("Local/350@debcomainbtn-local-paging-ee57,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:15] -- Local/322@debcomainbtn-local-paging-eb7b,1 answered [2011-05-25 10:47:15] -- Executing [paging@all-local-extension:1] Set("Local/330@debcomainbtn-local-paging-d2d7,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:15] -- Executing [paging@all-local-extension:2] Set("Local/330@debcomainbtn-local-paging-d2d7,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:15] -- Executing [paging@all-local-extension:3] GotoIf("Local/330@debcomainbtn-local-paging-d2d7,2", "0?6") in new stack [2011-05-25 10:47:15] -- Executing [paging@all-local-extension:4] Set("Local/330@debcomainbtn-local-paging-d2d7,2", "OUTBOUND_GROUP=330@INCOMING") in new stack [2011-05-25 10:47:15] -- Executing [paging@all-local-extension:5] Dial("Local/330@debcomainbtn-local-paging-d2d7,2", "SIP/330|5") in new stack [2011-05-25 10:47:15] -- Zap/69-1 answered SIP/411-00001351 [2011-05-25 10:47:15] -- Called 330 [2011-05-25 10:47:15] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/320@debcomainbtn-local-paging-f0ac,2' [2011-05-25 10:47:15] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/323@debcomainbtn-local-paging-c4bb,2' [2011-05-25 10:47:16] -- Executing [paging@all-local-extension:1] Set("Local/335@debcomainbtn-local-paging-7556,2", "GROUPCOUNT=0") in new stack voip*CLI> core show locks [2011-05-25 10:47:16] -- Executing [paging@all-local-extension:2] Set("Local/335@debcomainbtn-local-paging-7556,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:16] -- Executing [paging@all-local-extension:3] GotoIf("Local/335@debcomainbtn-local-paging-7556,2", "0?6") in new stack [2011-05-25 10:47:16] -- Executing [paging@all-local-extension:4] Set("Local/335@debcomainbtn-local-paging-7556,2", "OUTBOUND_GROUP=335@INCOMING") in new stack [2011-05-25 10:47:16] -- Executing [paging@all-local-extension:5] Dial("Local/335@debcomainbtn-local-paging-7556,2", "SIP/335|5") in new stack [2011-05-25 10:47:16] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/312@debcomainbtn-local-paging-be65,2' [2011-05-25 10:47:16] -- Called 335 [2011-05-25 10:47:16] -- Executing [paging@all-local-extension:1] Set("Local/344@debcomainbtn-local-paging-e4e2,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:16] -- Executing [paging@all-local-extension:2] Set("Local/344@debcomainbtn-local-paging-e4e2,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:16] -- Executing [paging@all-local-extension:3] GotoIf("Local/344@debcomainbtn-local-paging-e4e2,2", "0?6") in new stack [2011-05-25 10:47:16] -- Executing [paging@all-local-extension:4] Set("Local/344@debcomainbtn-local-paging-e4e2,2", "OUTBOUND_GROUP=344@INCOMING") in new stack [2011-05-25 10:47:16] -- Executing [paging@all-local-extension:5] Dial("Local/344@debcomainbtn-local-paging-e4e2,2", "SIP/344|5") in new stack [2011-05-25 10:47:16] -- Called 344 [2011-05-25 10:47:16] -- Executing [paging@all-local-extension:1] Set("Local/350@debcomainbtn-local-paging-ee57,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:16] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/322@debcomainbtn-local-paging-eb7b,2' [2011-05-25 10:47:16] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/321@debcomainbtn-local-paging-e6e7,2' [2011-05-25 10:47:16] -- Executing [paging@all-local-extension:2] Set("Local/350@debcomainbtn-local-paging-ee57,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:16] -- Executing [paging@all-local-extension:3] GotoIf("Local/350@debcomainbtn-local-paging-ee57,2", "0?6") in new stack [2011-05-25 10:47:16] -- Executing [paging@all-local-extension:4] Set("Local/350@debcomainbtn-local-paging-ee57,2", "OUTBOUND_GROUP=350@INCOMING") in new stack [2011-05-25 10:47:16] -- Executing [paging@all-local-extension:5] Dial("Local/350@debcomainbtn-local-paging-ee57,2", "Zap/24|5") in new stack [2011-05-25 10:47:16] -- SIP/330-00001388 answered Local/330@debcomainbtn-local-paging-d2d7,2 [2011-05-25 10:47:16] -- Called 24 [2011-05-25 10:47:16] -- Zap/24-1 is ringing [2011-05-25 10:47:16] -- Local/350@debcomainbtn-local-paging-ee57,1 is ringing [2011-05-25 10:47:16] -- Zap/70-1 answered SIP/284-0000134d [2011-05-25 10:47:16] -- Local/330@debcomainbtn-local-paging-d2d7,1 answered ======================================================================= === Currently Held Locks ============================================== ======================================================================= === === (times locked) === === Thread ID: 0xb5c3fb90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Lock #0 (channel.c): MUTEX 3153 ast_write &chan->lock 0xb3b08c08 (1) === ---> Lock #1 (chan_local.c): MUTEX 395 local_write p 0xb3b16c98 (1) === ---> Lock #2 (chan_local.c): MUTEX 250 local_queue_frame &other->lock 0xb3b172f0 (2) === ------------------------------------------------------------------- === === Thread ID: 0xb5663b90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Waiting for Lock #0 (channel.c): MUTEX 1883 ast_waitfor_nandfds &c[x]->lock 0xb3b172f0 (1) === --- ---> Locked Here: chan_local.c line 250 (local_queue_frame) === --- ---> Locked Here: channel.c line 920 (__ast_queue_frame) === ------------------------------------------------------------------- === === Thread ID: 0xb5ad7b90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Waiting for Lock #0 (channel.c): MUTEX 1883 ast_waitfor_nandfds &c[x]->lock 0xb3bd0f78 (1) === ------------------------------------------------------------------- === === Thread ID: 0xb54fbb90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Waiting for Lock #0 (manager.c): MUTEX 2698 manager_event &(&sessions)->lock 0x81879c8 (1) === ------------------------------------------------------------------- === ======================================================================= [2011-05-25 10:47:16] -- SIP/335-00001389 answered Local/335@debcomainbtn-local-paging-7556,2 [2011-05-25 10:47:16] -- SIP/344-0000138a answered Local/344@debcomainbtn-local-paging-e4e2,2 [2011-05-25 10:47:16] -- Local/344@debcomainbtn-local-paging-e4e2,1 answered [2011-05-25 10:47:16] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/330@debcomainbtn-local-paging-d2d7,2' [2011-05-25 10:47:16] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/327@debcomainbtn-local-paging-e1a1,2' [2011-05-25 10:47:16] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/344@debcomainbtn-local-paging-e4e2,2' [2011-05-25 10:47:16] -- Local/335@debcomainbtn-local-paging-7556,1 answered [2011-05-25 10:47:16] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/314@debcomainbtn-local-paging-2f5d,2' [2011-05-25 10:47:16] WARNING[23634]: chan_dahdi.c:1889 dahdi_train_ec: Unable to request echo training on channel 24: Invalid argument [2011-05-25 10:47:16] -- Zap/24-1 answered Local/350@debcomainbtn-local-paging-ee57,2 [2011-05-25 10:47:16] -- Local/350@debcomainbtn-local-paging-ee57,1 answered [2011-05-25 10:47:16] -- Executing [324@debcomainbtn-local-paging:2] Set("Local/324@debcomainbtn-local-paging-b37f,2", "LOCAL_EXTEN=324") in new stack [2011-05-25 10:47:16] -- Executing [324@debcomainbtn-local-paging:3] SIPAddHeader("Local/324@debcomainbtn-local-paging-b37f,2", "Call-Info:;answer-after=0") in new stack [2011-05-25 10:47:16] -- Executing [324@debcomainbtn-local-paging:4] Set("Local/324@debcomainbtn-local-paging-b37f,2", "LOCAL_CHANNEL=SIP/324") in new stack [2011-05-25 10:47:16] -- Executing [324@debcomainbtn-local-paging:5] Gosub("Local/324@debcomainbtn-local-paging-b37f,2", "all-local-extension|paging|1") in new stack [2011-05-25 10:47:16] -- Executing [paging@all-local-extension:1] Set("Local/324@debcomainbtn-local-paging-b37f,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:16] -- Executing [paging@all-local-extension:2] Set("Local/324@debcomainbtn-local-paging-b37f,2", "GROUPCOUNT=0") in new stack [2011-05-25 10:47:16] -- Executing [paging@all-local-extension:3] GotoIf("Local/324@debcomainbtn-local-paging-b37f,2", "0?6") in new stack [2011-05-25 10:47:16] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/350@debcomainbtn-local-paging-ee57,2' [2011-05-25 10:47:16] -- Executing [paging@all-local-extension:4] Set("Local/324@debcomainbtn-local-paging-b37f,2", "OUTBOUND_GROUP=324@INCOMING") in new stack [2011-05-25 10:47:16] -- Executing [paging@all-local-extension:5] Dial("Local/324@debcomainbtn-local-paging-b37f,2", "SIP/324|5") in new stack [2011-05-25 10:47:16] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/335@debcomainbtn-local-paging-7556,2' [2011-05-25 10:47:16] Extension Changed 324[debcomainbtn-local] new state Ringing for Notify User 335 [2011-05-25 10:47:16] -- Called 324 [2011-05-25 10:47:17] -- Stopped music on hold on Zap/27-1 [2011-05-25 10:47:17] -- Started music on hold, class 'debcoadvertising', on channel 'Zap/27-1' voip*CLI> core show locks ======================================================================= === Currently Held Locks ============================================== ======================================================================= === === (times locked) === === Thread ID: 0xb61a7b90 (do_monitor started at [17822] chan_sip.c restart_monitor()) === ---> Lock #0 (chan_sip.c): MUTEX 17661 do_monitor &iflock 0x10d7f40 (1) === ---> Lock #1 (chan_sip.c): MUTEX 17673 do_monitor &sip->lock 0xb3cc1208 (2) === ---> Waiting for Lock #2 (logger.c): MUTEX 1033 ast_verbose &(&verbosers)->lock 0x8187468 (1) === --- ---> Locked Here: logger.c line 1033 (ast_verbose) === ------------------------------------------------------------------- === === Thread ID: 0xb5843b90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Lock #0 (logger.c): MUTEX 1033 ast_verbose &(&verbosers)->lock 0x8187468 (1) === ------------------------------------------------------------------- === ======================================================================= [2011-05-25 10:47:17] -- SIP/324-0000138b answered Local/324@debcomainbtn-local-paging-b37f,2 voip*CLI> core show locks ======================================================================= === Currently Held Locks ============================================== ======================================================================= === === (times locked) === === Thread ID: 0xb61a7b90 (do_monitor started at [17822] chan_sip.c restart_monitor()) === ---> Lock #0 (chan_sip.c): MUTEX 17661 do_monitor &iflock 0x10d7f40 (1) === ---> Lock #1 (chan_sip.c): MUTEX 17673 do_monitor &sip->lock 0xb3cc1208 (2) === ---> Waiting for Lock #2 (logger.c): MUTEX 1033 ast_verbose &(&verbosers)->lock 0x8187468 (1) === --- ---> Locked Here: logger.c line 1033 (ast_verbose) === ------------------------------------------------------------------- === === Thread ID: 0xb5843b90 (pbx_thread started at [ 2712] pbx.c ast_pbx_start()) === ---> Lock #0 (logger.c): MUTEX 1033 ast_verbose &(&verbosers)->lock 0x8187468 (1) === ------------------------------------------------------------------- === ======================================================================= [2011-05-25 10:47:17] Extension Changed 324[debcomainbtn-local] new state InUse for Notify User 335 [2011-05-25 10:47:19] -- Local/324@debcomainbtn-local-paging-b37f,1 answered [2011-05-25 10:47:19] -- Executing [h@macro-debcomainbtn-dial-zap-3f5b2a-001056:1] ResetCDR("SIP/284-0000134d", "w") in new stack [2011-05-25 10:47:19] -- Executing [h@macro-debcomainbtn-dial-zap-3f5b2a-001056:2] NoCDR("SIP/284-0000134d", "") in new stack [2011-05-25 10:47:19] -- Hungup 'Zap/70-1' [2011-05-25 10:47:19] == Spawn extension (debcomainbtn-staff, 96472968829, 1) exited non-zero on 'SIP/284-0000134d' [2011-05-25 10:47:19] WARNING[23617]: channel.c:985 __ast_queue_frame: Exceptionally long voice queue length queuing to Local/324@debcomainbtn-local-paging-b37f,1 [2011-05-25 10:47:19] -- Accepting call from '9058441291' to '2247' on channel 0/19, span 2 [2011-05-25 10:47:19] -- Executing [2247@zap-incoming:1] Set("Zap/43-1", "__INCOMING_DNIS=2247") in new stack [2011-05-25 10:47:19] -- Executing [2247@zap-incoming:2] Set("Zap/43-1", "LINE_TENANT=debcomainbtn") in new stack [2011-05-25 10:47:19] -- Executing [2247@zap-incoming:3] Set("Zap/43-1", "LINE_LANGUAGE=en") in new stack [2011-05-25 10:47:19] -- Executing [2247@zap-incoming:4] Set("Zap/43-1", "LINE_CLID_NUM=UNKNOWN") in new stack [2011-05-25 10:47:19] -- Executing [2247@zap-incoming:5] Set("Zap/43-1", "LINE_CLID_NAME=") in new stack [2011-05-25 10:47:19] -- Executing [2247@zap-incoming:6] Set("Zap/43-1", "LINE_MOH=debcoadvertising") in new stack [2011-05-25 10:47:19] -- Executing [2247@zap-incoming:7] Gosub("Zap/43-1", "all-incoming-check|s|1") in new stack [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:1] NoOp("Zap/43-1", ""INCOMING CALL FROM CALLER ID: 9058441291 (ENTRIPY GROUP)"") in new stack [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:2] GotoIf("Zap/43-1", "1?7") in new stack [2011-05-25 10:47:19] -- Goto (all-incoming-check,s,7) [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:7] GotoIf("Zap/43-1", "1?10") in new stack [2011-05-25 10:47:19] -- Goto (all-incoming-check,s,10) [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:10] GotoIf("Zap/43-1", "1?12") in new stack [2011-05-25 10:47:19] -- Goto (all-incoming-check,s,12) [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:12] GotoIf("Zap/43-1", "1?14") in new stack [2011-05-25 10:47:19] -- Goto (all-incoming-check,s,14) [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:14] GotoIf("Zap/43-1", "1?16") in new stack [2011-05-25 10:47:19] -- Goto (all-incoming-check,s,16) [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:16] GotoIf("Zap/43-1", "0?18") in new stack [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:17] Set("Zap/43-1", "CHANNEL(musicclass)=debcoadvertising") in new stack [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:18] Set("Zap/43-1", "CALLERID(dnid)=2247") in new stack [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:19] Set("Zap/43-1", "CDR(userfield)=2247") in new stack [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:20] Set("Zap/43-1", "__EXTCONTEXT=default-default") in new stack [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:21] Set("Zap/43-1", "__INCOMINGLINE=1") in new stack [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:22] Set("Zap/43-1", "__ORGCALLID=1306334839.13747") in new stack [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:23] GotoIf("Zap/43-1", "1?25") in new stack [2011-05-25 10:47:19] -- Goto (all-incoming-check,s,25) [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:25] GotoIf("Zap/43-1", "1?27") in new stack [2011-05-25 10:47:19] -- Goto (all-incoming-check,s,27) [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:27] GotoIf("Zap/43-1", "1?29") in new stack [2011-05-25 10:47:19] -- Goto (all-incoming-check,s,29) [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:29] GotoIf("Zap/43-1", "1?31") in new stack [2011-05-25 10:47:19] -- Goto (all-incoming-check,s,31) [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:31] AGI("Zap/43-1", "agi://127.0.0.1:4573/fixcidname") in new stack [2011-05-25 10:47:19] == Spawn extension (all-local-extension, paging, 5) exited non-zero on 'Local/324@debcomainbtn-local-paging-b37f,2' [2011-05-25 10:47:19] -- AGI Script agi://127.0.0.1:4573/fixcidname completed, returning 0 [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:32] GotoIf("Zap/43-1", "1?34") in new stack [2011-05-25 10:47:19] -- Goto (all-incoming-check,s,34) [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:34] GotoIf("Zap/43-1", "0?36") in new stack [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:35] Set("Zap/43-1", "CHANNEL(language)=en") in new stack [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:36] Set("Zap/43-1", "FAXNUMBER=2247") in new stack [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:37] GotoIf("Zap/43-1", "1?39") in new stack [2011-05-25 10:47:19] -- Goto (all-incoming-check,s,39) [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:39] GotoIf("Zap/43-1", "1?41") in new stack [2011-05-25 10:47:19] -- Goto (all-incoming-check,s,41) [2011-05-25 10:47:19] -- Nobody picked up in 5000 ms [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:41] GotoIf("Zap/43-1", "1?44") in new stack [2011-05-25 10:47:19] -- Executing [paging@all-local-extension:6] Hangup("Local/292@debcomainbtn-local-paging-8647,2", "0") in new stack [2011-05-25 10:47:19] == Spawn extension (all-local-extension, paging, 6) exited non-zero on 'Local/292@debcomainbtn-local-paging-8647,2' [2011-05-25 10:47:19] -- Goto (all-incoming-check,s,44) [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:44] GotoIf("Zap/43-1", "0?49") in new stack [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:45] GotoIf("Zap/43-1", "1?47") in new stack [2011-05-25 10:47:19] -- Goto (all-incoming-check,s,47) [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:47] GotoIf("Zap/43-1", "1?49") in new stack [2011-05-25 10:47:19] -- Goto (all-incoming-check,s,49) [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:49] GotoIf("Zap/43-1", "1?54") in new stack [2011-05-25 10:47:19] -- Goto (all-incoming-check,s,54) [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:54] GotoIf("Zap/43-1", "1?56") in new stack [2011-05-25 10:47:19] -- Goto (all-incoming-check,s,56) [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:56] GotoIf("Zap/43-1", "1?58") in new stack [2011-05-25 10:47:19] -- Goto (all-incoming-check,s,58) [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:58] GotoIf("Zap/43-1", "1?60") in new stack [2011-05-25 10:47:19] -- Goto (all-incoming-check,s,60) [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:60] GotoIf("Zap/43-1", "1?62") in new stack [2011-05-25 10:47:19] -- Goto (all-incoming-check,s,62) [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:62] Set("Zap/43-1", "CALLFILENAME=1306334839.13747") in new stack [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:63] GotoIf("Zap/43-1", "1?65") in new stack [2011-05-25 10:47:19] -- Goto (all-incoming-check,s,65) [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:65] GotoIf("Zap/43-1", "1?67") in new stack [2011-05-25 10:47:19] -- Goto (all-incoming-check,s,67) [2011-05-25 10:47:19] -- Executing [s@all-incoming-check:67] Return("Zap/43-1", "") in new stack [2011-05-25 10:47:19] -- Executing [2247@zap-incoming:8] Answer("Zap/43-1", "") in new stack [2011-05-25 10:47:19] -- Executing [2247@zap-incoming:9] Goto("Zap/43-1", "20") in new stack [2011-05-25 10:47:19] -- Nobody picked up in 5000 ms [2011-05-25 10:47:19] -- Goto (zap-incoming,2247,20) [2011-05-25 10:47:19] -- Executing [2247@zap-incoming:20] Gosub("Zap/43-1", "debcomainbtn-aa-businessopen|s|1") in new stack [2011-05-25 10:47:19] -- Executing [s@debcomainbtn-aa-businessopen:1] Answer("Zap/43-1", "") in new stack [2011-05-25 10:47:19] -- Executing [s@debcomainbtn-aa-businessopen:2] AGI("Zap/43-1", "agi://127.0.0.1:4573/ivr?arg1=334") in new stack [2011-05-25 10:47:19] -- Executing [paging@all-local-extension:6] Hangup("Local/297@debcomainbtn-local-paging-5a0f,2", "0") in new stack [2011-05-25 10:47:19] == Spawn extension (all-local-extension, paging, 6) exited non-zero on 'Local/297@debcomainbtn-local-paging-5a0f,2' [2011-05-25 10:47:19] -- Nobody picked up in 5000 ms [2011-05-25 10:47:19] -- AGI Script agi://127.0.0.1:4573/ivr?arg1=334 completed, returning 0 [2011-05-25 10:47:19] -- Executing [paging@all-local-extension:6] Hangup("Local/294@debcomainbtn-local-paging-e9c2,2", "0") in new stack [2011-05-25 10:47:19] == Spawn extension (all-local-extension, paging, 6) exited non-zero on 'Local/294@debcomainbtn-local-paging-e9c2,2' [2011-05-25 10:47:19] -- Executing [s@debcomainbtn-aa-businessopen:3] Wait("Zap/43-1", "1") in new stack [2011-05-25 10:47:20] Extension Changed 253[debcomainbtn-local] new state Idle for Notify User 335 voip*CLI> core show locks ======================================================================= === Currently Held Locks ============================================== ======================================================================= === === (times locked) === =======================================================================