FreePBX IVR redirect on extarnal number fail

From wontsayit, 7 Months ago, written in Plain Text, viewed 3 times.
URL https://pastebin.freepbx.org/view/5585a859 Embed
Download Paste or View Raw
  1. -- Called 74951111111 from 79162222222 (mobile phone):
  2. [2020-09-23 14:16:19] VERBOSE[2444][C-00000317] netsock2.c: Using SIP RTP TOS bits 184
  3. [2020-09-23 14:16:19] VERBOSE[2444][C-00000317] netsock2.c: Using SIP RTP CoS mark 5
  4. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:1] Set("SIP/74951111111-00000735", "__DIRECTION=INBOUND") in new stack
  5. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:2] Set("SIP/74951111111-00000735", "CHANNEL(language)=ru") in new stack
  6. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:3] Gosub("SIP/74951111111-00000735", "sub-record-check,s,1(in,74951111111,dontcare)") in new stack
  7. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:1] GotoIf("SIP/74951111111-00000735", "0?initialized") in new stack
  8. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:2] Set("SIP/74951111111-00000735", "__REC_STATUS=INITIALIZED") in new stack
  9. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:3] Set("SIP/74951111111-00000735", "NOW=1600859779") in new stack
  10. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:4] Set("SIP/74951111111-00000735", "__DAY=23") in new stack
  11. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:5] Set("SIP/74951111111-00000735", "__MONTH=09") in new stack
  12. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:6] Set("SIP/74951111111-00000735", "__YEAR=2020") in new stack
  13. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:7] Set("SIP/74951111111-00000735", "__TIMESTR=20200923-141619") in new stack
  14. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:8] Set("SIP/74951111111-00000735", "__FROMEXTEN=unknown") in new stack
  15. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:9] Set("SIP/74951111111-00000735", "__MON_FMT=wav") in new stack
  16. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:10] NoOp("SIP/74951111111-00000735", "Recordings initialized") in new stack
  17. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:11] ExecIf("SIP/74951111111-00000735", "0?Set(ARG3=dontcare)") in new stack
  18. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:12] Set("SIP/74951111111-00000735", "REC_POLICY_MODE_SAVE=") in new stack
  19. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:13] ExecIf("SIP/74951111111-00000735", "0?Set(REC_STATUS=NO)") in new stack
  20. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:14] GotoIf("SIP/74951111111-00000735", "2?checkaction") in new stack
  21. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx_builtins.c: Goto (sub-record-check,s,17)
  22. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:17] GotoIf("SIP/74951111111-00000735", "1?sub-record-check,in,1") in new stack
  23. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx_builtins.c: Goto (sub-record-check,in,1)
  24. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [in@sub-record-check:1] NoOp("SIP/74951111111-00000735", "Inbound Recording Check to 74951111111") in new stack
  25. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [in@sub-record-check:2] Set("SIP/74951111111-00000735", "FROMEXTEN=unknown") in new stack
  26. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [in@sub-record-check:3] ExecIf("SIP/74951111111-00000735", "11?Set(FROMEXTEN=79162222222)") in new stack
  27. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [in@sub-record-check:4] Gosub("SIP/74951111111-00000735", "recordcheck,1(dontcare,in,74951111111)") in new stack
  28. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [recordcheck@sub-record-check:1] NoOp("SIP/74951111111-00000735", "Starting recording check against dontcare") in new stack
  29. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [recordcheck@sub-record-check:2] Goto("SIP/74951111111-00000735", "dontcare") in new stack
  30. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx_builtins.c: Goto (sub-record-check,recordcheck,3)
  31. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [recordcheck@sub-record-check:3] Return("SIP/74951111111-00000735", "") in new stack
  32. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [in@sub-record-check:5] Return("SIP/74951111111-00000735", "") in new stack
  33. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:4] Set("SIP/74951111111-00000735", "CHANNEL(tonezone)=ru") in new stack
  34. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:5] Set("SIP/74951111111-00000735", "__FROM_DID=74951111111") in new stack
  35. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:6] Set("SIP/74951111111-00000735", "returnhere=1") in new stack
  36. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:7] Gosub("SIP/74951111111-00000735", "app-blacklist-check,s,1()") in new stack
  37. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@app-blacklist-check:1] GotoIf("SIP/74951111111-00000735", "0?blacklisted") in new stack
  38. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@app-blacklist-check:2] Set("SIP/74951111111-00000735", "CALLED_BLACKLIST=1") in new stack
  39. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@app-blacklist-check:3] Return("SIP/74951111111-00000735", "") in new stack
  40. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:8] Set("SIP/74951111111-00000735", "CDR(did)=74951111111") in new stack
  41. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:9] GotoIf("SIP/74951111111-00000735", "0?") in new stack
  42. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:10] ExecIf("SIP/74951111111-00000735", "1 ?Set(CALLERID(name)=79162222222)") in new stack
  43. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:11] Set("SIP/74951111111-00000735", "__MOHCLASS=") in new stack
  44. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:12] Set("SIP/74951111111-00000735", "__REVERSAL_REJECT=FALSE") in new stack
  45. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:13] GotoIf("SIP/74951111111-00000735", "1?post-reverse-charge") in new stack
  46. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx_builtins.c: Goto (from-trunk,74951111111,15)
  47. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:15] NoOp("SIP/74951111111-00000735", "") in new stack
  48. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:16] Set("SIP/74951111111-00000735", "__CALLINGNAMEPRES_SV=allowed_not_screened") in new stack
  49. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:17] Set("SIP/74951111111-00000735", "__CALLINGNUMPRES_SV=allowed_not_screened") in new stack
  50. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:18] Set("SIP/74951111111-00000735", "CALLERID(name-pres)=allowed_not_screened") in new stack
  51. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:19] Set("SIP/74951111111-00000735", "CALLERID(num-pres)=allowed_not_screened") in new stack
  52. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:20] Gosub("SIP/74951111111-00000735", "cidlookup,cidlookup_1,1()") in new stack
  53. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [cidlookup_1@cidlookup:1] ExecIf("SIP/74951111111-00000735", "0?Set(CALLERID(name)=)") in new stack
  54. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [cidlookup_1@cidlookup:2] Return("SIP/74951111111-00000735", "") in new stack
  55. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:21] NoOp("SIP/74951111111-00000735", "CallerID Entry Point") in new stack
  56. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:22] Set("SIP/74951111111-00000735", "__CRM_DIRECTION=INBOUND") in new stack
  57. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:23] Set("SIP/74951111111-00000735", "__CRM_SOURCE=79162222222") in new stack
  58. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:24] Set("SIP/74951111111-00000735", "__CRM_LINKEDID=1600859779.1895") in new stack
  59. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:25] ExecIf("SIP/74951111111-00000735", "1?Set(CHANNEL(hangup_handler_push)=crm-hangup,s,1)") in new stack
  60. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [74951111111@from-trunk:26] Goto("SIP/74951111111-00000735", "ext-callrecording,1,1") in new stack
  61. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx_builtins.c: Goto (ext-callrecording,1,1)
  62. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [1@ext-callrecording:1] Gosub("SIP/74951111111-00000735", "sub-record-check,s,1(generic,74951111111,always)") in new stack
  63. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:1] GotoIf("SIP/74951111111-00000735", "11?initialized") in new stack
  64. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx_builtins.c: Goto (sub-record-check,s,10)
  65. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:10] NoOp("SIP/74951111111-00000735", "Recordings initialized") in new stack
  66. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:11] ExecIf("SIP/74951111111-00000735", "0?Set(ARG3=dontcare)") in new stack
  67. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:12] Set("SIP/74951111111-00000735", "REC_POLICY_MODE_SAVE=") in new stack
  68. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:13] ExecIf("SIP/74951111111-00000735", "0?Set(REC_STATUS=NO)") in new stack
  69. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:14] GotoIf("SIP/74951111111-00000735", "7?checkaction") in new stack
  70. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx_builtins.c: Goto (sub-record-check,s,17)
  71. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:17] GotoIf("SIP/74951111111-00000735", "0?sub-record-check,generic,1") in new stack
  72. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:18] NoOp("SIP/74951111111-00000735", "Generic generic Recording Check - 79162222222 74951111111") in new stack
  73. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:19] Gosub("SIP/74951111111-00000735", "recordcheck,1(always,generic,74951111111)") in new stack
  74. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [recordcheck@sub-record-check:1] NoOp("SIP/74951111111-00000735", "Starting recording check against always") in new stack
  75. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [recordcheck@sub-record-check:2] Goto("SIP/74951111111-00000735", "always") in new stack
  76. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx_builtins.c: Goto (sub-record-check,recordcheck,4)
  77. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [recordcheck@sub-record-check:4] NoOp("SIP/74951111111-00000735", "Detected legacy "always" entry. Mapping to "force"") in new stack
  78. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [recordcheck@sub-record-check:5] Set("SIP/74951111111-00000735", "__REC_POLICY_MODE=FORCE") in new stack
  79. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [recordcheck@sub-record-check:6] GotoIf("SIP/74951111111-00000735", "1?startrec") in new stack
  80. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx_builtins.c: Goto (sub-record-check,recordcheck,16)
  81. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [recordcheck@sub-record-check:16] NoOp("SIP/74951111111-00000735", "Starting recording: generic, 74951111111") in new stack
  82. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [recordcheck@sub-record-check:17] Set("SIP/74951111111-00000735", "__CALLFILENAME=generic-74951111111-79162222222-20200923-141619-1600859779.1895") in new stack
  83. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [recordcheck@sub-record-check:18] MixMonitor("SIP/74951111111-00000735", "2020/09/23/generic-74951111111-79162222222-20200923-141619-1600859779.1895.wav,abi(LOCAL_MIXMON_ID),") in new stack
  84. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [recordcheck@sub-record-check:19] Set("SIP/74951111111-00000735", "__MIXMON_ID=0x7fbb0410cea0") in new stack
  85. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [recordcheck@sub-record-check:20] Set("SIP/74951111111-00000735", "__RECORD_ID=SIP/74951111111-00000735") in new stack
  86. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [recordcheck@sub-record-check:21] Set("SIP/74951111111-00000735", "__REC_STATUS=RECORDING") in new stack
  87. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [recordcheck@sub-record-check:22] Set("SIP/74951111111-00000735", "CDR(recordingfile)=generic-74951111111-79162222222-20200923-141619-1600859779.1895.wav") in new stack
  88. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [recordcheck@sub-record-check:23] Return("SIP/74951111111-00000735", "") in new stack
  89. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@sub-record-check:20] Return("SIP/74951111111-00000735", "") in new stack
  90. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [1@ext-callrecording:2] Goto("SIP/74951111111-00000735", "ivr-1,s,1") in new stack
  91. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx_builtins.c: Goto (ivr-1,s,1)
  92. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@ivr-1:1] Set("SIP/74951111111-00000735", "_IVR_CONTEXT_ivr-1=") in new stack
  93. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@ivr-1:2] Set("SIP/74951111111-00000735", "_IVR_CONTEXT=ivr-1") in new stack
  94. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@ivr-1:3] Set("SIP/74951111111-00000735", "__IVR_RETVM=") in new stack
  95. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@ivr-1:4] GotoIf("SIP/74951111111-00000735", "0?skip") in new stack
  96. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@ivr-1:5] Answer("SIP/74951111111-00000735", "") in new stack
  97. [2020-09-23 14:16:19] VERBOSE[74750][C-00000317] app_mixmonitor.c: Begin MixMonitor Recording SIP/74951111111-00000735
  98. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@ivr-1:6] Set("SIP/74951111111-00000735", "IVR_MSG=custom/replacement-1573115868606") in new stack
  99. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@ivr-1:7] Set("SIP/74951111111-00000735", "TIMEOUT(digit)=3") in new stack
  100. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] func_timeout.c: Digit timeout set to 3.000
  101. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] pbx.c: Executing [s@ivr-1:8] ExecIf("SIP/74951111111-00000735", "1?Background(custom/replacement-1573115868606)") in new stack
  102. [2020-09-23 14:16:19] VERBOSE[74749][C-00000317] file.c: <SIP/74951111111-00000735> Playing 'custom/replacement-1573115868606.slin' (language 'ru')
  103.  
  104. -- Pressed 2 on my mobile's dial-pad:
  105. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [2@ivr-1:1] Set("SIP/74951111111-00000735", "__ivrreturn=0") in new stack
  106. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [2@ivr-1:2] Goto("SIP/74951111111-00000735", "ext-miscdests,2,1") in new stack
  107. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx_builtins.c: Goto (ext-miscdests,2,1)
  108. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [2@ext-miscdests:1] NoOp("SIP/74951111111-00000735", "MiscDest: IVR - 2 - Eugeny") in new stack
  109. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [2@ext-miscdests:2] Goto("SIP/74951111111-00000735", "from-internal,79645300536,1") in new stack
  110. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx_builtins.c: Goto (from-internal,79645300536,1)
  111. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [79645300536@from-internal:1] Macro("SIP/74951111111-00000735", "user-callerid,LIMIT,EXTERNAL,") in new stack
  112. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [s@macro-user-callerid:1] Set("SIP/74951111111-00000735", "TOUCH_MONITOR=1600859779.1895") in new stack
  113. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [s@macro-user-callerid:2] Set("SIP/74951111111-00000735", "AMPUSER=79162222222") in new stack
  114. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [s@macro-user-callerid:3] GotoIf("SIP/74951111111-00000735", "0?report") in new stack
  115. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [s@macro-user-callerid:4] ExecIf("SIP/74951111111-00000735", "1?Set(REALCALLERIDNUM=79162222222)") in new stack
  116. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [s@macro-user-callerid:5] Set("SIP/74951111111-00000735", "AMPUSER=") in new stack
  117. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [s@macro-user-callerid:6] GotoIf("SIP/74951111111-00000735", "0?limit") in new stack
  118. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [s@macro-user-callerid:7] Set("SIP/74951111111-00000735", "AMPUSERCIDNAME=") in new stack
  119. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [s@macro-user-callerid:8] ExecIf("SIP/74951111111-00000735", "0?Set(__CIDMASQUERADING=TRUE)") in new stack
  120. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [s@macro-user-callerid:9] GotoIf("SIP/74951111111-00000735", "1?report") in new stack
  121. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx_builtins.c: Goto (macro-user-callerid,s,17)
  122. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [s@macro-user-callerid:17] NoOp("SIP/74951111111-00000735", "Macro Depth is 1") in new stack
  123. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [s@macro-user-callerid:18] GotoIf("SIP/74951111111-00000735", "1?report2:macroerror") in new stack
  124. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx_builtins.c: Goto (macro-user-callerid,s,19)
  125. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [s@macro-user-callerid:19] GotoIf("SIP/74951111111-00000735", "1?continue") in new stack
  126. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx_builtins.c: Goto (macro-user-callerid,s,38)
  127. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [s@macro-user-callerid:38] Set("SIP/74951111111-00000735", "CALLERID(number)=79162222222") in new stack
  128. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [s@macro-user-callerid:39] Set("SIP/74951111111-00000735", "CALLERID(name)=79162222222") in new stack
  129. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [s@macro-user-callerid:40] GotoIf("SIP/74951111111-00000735", "0?cnum") in new stack
  130. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [s@macro-user-callerid:41] Set("SIP/74951111111-00000735", "CDR(cnam)=79162222222") in new stack
  131. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [s@macro-user-callerid:42] Set("SIP/74951111111-00000735", "CDR(cnum)=79162222222") in new stack
  132. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [s@macro-user-callerid:43] Set("SIP/74951111111-00000735", "CHANNEL(language)=ru") in new stack
  133. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [79645300536@from-internal:2] NoCDR("SIP/74951111111-00000735", "") in new stack
  134. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [79645300536@from-internal:3] Progress("SIP/74951111111-00000735", "") in new stack
  135. [2020-09-23 14:16:30] VERBOSE[74749][C-00000317] pbx.c: Executing [79645300536@from-internal:4] Wait("SIP/74951111111-00000735", "1") in new stack
  136. [2020-09-23 14:16:31] VERBOSE[74749][C-00000317] pbx.c: Executing [79645300536@from-internal:5] Playback("SIP/74951111111-00000735", "silence/1&cannot-complete-as-dialed&check-number-dial-again,noanswer") in new stack
  137. [2020-09-23 14:16:31] VERBOSE[74749][C-00000317] file.c: <SIP/74951111111-00000735> Playing 'silence/1.ulaw' (language 'ru')
  138. [2020-09-23 14:16:32] VERBOSE[74749][C-00000317] file.c: <SIP/74951111111-00000735> Playing 'cannot-complete-as-dialed.ulaw' (language 'ru')
  139. [2020-09-23 14:16:34] VERBOSE[74749][C-00000317] file.c: <SIP/74951111111-00000735> Playing 'check-number-dial-again.ulaw' (language 'ru')
  140. [2020-09-23 14:16:37] VERBOSE[74749][C-00000317] pbx.c: Executing [79645300536@from-internal:6] Wait("SIP/74951111111-00000735", "1") in new stack
  141. [2020-09-23 14:16:38] VERBOSE[74749][C-00000317] pbx.c: Executing [79645300536@from-internal:7] Congestion("SIP/74951111111-00000735", "20") in new stack
  142.  
  143. -- Pressed "Hang Up" on my mobile:
  144. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] pbx.c: Spawn extension (from-internal, 79645300536, 7) exited non-zero on 'SIP/74951111111-00000735'
  145. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] pbx.c: Executing [h@from-internal:1] Macro("SIP/74951111111-00000735", "hangupcall") in new stack
  146. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] pbx.c: Executing [s@macro-hangupcall:1] GotoIf("SIP/74951111111-00000735", "1?theend") in new stack
  147. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] pbx_builtins.c: Goto (macro-hangupcall,s,3)
  148. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] pbx.c: Executing [s@macro-hangupcall:3] ExecIf("SIP/74951111111-00000735", "0?Set(CDR(recordingfile)=)") in new stack
  149. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] pbx.c: Executing [s@macro-hangupcall:4] NoOp("SIP/74951111111-00000735", " montior file= /var/spool/asterisk/monitor/2020/09/23/generic-74951111111-79162222222-20200923-141619-1600859779.1895.wav") in new stack
  150. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] pbx.c: Executing [s@macro-hangupcall:5] GotoIf("SIP/74951111111-00000735", "1?skipagi") in new stack
  151. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] pbx_builtins.c: Goto (macro-hangupcall,s,7)
  152. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] pbx.c: Executing [s@macro-hangupcall:7] Hangup("SIP/74951111111-00000735", "") in new stack
  153. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] app_macro.c: Spawn extension (macro-hangupcall, s, 7) exited non-zero on 'SIP/74951111111-00000735' in macro 'hangupcall'
  154. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] pbx.c: Spawn extension (from-internal, h, 1) exited non-zero on 'SIP/74951111111-00000735'
  155. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] app_stack.c: SIP/74951111111-00000735 Internal Gosub(crm-hangup,s,1) start
  156. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] pbx.c: Executing [s@crm-hangup:1] NoOp("SIP/74951111111-00000735", "Sending Hangup to CRM") in new stack
  157. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] pbx.c: Executing [s@crm-hangup:2] NoOp("SIP/74951111111-00000735", "HANGUP CAUSE: 16") in new stack
  158. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] pbx.c: Executing [s@crm-hangup:3] ExecIf("SIP/74951111111-00000735", "0?Set(__CRM_VOICEMAIL=)") in new stack
  159. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] pbx.c: Executing [s@crm-hangup:4] NoOp("SIP/74951111111-00000735", "MASTER CHANNEL: 1600859779.1895 = 1600859779.1895") in new stack
  160. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] pbx.c: Executing [s@crm-hangup:5] GotoIf("SIP/74951111111-00000735", "0?return") in new stack
  161. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] pbx.c: Executing [s@crm-hangup:6] Set("SIP/74951111111-00000735", "__CRM_HANGUP=1") in new stack
  162. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] pbx.c: Executing [s@crm-hangup:7] AGI("SIP/74951111111-00000735", "sangomacrm.agi") in new stack
  163. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] res_agi.c: Launched AGI Script /var/lib/asterisk/agi-bin/sangomacrm.agi
  164. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] res_agi.c: <SIP/74951111111-00000735>AGI Script sangomacrm.agi completed, returning 0
  165. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] pbx.c: Executing [s@crm-hangup:8] Return("SIP/74951111111-00000735", "") in new stack
  166. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] app_stack.c: Spawn extension (from-internal, h, 1) exited non-zero on 'SIP/74951111111-00000735'
  167. [2020-09-23 14:16:45] VERBOSE[74749][C-00000317] app_stack.c: SIP/74951111111-00000735 Internal Gosub(crm-hangup,s,1) complete GOSUB_RETVAL=
  168. [2020-09-23 14:16:45] VERBOSE[74750][C-00000317] app_mixmonitor.c: MixMonitor close filestream (mixed)
  169. [2020-09-23 14:16:45] VERBOSE[74750][C-00000317] app_mixmonitor.c: End MixMonitor Recording SIP/74951111111-00000735
  170.  
  171.  

Reply to "FreePBX IVR redirect on extarnal number fail"

Here you can reply to the paste above