Failed outbound calls ringing the incoming queue

For some reason about a month ago when an outbound call can not complete, such as a disconnected or bad number, the call rings back into the inbound queue. Nothing changed on our end other than updates. I am not seeing any errors in the logs. I called the numbers with my cell and confirmed they are all to bad numbers. Most of them on the cell I get a message that it can not be completed.

Can you post the logs please?

Here is the log file. I know it is the part with Local/2017@from-queue but I am not able to figure out the cause. Thank you. I had to cut off the top of the log due to size. I couldnt attach a txt file.

[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-user-callerid:13] GotoIf(“SIP/22001-000010ac”, “0?limit”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-user-callerid:14] ExecIf(“SIP/22001-000010ac”, “1?Set(GROUP(concurrency_limit)=22001)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-user-callerid:15] ExecIf(“SIP/22001-000010ac”, “0?Set(CHANNEL(language)=)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-user-callerid:16] NoOp(“SIP/22001-000010ac”, “Macro Depth is 1”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-user-callerid:17] GotoIf(“SIP/22001-000010ac”, “1?report2:macroerror”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-user-callerid:19] GotoIf(“SIP/22001-000010ac”, “1?continue”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-user-callerid:37] Set(“SIP/22001-000010ac”, “CALLERID(number)=22001”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-user-callerid:38] Set(“SIP/22001-000010ac”, “CALLERID(name)=John Gibson”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-user-callerid:39] GotoIf(“SIP/22001-000010ac”, “0?cnum”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-user-callerid:40] Set(“SIP/22001-000010ac”, “CDR(cnam)=John Gibson”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-user-callerid:41] Set(“SIP/22001-000010ac”, “CDR(cnum)=22001”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-user-callerid:42] Set(“SIP/22001-000010ac”, “CHANNEL(language)=en”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [914015555432@from-internal:2] Gosub(“SIP/22001-000010ac”, “sub-record-check,s,1(out,914015555432,dontcare)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-record-check:1] GotoIf(“SIP/22001-000010ac”, “0?initialized”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-record-check:2] Set(“SIP/22001-000010ac”, “__REC_STATUS=INITIALIZED”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-record-check:3] Set(“SIP/22001-000010ac”, “NOW=1521559121”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-record-check:4] Set(“SIP/22001-000010ac”, “__DAY=20”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-record-check:5] Set(“SIP/22001-000010ac”, “__MONTH=03”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-record-check:6] Set(“SIP/22001-000010ac”, “__YEAR=2018”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-record-check:7] Set(“SIP/22001-000010ac”, “__TIMESTR=20180320-111841”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-record-check:8] Set(“SIP/22001-000010ac”, “__FROMEXTEN=22001”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-record-check:9] Set(“SIP/22001-000010ac”, “__MON_FMT=wav”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-record-check:10] NoOp(“SIP/22001-000010ac”, “Recordings initialized”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-record-check:11] ExecIf(“SIP/22001-000010ac”, “0?Set(ARG3=dontcare)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-record-check:12] Set(“SIP/22001-000010ac”, “REC_POLICY_MODE_SAVE=”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-record-check:13] ExecIf(“SIP/22001-000010ac”, “0?Set(REC_STATUS=NO)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-record-check:14] GotoIf(“SIP/22001-000010ac”, “3?checkaction”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-record-check:17] GotoIf(“SIP/22001-000010ac”, “1?sub-record-check,out,1”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [out@sub-record-check:1] NoOp(“SIP/22001-000010ac”, “Outbound Recording Check from 22001 to 914015555432”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [out@sub-record-check:2] Set(“SIP/22001-000010ac”, “RECMODE=force”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [out@sub-record-check:3] ExecIf(“SIP/22001-000010ac”, “0?Goto(routewins)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [out@sub-record-check:4] ExecIf(“SIP/22001-000010ac”, “0?Goto(routewins)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [out@sub-record-check:5] Gosub(“SIP/22001-000010ac”, “recordcheck,1(force,out,914015555432)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [recordcheck@sub-record-check:1] NoOp(“SIP/22001-000010ac”, “Starting recording check against force”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [recordcheck@sub-record-check:2] Goto(“SIP/22001-000010ac”, “force”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [recordcheck@sub-record-check:5] Set(“SIP/22001-000010ac”, “__REC_POLICY_MODE=FORCE”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [recordcheck@sub-record-check:6] GotoIf(“SIP/22001-000010ac”, “1?startrec”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [recordcheck@sub-record-check:16] NoOp(“SIP/22001-000010ac”, “Starting recording: out, 914015555432”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [recordcheck@sub-record-check:17] Set(“SIP/22001-000010ac”, “AUDIOHOOK_INHERIT(MixMonitor)=yes”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [recordcheck@sub-record-check:18] Set(“SIP/22001-000010ac”, “__CALLFILENAME=out-914015555432-22001-20180320-111841-1521559121.4940”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [recordcheck@sub-record-check:19] MixMonitor(“SIP/22001-000010ac”, “2018/03/20/out-914015555432-22001-20180320-111841-1521559121.4940.wav,abi(LOCAL_MIXMON_ID),”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [recordcheck@sub-record-check:20] Set(“SIP/22001-000010ac”, “__MIXMON_ID=0x7f102405b410”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [recordcheck@sub-record-check:21] Set(“SIP/22001-000010ac”, “__RECORD_ID=SIP/22001-000010ac”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [recordcheck@sub-record-check:22] Set(“SIP/22001-000010ac”, “__REC_STATUS=RECORDING”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [recordcheck@sub-record-check:23] Set(“SIP/22001-000010ac”, “CDR(recordingfile)=out-914015555432-22001-20180320-111841-1521559121.4940.wav”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [recordcheck@sub-record-check:24] Return(“SIP/22001-000010ac”, “”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [out@sub-record-check:6] Return(“SIP/22001-000010ac”, “”) in new stack
[2018-03-20 11:18:41] VERBOSE[31927][C-00000bba] app_mixmonitor.c: Begin MixMonitor Recording SIP/22001-000010ac
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [914015555432@from-internal:3] ExecIf(“SIP/22001-000010ac”, “0 ?Set(CDR(accountcode)=)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [914015555432@from-internal:4] Set(“SIP/22001-000010ac”, “MOHCLASS=default”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [914015555432@from-internal:5] Set(“SIP/22001-000010ac”, “_NODEST=”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [914015555432@from-internal:6] Macro(“SIP/22001-000010ac”, “dialout-trunk,2,14015555432,off”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:1] Set(“SIP/22001-000010ac”, “DIAL_TRUNK=2”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:2] GosubIf(“SIP/22001-000010ac”, “0?sub-pincheck,s,1()”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:3] ExecIf(“SIP/22001-000010ac”, “0?Set(CALLERID(num)=22001)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:4] GotoIf(“SIP/22001-000010ac”, “0?disabletrunk,1”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:5] Set(“SIP/22001-000010ac”, “DIAL_NUMBER=14015555432”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:6] Set(“SIP/22001-000010ac”, “DIAL_TRUNK_OPTIONS=Ttr”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:7] Set(“SIP/22001-000010ac”, “OUTBOUND_GROUP=OUT_2”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:8] Set(“SIP/22001-000010ac”, “DIAL_TRUNK_OPTIONS=Tt”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:9] GotoIf(“SIP/22001-000010ac”, “1?nomax”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:11] GotoIf(“SIP/22001-000010ac”, “0?skipoutcid”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:12] Macro(“SIP/22001-000010ac”, “outbound-callerid,2”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:1] NoOp(“SIP/22001-000010ac”, “22001”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:2] NoOp(“SIP/22001-000010ac”, “”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:3] NoOp(“SIP/22001-000010ac”, “off”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:4] ExecIf(“SIP/22001-000010ac”, “0?Set(CALLERPRES(name-pres)=)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:5] ExecIf(“SIP/22001-000010ac”, “0?Set(CALLERPRES(num-pres)=)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:6] ExecIf(“SIP/22001-000010ac”, “0?Set(REALCALLERIDNUM=22001)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:7] GotoIf(“SIP/22001-000010ac”, “1?normcid”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:11] Set(“SIP/22001-000010ac”, “USEROUTCID=5084586807”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:12] Set(“SIP/22001-000010ac”, “EMERGENCYCID=”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:13] Set(“SIP/22001-000010ac”, “TRUNKOUTCID=”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:14] GotoIf(“SIP/22001-000010ac”, “1?trunkcid”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:19] ExecIf(“SIP/22001-000010ac”, “0?Set(CALLERID(all)=)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:20] ExecIf(“SIP/22001-000010ac”, “1?Set(CALLERID(all)=5084586807)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:21] ExecIf(“SIP/22001-000010ac”, “0?Set(CALLERID(all)=)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:22] ExecIf(“SIP/22001-000010ac”, “0?Set(CALLERPRES(name-pres)=prohib_passed_screen)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:23] ExecIf(“SIP/22001-000010ac”, “0?Set(CALLERPRES(num-pres)=prohib_passed_screen)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:24] Set(“SIP/22001-000010ac”, “CDR(outbound_cnum)=5084586807”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:25] Set(“SIP/22001-000010ac”, “CDR(outbound_cnam)=”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:13] GosubIf(“SIP/22001-000010ac”, “1?sub-flp-2,s,1()”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-flp-2:1] ExecIf(“SIP/22001-000010ac”, “0?Set(TARGET_FLP_2=175714015555432)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-flp-2:2] GotoIf(“SIP/22001-000010ac”, “0?match”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-flp-2:3] ExecIf(“SIP/22001-000010ac”, “0?Set(TARGET_FLP_2=114015555432)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-flp-2:4] GotoIf(“SIP/22001-000010ac”, “0?match”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-flp-2:5] ExecIf(“SIP/22001-000010ac”, “0?Set(TARGET_FLP_2=15555432)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-flp-2:6] GotoIf(“SIP/22001-000010ac”, “0?match”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-flp-2:7] Return(“SIP/22001-000010ac”, “”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:14] Set(“SIP/22001-000010ac”, “OUTNUM=+14015555432”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:15] Set(“SIP/22001-000010ac”, “custom=SIP/BWPrimary”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:16] ExecIf(“SIP/22001-000010ac”, “0?Set(DIAL_TRUNK_OPTIONS=M(setmusic^default)Tt)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:17] ExecIf(“SIP/22001-000010ac”, “0?Set(DIAL_TRUNK_OPTIONS=TtM(confirm))”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:18] Macro(“SIP/22001-000010ac”, “dialout-trunk-predial-hook,”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk-predial-hook:1] MacroExit(“SIP/22001-000010ac”, “”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:19] GotoIf(“SIP/22001-000010ac”, “0?skipcrm”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:20] Set(“SIP/22001-000010ac”, “__CRM_DIRECTION=OUTBOUND”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:21] Set(“SIP/22001-000010ac”, “__CRM_DESTINATION=+14015555432”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:22] Set(“SIP/22001-000010ac”, “__CRM_SOURCE=22001”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:23] AGI(“SIP/22001-000010ac”, “sangomacrm.agi”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] res_agi.c: <SIP/22001-000010ac>AGI Script sangomacrm.agi completed, returning 0
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:24] Set(“SIP/22001-000010ac”, “CHANNEL(hangup_handler_push)=crm-hangup,s,1”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:25] NoOp(“SIP/22001-000010ac”, “CRM Finished”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:26] GotoIf(“SIP/22001-000010ac”, “0?bypass,1”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:27] ExecIf(“SIP/22001-000010ac”, “1?Set(CONNECTEDLINE(num,i)=14015555432)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:28] ExecIf(“SIP/22001-000010ac”, “1?Set(CONNECTEDLINE(name,i)=CID:5084586807)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:29] ExecIf(“SIP/22001-000010ac”, “0?Set(CONNECTEDLINE(name,i)=CID:(Hidden)5084586807)”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:30] GotoIf(“SIP/22001-000010ac”, “0?customtrunk”) in new stack
[2018-03-20 11:18:41] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:31] Dial(“SIP/22001-000010ac”, “SIP/BWPrimary/+14015555432,300,Ttb(func-apply-sipheaders^s^1)”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:32] NoOp(“SIP/22001-000010ac”, “Dial failed for some reason with DIALSTATUS = CONGESTION and HANGUPCAUSE = 38”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:33] GotoIf(“SIP/22001-000010ac”, “0?continue,1:s-CONGESTION,1”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s-CONGESTION@macro-dialout-trunk:1] Set(“SIP/22001-000010ac”, “RC=38”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s-CONGESTION@macro-dialout-trunk:2] Goto(“SIP/22001-000010ac”, “38,1”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [38@macro-dialout-trunk:1] Goto(“SIP/22001-000010ac”, “continue,1”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [continue@macro-dialout-trunk:1] NoOp(“SIP/22001-000010ac”, “TRUNK Dial failed due to CONGESTION HANGUPCAUSE: 38 - failing through to other trunks”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [continue@macro-dialout-trunk:2] ExecIf(“SIP/22001-000010ac”, “1?Set(CALLERID(number)=22001)”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [914015555432@from-internal:7] Macro(“SIP/22001-000010ac”, “dialout-trunk,3,14015555432,off”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:1] Set(“SIP/22001-000010ac”, “DIAL_TRUNK=3”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:2] GosubIf(“SIP/22001-000010ac”, “0?sub-pincheck,s,1()”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:3] ExecIf(“SIP/22001-000010ac”, “0?Set(CALLERID(num)=22001)”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:4] GotoIf(“SIP/22001-000010ac”, “0?disabletrunk,1”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:5] Set(“SIP/22001-000010ac”, “DIAL_NUMBER=14015555432”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:6] Set(“SIP/22001-000010ac”, “DIAL_TRUNK_OPTIONS=Ttr”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:7] Set(“SIP/22001-000010ac”, “OUTBOUND_GROUP=OUT_3”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:8] Set(“SIP/22001-000010ac”, “DIAL_TRUNK_OPTIONS=Tt”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:9] GotoIf(“SIP/22001-000010ac”, “1?nomax”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:11] GotoIf(“SIP/22001-000010ac”, “0?skipoutcid”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:12] Macro(“SIP/22001-000010ac”, “outbound-callerid,3”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:1] NoOp(“SIP/22001-000010ac”, “22001”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:2] NoOp(“SIP/22001-000010ac”, “”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:3] NoOp(“SIP/22001-000010ac”, “off”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:4] ExecIf(“SIP/22001-000010ac”, “0?Set(CALLERPRES(name-pres)=)”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:5] ExecIf(“SIP/22001-000010ac”, “0?Set(CALLERPRES(num-pres)=)”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:6] ExecIf(“SIP/22001-000010ac”, “0?Set(REALCALLERIDNUM=22001)”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:7] GotoIf(“SIP/22001-000010ac”, “1?normcid”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:11] Set(“SIP/22001-000010ac”, “USEROUTCID=5084586807”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:12] Set(“SIP/22001-000010ac”, “EMERGENCYCID=”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:13] Set(“SIP/22001-000010ac”, “TRUNKOUTCID=”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:14] GotoIf(“SIP/22001-000010ac”, “1?trunkcid”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:19] ExecIf(“SIP/22001-000010ac”, “0?Set(CALLERID(all)=)”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:20] ExecIf(“SIP/22001-000010ac”, “1?Set(CALLERID(all)=5084586807)”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:21] ExecIf(“SIP/22001-000010ac”, “0?Set(CALLERID(all)=)”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:22] ExecIf(“SIP/22001-000010ac”, “0?Set(CALLERPRES(name-pres)=prohib_passed_screen)”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:23] ExecIf(“SIP/22001-000010ac”, “0?Set(CALLERPRES(num-pres)=prohib_passed_screen)”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:24] Set(“SIP/22001-000010ac”, “CDR(outbound_cnum)=5084586807”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-outbound-callerid:25] Set(“SIP/22001-000010ac”, “CDR(outbound_cnam)=”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:13] GosubIf(“SIP/22001-000010ac”, “1?sub-flp-3,s,1()”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-flp-3:1] ExecIf(“SIP/22001-000010ac”, “0?Set(TARGET_FLP_3=175714015555432)”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-flp-3:2] GotoIf(“SIP/22001-000010ac”, “0?match”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-flp-3:3] ExecIf(“SIP/22001-000010ac”, “0?Set(TARGET_FLP_3=114015555432)”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-flp-3:4] GotoIf(“SIP/22001-000010ac”, “0?match”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-flp-3:5] ExecIf(“SIP/22001-000010ac”, “0?Set(TARGET_FLP_3=15555432)”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-flp-3:6] GotoIf(“SIP/22001-000010ac”, “0?match”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@sub-flp-3:7] Return(“SIP/22001-000010ac”, “”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:14] Set(“SIP/22001-000010ac”, “OUTNUM=+14015555432”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:15] Set(“SIP/22001-000010ac”, “custom=SIP/BWSecondary”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:16] ExecIf(“SIP/22001-000010ac”, “0?Set(DIAL_TRUNK_OPTIONS=M(setmusic^default)Tt)”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:17] ExecIf(“SIP/22001-000010ac”, “0?Set(DIAL_TRUNK_OPTIONS=TtM(confirm))”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:18] Macro(“SIP/22001-000010ac”, “dialout-trunk-predial-hook,”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk-predial-hook:1] MacroExit(“SIP/22001-000010ac”, “”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:19] GotoIf(“SIP/22001-000010ac”, “1?skipcrm”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:25] NoOp(“SIP/22001-000010ac”, “CRM Finished”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:26] GotoIf(“SIP/22001-000010ac”, “0?bypass,1”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:27] ExecIf(“SIP/22001-000010ac”, “1?Set(CONNECTEDLINE(num,i)=14015555432)”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:28] ExecIf(“SIP/22001-000010ac”, “1?Set(CONNECTEDLINE(name,i)=CID:5084586807)”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:29] ExecIf(“SIP/22001-000010ac”, “0?Set(CONNECTEDLINE(name,i)=CID:(Hidden)5084586807)”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:30] GotoIf(“SIP/22001-000010ac”, “0?customtrunk”) in new stack
[2018-03-20 11:18:43] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-dialout-trunk:31] Dial(“SIP/22001-000010ac”, “SIP/BWSecondary/+14015555432,300,Ttb(func-apply-sipheaders^s^1)”) in new stack
[2018-03-20 11:18:45] VERBOSE[31926][C-00000bba] app_dial.c: Now forwarding SIP/22001-000010ac to ‘Local/+14015555432@from-pstn-e164-us’ (thanks to SIP/BWSecondary-000010ae)
[2018-03-20 11:18:45] VERBOSE[31926][C-00000bba] app_dial.c: Local/+14015555432@from-pstn-e164-us-000000ae;1 answered SIP/22001-000010ac
[2018-03-20 11:18:45] VERBOSE[31926][C-00000bba] bridge_channel.c: Channel SIP/22001-000010ac joined ‘simple_bridge’ basic-bridge <173bf17e-95ad-4ced-af70-84d99df3ff41>
[2018-03-20 11:18:49] VERBOSE[31984][C-00000bba] bridge_channel.c: Channel SIP/22001-000010ac left ‘simple_bridge’ basic-bridge <173bf17e-95ad-4ced-af70-84d99df3ff41>
[2018-03-20 11:18:49] VERBOSE[31984][C-00000bba] bridge_channel.c: Channel SIP/22001-000010ac swapped with Local/+14015555432@from-pstn-e164-us-000000ae;2 into ‘simple_bridge’ basic-bridge <9e6b816b-37b7-4ac4-a653-3300d5717494>
[2018-03-20 11:18:52] VERBOSE[31926][C-00000bba] bridge_channel.c: Channel SIP/22001-000010ac left ‘simple_bridge’ basic-bridge <9e6b816b-37b7-4ac4-a653-3300d5717494>
[2018-03-20 11:18:52] VERBOSE[31926][C-00000bba] app_macro.c: Spawn extension (macro-dialout-trunk, s, 31) exited non-zero on ‘SIP/22001-000010ac’ in macro ‘dialout-trunk’
[2018-03-20 11:18:52] VERBOSE[31926][C-00000bba] pbx.c: Spawn extension (from-internal, 914015555432, 7) exited non-zero on ‘SIP/22001-000010ac’
[2018-03-20 11:18:52] VERBOSE[31926][C-00000bba] pbx.c: Executing [h@from-internal:1] Macro(“SIP/22001-000010ac”, “hangupcall”) in new stack
[2018-03-20 11:18:52] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-hangupcall:1] GotoIf(“SIP/22001-000010ac”, “1?theend”) in new stack
[2018-03-20 11:18:52] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-hangupcall:3] ExecIf(“SIP/22001-000010ac”, “0?Set(CDR(recordingfile)=)”) in new stack
[2018-03-20 11:18:52] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-hangupcall:4] NoOp(“SIP/22001-000010ac”, “Local/2017@from-queue-000000af;1 monior file= /var/spool/asterisk/monitor/2018/03/20/out-914015555432-22001-20180320-111841-1521559121.4940.wav”) in new stack
[2018-03-20 11:18:52] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-hangupcall:5] AGI(“SIP/22001-000010ac”, “attendedtransfer-rec-restart.php,Local/2017@from-queue-000000af;1,/var/spool/asterisk/monitor/2018/03/20/out-914015555432-22001-20180320-111841-1521559121.4940.wav”) in new stack
[2018-03-20 11:18:52] VERBOSE[31926][C-00000bba] res_agi.c: <SIP/22001-000010ac>AGI Script attendedtransfer-rec-restart.php completed, returning 0
[2018-03-20 11:18:52] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@macro-hangupcall:6] Hangup(“SIP/22001-000010ac”, “”) in new stack
[2018-03-20 11:18:52] VERBOSE[31926][C-00000bba] app_macro.c: Spawn extension (macro-hangupcall, s, 6) exited non-zero on ‘SIP/22001-000010ac’ in macro ‘hangupcall’
[2018-03-20 11:18:52] VERBOSE[31926][C-00000bba] pbx.c: Spawn extension (from-internal, h, 1) exited non-zero on ‘SIP/22001-000010ac’
[2018-03-20 11:18:52] VERBOSE[31926][C-00000bba] app_stack.c: SIP/22001-000010ac Internal Gosub(crm-hangup,s,1) start
[2018-03-20 11:18:52] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@crm-hangup:1] NoOp(“SIP/22001-000010ac”, “Sending Hangup to CRM”) in new stack
[2018-03-20 11:18:52] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@crm-hangup:2] NoOp(“SIP/22001-000010ac”, “HANGUP CAUSE: 16”) in new stack
[2018-03-20 11:18:52] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@crm-hangup:3] ExecIf(“SIP/22001-000010ac”, “0?Set(__CRM_VOICEMAIL=)”) in new stack
[2018-03-20 11:18:52] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@crm-hangup:4] NoOp(“SIP/22001-000010ac”, “MASTER CHANNEL: 1521559121.4940 = 1521559121.4940”) in new stack
[2018-03-20 11:18:52] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@crm-hangup:5] GotoIf(“SIP/22001-000010ac”, “0?return”) in new stack
[2018-03-20 11:18:52] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@crm-hangup:6] Set(“SIP/22001-000010ac”, “__CRM_HANGUP=1”) in new stack
[2018-03-20 11:18:52] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@crm-hangup:7] AGI(“SIP/22001-000010ac”, “sangomacrm.agi”) in new stack
[2018-03-20 11:18:53] VERBOSE[31926][C-00000bba] res_agi.c: <SIP/22001-000010ac>AGI Script sangomacrm.agi completed, returning 0
[2018-03-20 11:18:53] VERBOSE[31926][C-00000bba] pbx.c: Executing [s@crm-hangup:8] Return(“SIP/22001-000010ac”, “”) in new stack
[2018-03-20 11:18:53] VERBOSE[31926][C-00000bba] app_stack.c: Spawn extension (from-internal, h, 1) exited non-zero on ‘SIP/22001-000010ac’
[2018-03-20 11:18:53] VERBOSE[31926][C-00000bba] app_stack.c: SIP/22001-000010ac Internal Gosub(crm-hangup,s,1) complete GOSUB_RETVAL=
[2018-03-20 11:18:53] VERBOSE[31927][C-00000bba] app_mixmonitor.c: End MixMonitor Recording SIP/22001-000010ac

Our trunk provider has said it is an issue on their end. Thank you.

This topic was automatically closed 365 days after the last reply. New replies are no longer allowed.