[Sep 14 09:36:55] VERBOSE[31498] chan_sip.c: Registered SIP 'lox4wzzz' at 184.181.181.181:57508
[Sep 14 09:36:55] VERBOSE[31498] chan_sip.c: Saved useragent "X-Lite release 5.0.1 stamp 86895" for peer lox4wzzz
[Sep 14 09:37:01] VERBOSE[31498][C-0000018d] netsock2.c: Using SIP RTP CoS mark 5
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [8055551212@default:1] Set("SIP/lox4wzzz-000001f5", "XIVO_BASE_CONTEXT=default") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [8055551212@default:2] Set("SIP/lox4wzzz-000001f5", "XIVO_BASE_EXTEN=8055551212") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [8055551212@default:3] Gosub("SIP/lox4wzzz-000001f5", "outcall,s,1(3,)") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@outcall:1] Set("SIP/lox4wzzz-000001f5", "XIVO_DSTID=3") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@outcall:2] Set("SIP/lox4wzzz-000001f5", "XIVO_PRESUBR_GLOBAL_NAME=OUTCALL") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@outcall:3] Set("SIP/lox4wzzz-000001f5", "XIVO_SRCNUM=799") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@outcall:4] Set("SIP/lox4wzzz-000001f5", "XIVO_DSTNUM=8055551212") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@outcall:5] Set("SIP/lox4wzzz-000001f5", "XIVO_CONTEXT=default") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@outcall:6] Set("SIP/lox4wzzz-000001f5", "WAZO_CHANNEL_DIRECTION=to-wazo") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@outcall:7] Gosub("SIP/lox4wzzz-000001f5", "originate-caller-id,s,1") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@originate-caller-id:1] GotoIf("SIP/lox4wzzz-000001f5", "0?:name") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx_builtins.c: Goto (originate-caller-id,s,3)
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@originate-caller-id:3] GotoIf("SIP/lox4wzzz-000001f5", "0?:fix") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx_builtins.c: Goto (originate-caller-id,s,5)
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@originate-caller-id:5] GotoIf("SIP/lox4wzzz-000001f5", "?:end") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx_builtins.c: Goto (originate-caller-id,s,9)
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@originate-caller-id:9] Return("SIP/lox4wzzz-000001f5", "") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@outcall:8] AGI("SIP/lox4wzzz-000001f5", "agi://127.0.0.1/outgoing_user_set_features") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] res_agi.c: agi://127.0.0.1/outgoing_user_set_features: AGI handler 'outgoing_user_set_features' successfully executed
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] res_agi.c: <SIP/lox4wzzz-000001f5>AGI Script agi://127.0.0.1/outgoing_user_set_features completed, returning 0
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@outcall:9] Gosub("SIP/lox4wzzz-000001f5", "xivo-subroutine,s,1()") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@xivo-subroutine:1] GotoIf("SIP/lox4wzzz-000001f5", "?:nosubroutine") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx_builtins.c: Goto (xivo-subroutine,s,4)
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@xivo-subroutine:4] Return("SIP/lox4wzzz-000001f5", "") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@outcall:10] Gosub("SIP/lox4wzzz-000001f5", "xivo-user_rights_check,s,1") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@xivo-user_rights_check:1] AGI("SIP/lox4wzzz-000001f5", "agi://127.0.0.1/user_set_call_rights") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] res_agi.c: agi://127.0.0.1/user_set_call_rights: AGI handler 'user_set_call_rights' successfully executed
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] res_agi.c: <SIP/lox4wzzz-000001f5>AGI Script agi://127.0.0.1/user_set_call_rights completed, returning 0
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@xivo-user_rights_check:2] GotoIf("SIP/lox4wzzz-000001f5", "ALLOW?:error,1") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@xivo-user_rights_check:3] GotoIf("SIP/lox4wzzz-000001f5", "1?allow,1") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx_builtins.c: Goto (xivo-user_rights_check,allow,1)
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [allow@xivo-user_rights_check:1] NoOp("SIP/lox4wzzz-000001f5", "User allowed to make call") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [allow@xivo-user_rights_check:2] Return("SIP/lox4wzzz-000001f5", "") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@outcall:11] AGI("SIP/lox4wzzz-000001f5", "agi://127.0.0.1/check_schedule") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] res_agi.c: agi://127.0.0.1/check_schedule: AGI handler 'check_schedule' successfully executed
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] res_agi.c: <SIP/lox4wzzz-000001f5>AGI Script agi://127.0.0.1/check_schedule completed, returning 0
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@outcall:12] GotoIf("SIP/lox4wzzz-000001f5", "0?CLOSED,1") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@outcall:13] GotoIf("SIP/lox4wzzz-000001f5", "?:15") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx_builtins.c: Goto (outcall,s,15)
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@outcall:15] GotoIf("SIP/lox4wzzz-000001f5", "SIP/Flowroute?:error,1") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@xivo-subrgbl-outcall:8] Return("SIP/lox4wzzz-000001f5", "") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [s@xivo-global-subroutine:6] Return("SIP/lox4wzzz-000001f5", "") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [dial@outcall:5] CELGenUserEvent("SIP/lox4wzzz-000001f5", "XIVO_OUTCALL") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [dial@outcall:6] Set("SIP/lox4wzzz-000001f5", "CONNECTEDLINE(num,i)=8055551212") in new stack
[Sep 14 09:37:01] VERBOSE[3353][C-0000018d] pbx.c: Executing [dial@outcall:7] Dial("SIP/lox4wzzz-000001f5", "SIP/Flowroute/18055551212,,o(8055551212)") in new stack