Strange Behaviours

From CCENTRALE, 1 Week ago, written in Plain Text, viewed 3 times.
URL https://pastebin.freepbx.org/view/6cad4125 Embed
Download Paste or View Raw
  1. [2021-10-12 21:52:15] VERBOSE[2850][C-00000039] res_rtp_asterisk.c: 0x7fabe0060530 -- Strict RTP learning after remote address set to: 10.139.156.1:6092
  2. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk-sip-uco_p1:1] Set("SIP/uco_p1-00000054", "GROUP()=OUT_1") in new stack
  3. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk-sip-uco_p1:2] Goto("SIP/uco_p1-00000054", "from-trunk,645775926,1") in new stack
  4. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx_builtins.c: Goto (from-trunk,645775926,1)
  5. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:1] Set("SIP/uco_p1-00000054", "__DIRECTION=INBOUND") in new stack
  6. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:2] Set("SIP/uco_p1-00000054", "CHANNEL(language)=it") in new stack
  7. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:3] Gosub("SIP/uco_p1-00000054", "sub-record-check,s,1(in,645775926,dontcare)") in new stack
  8. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@sub-record-check:1] GotoIf("SIP/uco_p1-00000054", "0?initialized") in new stack
  9. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@sub-record-check:2] Set("SIP/uco_p1-00000054", "__REC_STATUS=INITIALIZED") in new stack
  10. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@sub-record-check:3] Set("SIP/uco_p1-00000054", "NOW=1634068335") in new stack
  11. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@sub-record-check:4] Set("SIP/uco_p1-00000054", "__DAY=12") in new stack
  12. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@sub-record-check:5] Set("SIP/uco_p1-00000054", "__MONTH=10") in new stack
  13. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@sub-record-check:6] Set("SIP/uco_p1-00000054", "__YEAR=2021") in new stack
  14. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@sub-record-check:7] Set("SIP/uco_p1-00000054", "__TIMESTR=20211012-215215") in new stack
  15. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@sub-record-check:8] Set("SIP/uco_p1-00000054", "__FROMEXTEN=unknown") in new stack
  16. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@sub-record-check:9] Set("SIP/uco_p1-00000054", "__MON_FMT=wav") in new stack
  17. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@sub-record-check:10] NoOp("SIP/uco_p1-00000054", "Recordings initialized") in new stack
  18. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@sub-record-check:11] ExecIf("SIP/uco_p1-00000054", "0?Set(ARG3=dontcare)") in new stack
  19. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@sub-record-check:12] Set("SIP/uco_p1-00000054", "REC_POLICY_MODE_SAVE=") in new stack
  20. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@sub-record-check:13] ExecIf("SIP/uco_p1-00000054", "0?Set(REC_STATUS=NO)") in new stack
  21. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@sub-record-check:14] GotoIf("SIP/uco_p1-00000054", "2?checkaction") in new stack
  22. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx_builtins.c: Goto (sub-record-check,s,17)
  23. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@sub-record-check:17] GotoIf("SIP/uco_p1-00000054", "1?sub-record-check,in,1") in new stack
  24. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx_builtins.c: Goto (sub-record-check,in,1)
  25. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [in@sub-record-check:1] NoOp("SIP/uco_p1-00000054", "Inbound Recording Check to 645775926") in new stack
  26. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [in@sub-record-check:2] Set("SIP/uco_p1-00000054", "FROMEXTEN=unknown") in new stack
  27. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [in@sub-record-check:3] ExecIf("SIP/uco_p1-00000054", "10?Set(FROMEXTEN=3408004705)") in new stack
  28. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [in@sub-record-check:4] Gosub("SIP/uco_p1-00000054", "recordcheck,1(dontcare,in,645775926)") in new stack
  29. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [recordcheck@sub-record-check:1] NoOp("SIP/uco_p1-00000054", "Starting recording check against dontcare") in new stack
  30. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [recordcheck@sub-record-check:2] Goto("SIP/uco_p1-00000054", "dontcare") in new stack
  31. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx_builtins.c: Goto (sub-record-check,recordcheck,3)
  32. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [recordcheck@sub-record-check:3] Return("SIP/uco_p1-00000054", "") in new stack
  33. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [in@sub-record-check:5] Return("SIP/uco_p1-00000054", "") in new stack
  34. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:4] Set("SIP/uco_p1-00000054", "CHANNEL(tonezone)=it") in new stack
  35. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:5] Set("SIP/uco_p1-00000054", "__FROM_DID=645775926") in new stack
  36. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:6] Set("SIP/uco_p1-00000054", "returnhere=1") in new stack
  37. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:7] Gosub("SIP/uco_p1-00000054", "app-blacklist-check,s,1()") in new stack
  38. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@app-blacklist-check:1] GotoIf("SIP/uco_p1-00000054", "0?blacklisted") in new stack
  39. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@app-blacklist-check:2] Set("SIP/uco_p1-00000054", "CALLED_BLACKLIST=1") in new stack
  40. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@app-blacklist-check:3] Return("SIP/uco_p1-00000054", "") in new stack
  41. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:8] Set("SIP/uco_p1-00000054", "CDR(did)=645775926") in new stack
  42. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:9] GotoIf("SIP/uco_p1-00000054", "0?") in new stack
  43. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:10] ExecIf("SIP/uco_p1-00000054", "0 ?Set(CALLERID(name)=3408004705)") in new stack
  44. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:11] Set("SIP/uco_p1-00000054", "__MOHCLASS=") in new stack
  45. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:12] Set("SIP/uco_p1-00000054", "__REVERSAL_REJECT=FALSE") in new stack
  46. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:13] GotoIf("SIP/uco_p1-00000054", "1?post-reverse-charge") in new stack
  47. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx_builtins.c: Goto (from-trunk,645775926,15)
  48. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:15] NoOp("SIP/uco_p1-00000054", "") in new stack
  49. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:16] Set("SIP/uco_p1-00000054", "__CALLINGNAMEPRES_SV=allowed_not_screened") in new stack
  50. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:17] Set("SIP/uco_p1-00000054", "__CALLINGNUMPRES_SV=allowed_not_screened") in new stack
  51. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:18] Set("SIP/uco_p1-00000054", "CALLERID(name-pres)=allowed_not_screened") in new stack
  52. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:19] Set("SIP/uco_p1-00000054", "CALLERID(num-pres)=allowed_not_screened") in new stack
  53. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:20] NoOp("SIP/uco_p1-00000054", "CallerID Entry Point") in new stack
  54. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:21] Set("SIP/uco_p1-00000054", "__CRM_DIRECTION=INBOUND") in new stack
  55. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:22] Set("SIP/uco_p1-00000054", "__CRM_SOURCE=3408004705") in new stack
  56. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:23] Set("SIP/uco_p1-00000054", "__CRM_LINKEDID=1634068335.84") in new stack
  57. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:24] AGI("SIP/uco_p1-00000054", "agi://127.0.0.1/sangomacrm.agi,true") in new stack
  58. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] res_agi.c: <SIP/uco_p1-00000054>AGI Script agi://127.0.0.1/sangomacrm.agi completed, returning 0
  59. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:25] ExecIf("SIP/uco_p1-00000054", "1?Set(CHANNEL(hangup_handler_push)=crm-hangup,s,1)") in new stack
  60. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [645775926@from-trunk:26] Goto("SIP/uco_p1-00000054", "ivr-4,s,1") in new stack
  61. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx_builtins.c: Goto (ivr-4,s,1)
  62. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@ivr-4:1] Set("SIP/uco_p1-00000054", "TIMEOUT_LOOPCOUNT=0") in new stack
  63. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@ivr-4:2] Set("SIP/uco_p1-00000054", "INVALID_LOOPCOUNT=0") in new stack
  64. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@ivr-4:3] Set("SIP/uco_p1-00000054", "_IVR_CONTEXT_ivr-4=") in new stack
  65. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@ivr-4:4] Set("SIP/uco_p1-00000054", "_IVR_CONTEXT=ivr-4") in new stack
  66. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@ivr-4:5] Set("SIP/uco_p1-00000054", "__IVR_RETVM=") in new stack
  67. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@ivr-4:6] GotoIf("SIP/uco_p1-00000054", "0?skip") in new stack
  68. [2021-10-12 21:52:15] VERBOSE[16771][C-00000039] pbx.c: Executing [s@ivr-4:7] Answer("SIP/uco_p1-00000054", "") in new stack
  69. [2021-10-12 21:52:16] VERBOSE[16771][C-00000039] res_rtp_asterisk.c: 0x7fabe0060530 -- Strict RTP switching to RTP target address 10.139.156.1:6092 as source
  70. [2021-10-12 21:52:16] VERBOSE[16771][C-00000039] pbx.c: Executing [s@ivr-4:8] Set("SIP/uco_p1-00000054", "IVR_MSG=custom/UCO_FuoriOrarioHoliday") in new stack
  71. [2021-10-12 21:52:16] VERBOSE[16771][C-00000039] pbx.c: Executing [s@ivr-4:9] Set("SIP/uco_p1-00000054", "TIMEOUT(digit)=3") in new stack
  72. [2021-10-12 21:52:16] VERBOSE[16771][C-00000039] func_timeout.c: Digit timeout set to 3.000
  73. [2021-10-12 21:52:16] VERBOSE[16771][C-00000039] pbx.c: Executing [s@ivr-4:10] ExecIf("SIP/uco_p1-00000054", "1?Background(custom/UCO_FuoriOrarioHoliday)") in new stack
  74. [2021-10-12 21:52:16] VERBOSE[16771][C-00000039] file.c: <SIP/uco_p1-00000054> Playing 'custom/UCO_FuoriOrarioHoliday.ulaw' (language 'it')
  75. [2021-10-12 21:52:20] VERBOSE[16771][C-00000039] res_rtp_asterisk.c: 0x7fabe0060530 -- Strict RTP learning complete - Locking on source address 10.139.156.1:6092
  76. [2021-10-12 21:52:30] VERBOSE[16771][C-00000039] pbx.c: Executing [s@ivr-4:11] WaitExten("SIP/uco_p1-00000054", "10,") in new stack
  77. [2021-10-12 21:52:40] VERBOSE[16771][C-00000039] pbx_builtins.c: Timeout on SIP/uco_p1-00000054, going to 't'
  78. [2021-10-12 21:52:40] VERBOSE[16771][C-00000039] pbx.c: Executing [t@ivr-4:1] Set("SIP/uco_p1-00000054", "TIMEOUT_LOOPCOUNT=1") in new stack
  79. [2021-10-12 21:52:40] VERBOSE[16771][C-00000039] pbx.c: Executing [t@ivr-4:2] GotoIf("SIP/uco_p1-00000054", "0?final") in new stack
  80. [2021-10-12 21:52:40] VERBOSE[16771][C-00000039] pbx.c: Executing [t@ivr-4:3] Set("SIP/uco_p1-00000054", "IVR_MSG=no-valid-responce-pls-try-again") in new stack
  81. [2021-10-12 21:52:40] VERBOSE[16771][C-00000039] pbx.c: Executing [t@ivr-4:4] Goto("SIP/uco_p1-00000054", "s,start") in new stack
  82. [2021-10-12 21:52:40] VERBOSE[16771][C-00000039] pbx_builtins.c: Goto (ivr-4,s,9)
  83. [2021-10-12 21:52:40] VERBOSE[16771][C-00000039] pbx.c: Executing [s@ivr-4:9] Set("SIP/uco_p1-00000054", "TIMEOUT(digit)=3") in new stack
  84. [2021-10-12 21:52:40] VERBOSE[16771][C-00000039] func_timeout.c: Digit timeout set to 3.000
  85. [2021-10-12 21:52:40] VERBOSE[16771][C-00000039] pbx.c: Executing [s@ivr-4:10] ExecIf("SIP/uco_p1-00000054", "1?Background(no-valid-responce-pls-try-again)") in new stack
  86. [2021-10-12 21:52:40] VERBOSE[16771][C-00000039] file.c: <SIP/uco_p1-00000054> Playing 'no-valid-responce-pls-try-again.ulaw' (language 'it')
  87. [2021-10-12 21:52:44] VERBOSE[16771][C-00000039] pbx.c: Executing [s@ivr-4:11] WaitExten("SIP/uco_p1-00000054", "10,") in new stack
  88. [2021-10-12 21:52:48] VERBOSE[16771][C-00000039] pbx.c: Spawn extension (ivr-4, s, 11) exited non-zero on 'SIP/uco_p1-00000054'
  89. [2021-10-12 21:52:48] VERBOSE[16771][C-00000039] pbx.c: Executing [h@ivr-4:1] Hangup("SIP/uco_p1-00000054", "") in new stack
  90. [2021-10-12 21:52:48] VERBOSE[16771][C-00000039] pbx.c: Spawn extension (ivr-4, h, 1) exited non-zero on 'SIP/uco_p1-00000054'
  91. [2021-10-12 21:52:48] VERBOSE[16771][C-00000039] app_stack.c: SIP/uco_p1-00000054 Internal Gosub(crm-hangup,s,1) start
  92. [2021-10-12 21:52:48] VERBOSE[16771][C-00000039] pbx.c: Executing [s@crm-hangup:1] NoOp("SIP/uco_p1-00000054", "Sending Hangup to CRM") in new stack
  93. [2021-10-12 21:52:48] VERBOSE[16771][C-00000039] pbx.c: Executing [s@crm-hangup:2] NoOp("SIP/uco_p1-00000054", "HANGUP CAUSE: 16") in new stack
  94. [2021-10-12 21:52:48] VERBOSE[16771][C-00000039] pbx.c: Executing [s@crm-hangup:3] ExecIf("SIP/uco_p1-00000054", "0?Set(__CRM_VOICEMAIL=)") in new stack
  95. [2021-10-12 21:52:48] VERBOSE[16771][C-00000039] pbx.c: Executing [s@crm-hangup:4] NoOp("SIP/uco_p1-00000054", "MASTER CHANNEL: 1634068335.84 = 1634068335.84") in new stack
  96. [2021-10-12 21:52:48] VERBOSE[16771][C-00000039] pbx.c: Executing [s@crm-hangup:5] GotoIf("SIP/uco_p1-00000054", "0?return") in new stack
  97. [2021-10-12 21:52:48] VERBOSE[16771][C-00000039] pbx.c: Executing [s@crm-hangup:6] Set("SIP/uco_p1-00000054", "__CRM_HANGUP=1") in new stack
  98. [2021-10-12 21:52:48] VERBOSE[16771][C-00000039] pbx.c: Executing [s@crm-hangup:7] AGI("SIP/uco_p1-00000054", "agi://127.0.0.1/sangomacrm.agi") in new stack
  99. [2021-10-12 21:52:48] VERBOSE[16771][C-00000039] res_agi.c: <SIP/uco_p1-00000054>AGI Script agi://127.0.0.1/sangomacrm.agi completed, returning 0
  100. [2021-10-12 21:52:48] VERBOSE[16771][C-00000039] pbx.c: Executing [s@crm-hangup:8] Return("SIP/uco_p1-00000054", "") in new stack
  101. [2021-10-12 21:52:48] VERBOSE[16771][C-00000039] app_stack.c: Spawn extension (ivr-4, h, 1) exited non-zero on 'SIP/uco_p1-00000054'
  102. [2021-10-12 21:52:48] VERBOSE[16771][C-00000039] app_stack.c: SIP/uco_p1-00000054 Internal Gosub(crm-hangup,s,1) complete GOSUB_RETVAL=

Reply to "Strange Behaviours"

Here you can reply to the paste above