identity_compact_check ............................................2023-11-03 22:31:14.892158 83.33% [DEBUG] switch_ivr_originate.c:2301 Parsing global variables
2023-11-03 22:31:14.892158 83.33% [NOTICE] switch_channel.c:1143 New Channel sofia/external/+15553332901 [7eec9506-3ac3-4ffa-8942-bf50cdc9d7f1]
2023-11-03 22:31:14.892158 83.33% [DEBUG] mod_sofia.c:5094 sofia/external/+15553332901 setting variable [rtp_secure_media]=[false]
2023-11-03 22:31:14.892158 83.33% [DEBUG] mod_sofia.c:5110 (sofia/external/+15553332901) State Change CS_NEW -> CS_INIT
2023-11-03 22:31:14.912225 83.33% [DEBUG] switch_core_state_machine.c:581 (sofia/external/+15553332901) Running State Change CS_INIT (Cur 1 Tot 1)
2023-11-03 22:31:14.912225 83.33% [DEBUG] switch_core_state_machine.c:624 (sofia/external/+15553332901) State INIT
2023-11-03 22:31:14.912225 83.33% [DEBUG] mod_sofia.c:97 sofia/external/+15553332901 SOFIA INIT
2023-11-03 22:31:14.912225 83.33% [INFO] sofia_glue.c:1659 sofia/external/+15553332901 sending invite call-id: (null)
2023-11-03 22:31:14.912225 83.33% [DEBUG] sofia_glue.c:1662 sofia/external/+15553332901 sending invite version: 1.10.11-dev git 42162a8 2023-11-03 22:22:07Z 64bit
Local SDP:
v=0
o=SignalWire-STACK 1699030490 1699030491 IN IP4 192.168.176.2
s=SignalWire-STACK
c=IN IP4 192.168.176.2
t=0 0
m=audio 20184 RTP/AVP 0 101 13
a=rtpmap:0 PCMU/8000
a=rtpmap:101 telephone-event/8000
a=fmtp:101 0-15
a=rtpmap:13 CN/8000
a=ptime:20
a=sendrecv

2023-11-03 22:31:14.912225 83.33% [DEBUG] switch_core_state_machine.c:40 sofia/external/+15553332901 Standard INIT
2023-11-03 22:31:14.912225 83.33% [DEBUG] switch_core_state_machine.c:48 (sofia/external/+15553332901) State Change CS_INIT -> CS_ROUTING
2023-11-03 22:31:14.912225 83.33% [DEBUG] switch_core_state_machine.c:624 (sofia/external/+15553332901) State INIT going to sleep
2023-11-03 22:31:14.912225 83.33% [NOTICE] switch_channel.c:1143 New Channel sofia/external/not-used@192.168.176.2:63068 [a177b9c4-ebbb-46c3-8d67-e0141d34c169]
2023-11-03 22:31:14.932146 83.33% [DEBUG] switch_core_state_machine.c:581 (sofia/external/+15553332901) Running State Change CS_ROUTING (Cur 2 Tot 2)
2023-11-03 22:31:14.932146 83.33% [DEBUG] switch_core_state_machine.c:581 (sofia/external/not-used@192.168.176.2:63068) Running State Change CS_NEW (Cur 2 Tot 2)
2023-11-03 22:31:14.932146 83.33% [INFO] sofia.c:10459 sofia/external/not-used@192.168.176.2:63068 receiving invite from 192.168.176.2:63068 version: 1.10.11-dev git 42162a8 2023-11-03 22:22:07Z 64bit call-id: 8a37acfa-f53b-123c-0695-0242c0a8b002
2023-11-03 22:31:14.932146 83.33% [DEBUG] sofia.c:7493 Channel sofia/external/not-used@192.168.176.2:63068 entering state [received][100]
2023-11-03 22:31:14.932146 83.33% [DEBUG] sofia.c:7503 Remote SDP:
v=0
o=SignalWire-STACK 1699030490 1699030491 IN IP4 192.168.176.2
s=SignalWire-STACK
c=IN IP4 192.168.176.2
t=0 0
m=audio 20184 RTP/AVP 0 101 13
a=rtpmap:0 PCMU/8000
a=rtpmap:101 telephone-event/8000
a=fmtp:101 0-15
a=rtpmap:13 CN/8000
a=ptime:20

2023-11-03 22:31:14.932146 83.33% [DEBUG] sofia.c:7906 (sofia/external/not-used@192.168.176.2:63068) State Change CS_NEW -> CS_INIT
2023-11-03 22:31:14.932146 83.33% [DEBUG] switch_core_state_machine.c:600 (sofia/external/not-used@192.168.176.2:63068) State NEW
2023-11-03 22:31:14.932146 83.33% [DEBUG] switch_core_state_machine.c:581 (sofia/external/not-used@192.168.176.2:63068) Running State Change CS_INIT (Cur 2 Tot 2)
2023-11-03 22:31:14.932146 83.33% [DEBUG] switch_core_state_machine.c:624 (sofia/external/not-used@192.168.176.2:63068) State INIT
2023-11-03 22:31:14.932146 83.33% [DEBUG] mod_sofia.c:97 sofia/external/not-used@192.168.176.2:63068 SOFIA INIT
2023-11-03 22:31:14.932146 83.33% [DEBUG] switch_core_state_machine.c:40 sofia/external/not-used@192.168.176.2:63068 Standard INIT
2023-11-03 22:31:14.932146 83.33% [DEBUG] switch_core_state_machine.c:48 (sofia/external/not-used@192.168.176.2:63068) State Change CS_INIT -> CS_ROUTING
2023-11-03 22:31:14.932146 83.33% [DEBUG] switch_core_state_machine.c:624 (sofia/external/not-used@192.168.176.2:63068) State INIT going to sleep
2023-11-03 22:31:14.932146 83.33% [DEBUG] sofia.c:7493 Channel sofia/external/+15553332901 entering state [calling][0]
2023-11-03 22:31:14.932146 83.33% [DEBUG] switch_core_state_machine.c:640 (sofia/external/+15553332901) State ROUTING
2023-11-03 22:31:14.932146 83.33% [DEBUG] mod_sofia.c:158 sofia/external/+15553332901 SOFIA ROUTING
2023-11-03 22:31:14.932146 83.33% [DEBUG] switch_ivr_originate.c:67 (sofia/external/+15553332901) State Change CS_ROUTING -> CS_CONSUME_MEDIA
2023-11-03 22:31:14.932146 83.33% [DEBUG] switch_core_state_machine.c:640 (sofia/external/+15553332901) State ROUTING going to sleep
2023-11-03 22:31:14.932146 83.33% [DEBUG] switch_core_state_machine.c:581 (sofia/external/+15553332901) Running State Change CS_CONSUME_MEDIA (Cur 2 Tot 2)
2023-11-03 22:31:14.952578 80.00% [DEBUG] switch_core_state_machine.c:659 (sofia/external/+15553332901) State CONSUME_MEDIA
2023-11-03 22:31:14.952578 80.00% [DEBUG] switch_core_state_machine.c:659 (sofia/external/+15553332901) State CONSUME_MEDIA going to sleep
2023-11-03 22:31:14.952578 80.00% [DEBUG] switch_core_state_machine.c:581 (sofia/external/not-used@192.168.176.2:63068) Running State Change CS_ROUTING (Cur 2 Tot 2)
2023-11-03 22:31:14.952578 80.00% [DEBUG] switch_channel.c:2400 (sofia/external/not-used@192.168.176.2:63068) Callstate Change DOWN -> RINGING
2023-11-03 22:31:14.952578 80.00% [DEBUG] switch_core_state_machine.c:640 (sofia/external/not-used@192.168.176.2:63068) State ROUTING
2023-11-03 22:31:14.952578 80.00% [DEBUG] mod_sofia.c:158 sofia/external/not-used@192.168.176.2:63068 SOFIA ROUTING
2023-11-03 22:31:14.952578 80.00% [DEBUG] switch_core_state_machine.c:230 sofia/external/not-used@192.168.176.2:63068 Standard ROUTING
2023-11-03 22:31:14.952578 80.00% [INFO] mod_dialplan_xml.c:642 Processing not-used <0000000000>->+15553332901 in context default
Dialplan: sofia/external/not-used@192.168.176.2:63068 parsing [default->two] continue=false
2023-11-03 22:31:14.970357 80.00% [ERR] switch_regex.c:116 COMPILE ERROR: 0 [no error][^\+15553332901$]
Dialplan: sofia/external/not-used@192.168.176.2:63068 Regex (FAIL) [two] destination_number(+15553332901) =~ /^\+15553332901$/ break=on-false
Dialplan: sofia/external/not-used@192.168.176.2:63068 parsing [default->one] continue=false
2023-11-03 22:31:14.970357 80.00% [ERR] switch_regex.c:116 COMPILE ERROR: 0 [no error][^\+15553332900$]
Dialplan: sofia/external/not-used@192.168.176.2:63068 Regex (FAIL) [one] destination_number(+15553332901) =~ /^\+15553332900$/ break=on-false
2023-11-03 22:31:14.970357 80.00% [INFO] switch_core_state_machine.c:306 No Route, Aborting
2023-11-03 22:31:14.970357 80.00% [NOTICE] switch_core_state_machine.c:307 Hangup sofia/external/not-used@192.168.176.2:63068 [CS_ROUTING] [NO_ROUTE_DESTINATION]
2023-11-03 22:31:14.970357 80.00% [DEBUG] switch_core_state_machine.c:640 (sofia/external/not-used@192.168.176.2:63068) State ROUTING going to sleep
2023-11-03 22:31:14.970357 80.00% [DEBUG] switch_core_state_machine.c:581 (sofia/external/not-used@192.168.176.2:63068) Running State Change CS_HANGUP (Cur 2 Tot 2)
2023-11-03 22:31:14.992581 80.00% [DEBUG] switch_core_state_machine.c:844 (sofia/external/not-used@192.168.176.2:63068) Callstate Change RINGING -> HANGUP
2023-11-03 22:31:14.992581 80.00% [DEBUG] switch_core_state_machine.c:846 (sofia/external/not-used@192.168.176.2:63068) State HANGUP
2023-11-03 22:31:14.992581 80.00% [DEBUG] mod_sofia.c:469 Channel sofia/external/not-used@192.168.176.2:63068 hanging up, cause: NO_ROUTE_DESTINATION
2023-11-03 22:31:14.992581 80.00% [DEBUG] mod_sofia.c:614 Responding to INVITE with: 404
2023-11-03 22:31:14.992581 80.00% [DEBUG] switch_core_state_machine.c:59 sofia/external/not-used@192.168.176.2:63068 Standard HANGUP, cause: NO_ROUTE_DESTINATION
2023-11-03 22:31:14.992581 80.00% [DEBUG] switch_core_state_machine.c:846 (sofia/external/not-used@192.168.176.2:63068) State HANGUP going to sleep
2023-11-03 22:31:14.992581 80.00% [DEBUG] switch_core_state_machine.c:616 (sofia/external/not-used@192.168.176.2:63068) State Change CS_HANGUP -> CS_REPORTING
2023-11-03 22:31:14.992581 80.00% [DEBUG] switch_core_state_machine.c:581 (sofia/external/not-used@192.168.176.2:63068) Running State Change CS_REPORTING (Cur 2 Tot 2)
2023-11-03 22:31:14.992581 80.00% [DEBUG] switch_core_state_machine.c:932 (sofia/external/not-used@192.168.176.2:63068) State REPORTING
2023-11-03 22:31:14.992581 80.00% [DEBUG] switch_core_state_machine.c:168 sofia/external/not-used@192.168.176.2:63068 Standard REPORTING, cause: NO_ROUTE_DESTINATION
2023-11-03 22:31:14.992581 80.00% [DEBUG] switch_core_state_machine.c:932 (sofia/external/not-used@192.168.176.2:63068) State REPORTING going to sleep
2023-11-03 22:31:15.010138 80.00% [DEBUG] switch_core_state_machine.c:607 (sofia/external/not-used@192.168.176.2:63068) State Change CS_REPORTING -> CS_DESTROY
2023-11-03 22:31:15.010138 80.00% [DEBUG] switch_core_session.c:1744 Session 2 (sofia/external/not-used@192.168.176.2:63068) Locked, Waiting on external entities
2023-11-03 22:31:15.010138 80.00% [NOTICE] switch_core_session.c:1762 Session 2 (sofia/external/not-used@192.168.176.2:63068) Ended
2023-11-03 22:31:15.010138 80.00% [NOTICE] switch_core_session.c:1766 Close Channel sofia/external/not-used@192.168.176.2:63068 [CS_DESTROY]
2023-11-03 22:31:15.010138 80.00% [DEBUG] switch_core_state_machine.c:735 (sofia/external/not-used@192.168.176.2:63068) Running State Change CS_DESTROY (Cur 1 Tot 2)
2023-11-03 22:31:15.010138 80.00% [DEBUG] switch_core_state_machine.c:745 (sofia/external/not-used@192.168.176.2:63068) State DESTROY
2023-11-03 22:31:15.010138 80.00% [DEBUG] mod_sofia.c:380 sofia/external/not-used@192.168.176.2:63068 SOFIA DESTROY
2023-11-03 22:31:15.010138 80.00% [DEBUG] switch_core_state_machine.c:175 sofia/external/not-used@192.168.176.2:63068 Standard DESTROY
2023-11-03 22:31:15.010138 80.00% [DEBUG] switch_core_state_machine.c:745 (sofia/external/not-used@192.168.176.2:63068) State DESTROY going to sleep
2023-11-03 22:31:15.010138 80.00% [DEBUG] sofia.c:6672 Remote Reason: 3
2023-11-03 22:31:15.049199 80.00% [DEBUG] sofia.c:7493 Channel sofia/external/+15553332901 entering state [terminated][404]
2023-11-03 22:31:15.049199 80.00% [NOTICE] sofia.c:8735 Hangup sofia/external/+15553332901 [CS_CONSUME_MEDIA] [NO_ROUTE_DESTINATION]

TEST FAIL: switch_sip.c(38): (session)
 FAIL ***
2023-11-03 22:31:15.049199 80.00% [DEBUG] switch_ivr_originate.c:4056 Originate Resulted in Error Cause: 3 [NO_ROUTE_DESTINATION]
identity_full_check ...............................................2023-11-03 22:31:15.049199 80.00% [DEBUG] switch_ivr_originate.c:2301 Parsing global variables
2023-11-03 22:31:15.049199 80.00% [NOTICE] switch_channel.c:1143 New Channel sofia/external/+15553332901 [da6d3e4c-44a5-4978-afbe-7543deca5b9d]
2023-11-03 22:31:15.049199 80.00% [DEBUG] mod_sofia.c:5094 sofia/external/+15553332901 setting variable [rtp_secure_media]=[false]
2023-11-03 22:31:15.049199 80.00% [DEBUG] mod_sofia.c:5110 (sofia/external/+15553332901) State Change CS_NEW -> CS_INIT
2023-11-03 22:31:15.049199 80.00% [DEBUG] switch_core_state_machine.c:581 (sofia/external/+15553332901) Running State Change CS_INIT (Cur 2 Tot 3)
2023-11-03 22:31:15.068863 80.00% [DEBUG] switch_core_state_machine.c:581 (sofia/external/+15553332901) Running State Change CS_HANGUP (Cur 2 Tot 3)
2023-11-03 22:31:15.068863 80.00% [DEBUG] switch_core_state_machine.c:624 (sofia/external/+15553332901) State INIT
2023-11-03 22:31:15.068863 80.00% [DEBUG] mod_sofia.c:97 sofia/external/+15553332901 SOFIA INIT
2023-11-03 22:31:15.068863 80.00% [DEBUG] switch_core_state_machine.c:844 (sofia/external/+15553332901) Callstate Change DOWN -> HANGUP
2023-11-03 22:31:15.068863 80.00% [INFO] sofia_glue.c:1659 sofia/external/+15553332901 sending invite call-id: (null)
2023-11-03 22:31:15.068863 80.00% [DEBUG] sofia_glue.c:1662 sofia/external/+15553332901 sending invite version: 1.10.11-dev git 42162a8 2023-11-03 22:22:07Z 64bit
Local SDP:
v=0
o=SignalWire-STACK 1699031235 1699031236 IN IP4 192.168.176.2
s=SignalWire-STACK
c=IN IP4 192.168.176.2
t=0 0
m=audio 19440 RTP/AVP 0 101 13
a=rtpmap:0 PCMU/8000
a=rtpmap:101 telephone-event/8000
a=fmtp:101 0-15
a=rtpmap:13 CN/8000
a=ptime:20
a=sendrecv

2023-11-03 22:31:15.068863 80.00% [DEBUG] switch_core_state_machine.c:40 sofia/external/+15553332901 Standard INIT
2023-11-03 22:31:15.068863 80.00% [DEBUG] switch_core_state_machine.c:48 (sofia/external/+15553332901) State Change CS_INIT -> CS_ROUTING
2023-11-03 22:31:15.068863 80.00% [DEBUG] switch_core_state_machine.c:846 (sofia/external/+15553332901) State HANGUP
2023-11-03 22:31:15.068863 80.00% [DEBUG] mod_sofia.c:469 Channel sofia/external/+15553332901 hanging up, cause: NO_ROUTE_DESTINATION
2023-11-03 22:31:15.068863 80.00% [DEBUG] switch_core_state_machine.c:624 (sofia/external/+15553332901) State INIT going to sleep
2023-11-03 22:31:15.068863 80.00% [DEBUG] switch_core_state_machine.c:59 sofia/external/+15553332901 Standard HANGUP, cause: NO_ROUTE_DESTINATION
2023-11-03 22:31:15.068863 80.00% [DEBUG] switch_core_state_machine.c:846 (sofia/external/+15553332901) State HANGUP going to sleep
2023-11-03 22:31:15.068863 80.00% [DEBUG] switch_core_state_machine.c:616 (sofia/external/+15553332901) State Change CS_HANGUP -> CS_REPORTING
2023-11-03 22:31:15.068863 80.00% [DEBUG] switch_core_state_machine.c:581 (sofia/external/+15553332901) Running State Change CS_REPORTING (Cur 2 Tot 3)
2023-11-03 22:31:15.088862 80.00% [DEBUG] switch_core_state_machine.c:932 (sofia/external/+15553332901) State REPORTING
2023-11-03 22:31:15.088862 80.00% [DEBUG] switch_core_state_machine.c:168 sofia/external/+15553332901 Standard REPORTING, cause: NO_ROUTE_DESTINATION
2023-11-03 22:31:15.088862 80.00% [DEBUG] switch_core_state_machine.c:932 (sofia/external/+15553332901) State REPORTING going to sleep
2023-11-03 22:31:15.088862 80.00% [NOTICE] switch_channel.c:1143 New Channel sofia/external/not-used@192.168.176.2:63068 [9e4057f3-4513-4715-ae4d-f2bda58deafe]
2023-11-03 22:31:15.088862 80.00% [DEBUG] switch_core_state_machine.c:607 (sofia/external/+15553332901) State Change CS_REPORTING -> CS_DESTROY
2023-11-03 22:31:15.088862 80.00% [DEBUG] switch_core_state_machine.c:581 (sofia/external/not-used@192.168.176.2:63068) Running State Change CS_NEW (Cur 3 Tot 4)
2023-11-03 22:31:15.088862 80.00% [DEBUG] switch_core_session.c:1744 Session 1 (sofia/external/+15553332901) Locked, Waiting on external entities
2023-11-03 22:31:15.088862 80.00% [NOTICE] switch_core_session.c:1762 Session 1 (sofia/external/+15553332901) Ended
2023-11-03 22:31:15.088862 80.00% [NOTICE] switch_core_session.c:1766 Close Channel sofia/external/+15553332901 [CS_DESTROY]
2023-11-03 22:31:15.088862 80.00% [DEBUG] switch_core_state_machine.c:735 (sofia/external/+15553332901) Running State Change CS_DESTROY (Cur 2 Tot 4)
2023-11-03 22:31:15.108866 80.00% [DEBUG] switch_core_state_machine.c:745 (sofia/external/+15553332901) State DESTROY
2023-11-03 22:31:15.108866 80.00% [DEBUG] mod_sofia.c:380 sofia/external/+15553332901 SOFIA DESTROY
2023-11-03 22:31:15.108866 80.00% [DEBUG] switch_core_state_machine.c:175 sofia/external/+15553332901 Standard DESTROY
2023-11-03 22:31:15.108866 80.00% [DEBUG] switch_core_state_machine.c:745 (sofia/external/+15553332901) State DESTROY going to sleep
2023-11-03 22:31:15.108866 80.00% [DEBUG] switch_core_state_machine.c:581 (sofia/external/+15553332901) Running State Change CS_ROUTING (Cur 2 Tot 4)
2023-11-03 22:31:15.108866 80.00% [DEBUG] sofia.c:7493 Channel sofia/external/+15553332901 entering state [calling][0]
2023-11-03 22:31:15.108866 80.00% [DEBUG] switch_core_state_machine.c:640 (sofia/external/+15553332901) State ROUTING
2023-11-03 22:31:15.108866 80.00% [DEBUG] mod_sofia.c:158 sofia/external/+15553332901 SOFIA ROUTING
2023-11-03 22:31:15.108866 80.00% [DEBUG] switch_ivr_originate.c:67 (sofia/external/+15553332901) State Change CS_ROUTING -> CS_CONSUME_MEDIA
2023-11-03 22:31:15.108866 80.00% [DEBUG] switch_core_state_machine.c:640 (sofia/external/+15553332901) State ROUTING going to sleep
2023-11-03 22:31:15.108866 80.00% [DEBUG] switch_core_state_machine.c:581 (sofia/external/+15553332901) Running State Change CS_CONSUME_MEDIA (Cur 2 Tot 4)
2023-11-03 22:31:15.108866 80.00% [DEBUG] switch_core_state_machine.c:659 (sofia/external/+15553332901) State CONSUME_MEDIA
2023-11-03 22:31:15.108866 80.00% [DEBUG] switch_core_state_machine.c:659 (sofia/external/+15553332901) State CONSUME_MEDIA going to sleep
2023-11-03 22:31:15.108866 80.00% [INFO] sofia.c:10459 sofia/external/not-used@192.168.176.2:63068 receiving invite from 192.168.176.2:63068 version: 1.10.11-dev git 42162a8 2023-11-03 22:22:07Z 64bit call-id: 8a4fd53f-f53b-123c-0695-0242c0a8b002
2023-11-03 22:31:15.128954 80.00% [DEBUG] sofia.c:7493 Channel sofia/external/not-used@192.168.176.2:63068 entering state [received][100]
2023-11-03 22:31:15.128954 80.00% [DEBUG] sofia.c:7503 Remote SDP:
v=0
o=SignalWire-STACK 1699031235 1699031236 IN IP4 192.168.176.2
s=SignalWire-STACK
c=IN IP4 192.168.176.2
t=0 0
m=audio 19440 RTP/AVP 0 101 13
a=rtpmap:0 PCMU/8000
a=rtpmap:101 telephone-event/8000
a=fmtp:101 0-15
a=rtpmap:13 CN/8000
a=ptime:20

2023-11-03 22:31:15.128954 80.00% [DEBUG] sofia.c:7906 (sofia/external/not-used@192.168.176.2:63068) State Change CS_NEW -> CS_INIT
2023-11-03 22:31:15.128954 80.00% [DEBUG] switch_core_state_machine.c:600 (sofia/external/not-used@192.168.176.2:63068) State NEW
2023-11-03 22:31:15.128954 80.00% [DEBUG] switch_core_state_machine.c:581 (sofia/external/not-used@192.168.176.2:63068) Running State Change CS_INIT (Cur 2 Tot 4)
2023-11-03 22:31:15.128954 80.00% [DEBUG] switch_core_state_machine.c:624 (sofia/external/not-used@192.168.176.2:63068) State INIT
2023-11-03 22:31:15.128954 80.00% [DEBUG] mod_sofia.c:97 sofia/external/not-used@192.168.176.2:63068 SOFIA INIT
2023-11-03 22:31:15.128954 80.00% [DEBUG] switch_core_state_machine.c:40 sofia/external/not-used@192.168.176.2:63068 Standard INIT
2023-11-03 22:31:15.128954 80.00% [DEBUG] switch_core_state_machine.c:48 (sofia/external/not-used@192.168.176.2:63068) State Change CS_INIT -> CS_ROUTING
2023-11-03 22:31:15.128954 80.00% [DEBUG] switch_core_state_machine.c:624 (sofia/external/not-used@192.168.176.2:63068) State INIT going to sleep
2023-11-03 22:31:15.149661 80.00% [DEBUG] switch_core_state_machine.c:581 (sofia/external/not-used@192.168.176.2:63068) Running State Change CS_ROUTING (Cur 2 Tot 4)
2023-11-03 22:31:15.149661 80.00% [DEBUG] switch_channel.c:2400 (sofia/external/not-used@192.168.176.2:63068) Callstate Change DOWN -> RINGING
2023-11-03 22:31:15.149661 80.00% [DEBUG] switch_core_state_machine.c:640 (sofia/external/not-used@192.168.176.2:63068) State ROUTING
2023-11-03 22:31:15.149661 80.00% [DEBUG] mod_sofia.c:158 sofia/external/not-used@192.168.176.2:63068 SOFIA ROUTING
2023-11-03 22:31:15.149661 80.00% [DEBUG] switch_core_state_machine.c:230 sofia/external/not-used@192.168.176.2:63068 Standard ROUTING
2023-11-03 22:31:15.149661 80.00% [INFO] mod_dialplan_xml.c:642 Processing not-used <0000000000>->+15553332901 in context default
Dialplan: sofia/external/not-used@192.168.176.2:63068 parsing [default->two] continue=false
2023-11-03 22:31:15.149661 80.00% [ERR] switch_regex.c:116 COMPILE ERROR: 0 [no error][^\+15553332901$]
Dialplan: sofia/external/not-used@192.168.176.2:63068 Regex (FAIL) [two] destination_number(+15553332901) =~ /^\+15553332901$/ break=on-false
Dialplan: sofia/external/not-used@192.168.176.2:63068 parsing [default->one] continue=false
2023-11-03 22:31:15.149661 80.00% [ERR] switch_regex.c:116 COMPILE ERROR: 0 [no error][^\+15553332900$]
Dialplan: sofia/external/not-used@192.168.176.2:63068 Regex (FAIL) [one] destination_number(+15553332901) =~ /^\+15553332900$/ break=on-false
2023-11-03 22:31:15.149661 80.00% [INFO] switch_core_state_machine.c:306 No Route, Aborting
2023-11-03 22:31:15.149661 80.00% [NOTICE] switch_core_state_machine.c:307 Hangup sofia/external/not-used@192.168.176.2:63068 [CS_ROUTING] [NO_ROUTE_DESTINATION]
2023-11-03 22:31:15.149661 80.00% [DEBUG] switch_core_state_machine.c:640 (sofia/external/not-used@192.168.176.2:63068) State ROUTING going to sleep
2023-11-03 22:31:15.149661 80.00% [DEBUG] switch_core_state_machine.c:581 (sofia/external/not-used@192.168.176.2:63068) Running State Change CS_HANGUP (Cur 2 Tot 4)
2023-11-03 22:31:15.169599 80.00% [DEBUG] switch_core_state_machine.c:844 (sofia/external/not-used@192.168.176.2:63068) Callstate Change RINGING -> HANGUP
2023-11-03 22:31:15.169599 80.00% [DEBUG] switch_core_state_machine.c:846 (sofia/external/not-used@192.168.176.2:63068) State HANGUP
2023-11-03 22:31:15.169599 80.00% [DEBUG] mod_sofia.c:469 Channel sofia/external/not-used@192.168.176.2:63068 hanging up, cause: NO_ROUTE_DESTINATION
2023-11-03 22:31:15.169599 80.00% [DEBUG] mod_sofia.c:614 Responding to INVITE with: 404
2023-11-03 22:31:15.169599 80.00% [DEBUG] switch_core_state_machine.c:59 sofia/external/not-used@192.168.176.2:63068 Standard HANGUP, cause: NO_ROUTE_DESTINATION
2023-11-03 22:31:15.169599 80.00% [DEBUG] switch_core_state_machine.c:846 (sofia/external/not-used@192.168.176.2:63068) State HANGUP going to sleep
2023-11-03 22:31:15.169599 80.00% [DEBUG] switch_core_state_machine.c:616 (sofia/external/not-used@192.168.176.2:63068) State Change CS_HANGUP -> CS_REPORTING
2023-11-03 22:31:15.169599 80.00% [DEBUG] switch_core_state_machine.c:581 (sofia/external/not-used@192.168.176.2:63068) Running State Change CS_REPORTING (Cur 2 Tot 4)
2023-11-03 22:31:15.169599 80.00% [DEBUG] switch_core_state_machine.c:932 (sofia/external/not-used@192.168.176.2:63068) State REPORTING
2023-11-03 22:31:15.169599 80.00% [DEBUG] switch_core_state_machine.c:168 sofia/external/not-used@192.168.176.2:63068 Standard REPORTING, cause: NO_ROUTE_DESTINATION
2023-11-03 22:31:15.169599 80.00% [DEBUG] switch_core_state_machine.c:932 (sofia/external/not-used@192.168.176.2:63068) State REPORTING going to sleep
2023-11-03 22:31:15.190273 80.00% [DEBUG] switch_core_state_machine.c:607 (sofia/external/not-used@192.168.176.2:63068) State Change CS_REPORTING -> CS_DESTROY
2023-11-03 22:31:15.190273 80.00% [DEBUG] switch_core_session.c:1744 Session 4 (sofia/external/not-used@192.168.176.2:63068) Locked, Waiting on external entities
2023-11-03 22:31:15.190273 80.00% [NOTICE] switch_core_session.c:1762 Session 4 (sofia/external/not-used@192.168.176.2:63068) Ended
2023-11-03 22:31:15.190273 80.00% [NOTICE] switch_core_session.c:1766 Close Channel sofia/external/not-used@192.168.176.2:63068 [CS_DESTROY]
2023-11-03 22:31:15.190273 80.00% [DEBUG] switch_core_state_machine.c:735 (sofia/external/not-used@192.168.176.2:63068) Running State Change CS_DESTROY (Cur 1 Tot 4)
2023-11-03 22:31:15.190273 80.00% [DEBUG] switch_core_state_machine.c:745 (sofia/external/not-used@192.168.176.2:63068) State DESTROY
2023-11-03 22:31:15.190273 80.00% [DEBUG] mod_sofia.c:380 sofia/external/not-used@192.168.176.2:63068 SOFIA DESTROY
2023-11-03 22:31:15.190273 80.00% [DEBUG] switch_core_state_machine.c:175 sofia/external/not-used@192.168.176.2:63068 Standard DESTROY
2023-11-03 22:31:15.190273 80.00% [DEBUG] switch_core_state_machine.c:745 (sofia/external/not-used@192.168.176.2:63068) State DESTROY going to sleep
2023-11-03 22:31:15.190273 80.00% [DEBUG] sofia.c:6672 Remote Reason: 3
2023-11-03 22:31:15.210287 80.00% [DEBUG] sofia.c:7493 Channel sofia/external/+15553332901 entering state [terminated][404]
2023-11-03 22:31:15.210287 80.00% [NOTICE] sofia.c:8735 Hangup sofia/external/+15553332901 [CS_CONSUME_MEDIA] [NO_ROUTE_DESTINATION]
2023-11-03 22:31:15.210287 80.00% [DEBUG] switch_core_state_machine.c:581 (sofia/external/+15553332901) Running State Change CS_HANGUP (Cur 1 Tot 4)
2023-11-03 22:31:15.230276 80.00% [DEBUG] switch_core_state_machine.c:844 (sofia/external/+15553332901) Callstate Change DOWN -> HANGUP
2023-11-03 22:31:15.230276 80.00% [DEBUG] switch_ivr_originate.c:4056 Originate Resulted in Error Cause: 3 [NO_ROUTE_DESTINATION]

TEST FAIL: switch_sip.c(74): (session)
 FAIL ***
2023-11-03 22:31:15.230276 80.00% [CONSOLE] switch_core.c:3031 End existing sessions
2023-11-03 22:31:15.230276 80.00% [DEBUG] switch_core_state_machine.c:846 (sofia/external/+15553332901) State HANGUP
2023-11-03 22:31:15.230276 80.00% [CONSOLE] switch_core.c:3033 Clean up modules.
2023-11-03 22:31:15.230276 80.00% [DEBUG] mod_sofia.c:469 Channel sofia/external/+15553332901 hanging up, cause: NO_ROUTE_DESTINATION
2023-11-03 22:31:15.230276 80.00% [DEBUG] switch_core_state_machine.c:59 sofia/external/+15553332901 Standard HANGUP, cause: NO_ROUTE_DESTINATION
2023-11-03 22:31:15.230276 80.00% [DEBUG] switch_core_state_machine.c:846 (sofia/external/+15553332901) State HANGUP going to sleep
2023-11-03 22:31:15.230276 80.00% [DEBUG] switch_loadable_module.c:919 Chat Thread Ended
2023-11-03 22:31:15.230276 80.00% [DEBUG] switch_core_state_machine.c:616 (sofia/external/+15553332901) State Change CS_HANGUP -> CS_REPORTING
2023-11-03 22:31:15.230276 80.00% [DEBUG] switch_loadable_module.c:919 Chat Thread Ended
2023-11-03 22:31:15.230276 80.00% [DEBUG] switch_core_state_machine.c:581 (sofia/external/+15553332901) Running State Change CS_REPORTING (Cur 1 Tot 4)
2023-11-03 22:31:15.230276 80.00% [NOTICE] switch_loadable_module.c:1197 Deleting Dialplan 'XML'
2023-11-03 22:31:15.230276 80.00% [CONSOLE] switch_loadable_module.c:2357 mod_dialplan_xml has no shutdown routine
2023-11-03 22:31:15.230276 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec SPEEX 99 Speex 32000hz 20ms
2023-11-03 22:31:15.230276 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec SPEEX 99 Speex 16000hz 20ms
2023-11-03 22:31:15.230276 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec SPEEX 99 Speex 8000hz 20ms
2023-11-03 22:31:15.230276 80.00% [CONSOLE] switch_loadable_module.c:2357 CORE_SPEEX_MODULE has no shutdown routine
2023-11-03 22:31:15.230276 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec VP8 99 VP8 Video 90000hz 0ms
2023-11-03 22:31:15.230276 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec VP9 99 VP9 Video 90000hz 0ms
2023-11-03 22:31:15.230276 80.00% [NOTICE] switch_loadable_module.c:1285 Deleting API Function 'vpx'
2023-11-03 22:31:15.230276 80.00% [DEBUG] switch_loadable_module.c:1287 Write lock interface 'vpx' to wait for existing references.
2023-11-03 22:31:15.249655 80.00% [CONSOLE] switch_loadable_module.c:2354 Stopping: CORE_VPX_MODULE
2023-11-03 22:31:15.249655 80.00% [DEBUG] switch_loadable_module.c:1117 Write lock interface 'loopback' to wait for existing references.
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1125 Deleting Endpoint 'loopback'
2023-11-03 22:31:15.249655 80.00% [DEBUG] switch_loadable_module.c:1117 Write lock interface 'null' to wait for existing references.
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1125 Deleting Endpoint 'null'
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'unloop'
2023-11-03 22:31:15.249655 80.00% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'unloop' to wait for existing references.
2023-11-03 22:31:15.249655 80.00% [CONSOLE] switch_loadable_module.c:2354 Stopping: mod_loopback
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_loopback.c:loopback::bowout
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_loopback.c:loopback::direct
2023-11-03 22:31:15.249655 80.00% [DEBUG] switch_event.c:2156 Event Binding deleted for mod_loopback:RELOADXML
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1285 Deleting API Function 'console'
2023-11-03 22:31:15.249655 80.00% [DEBUG] switch_loadable_module.c:1287 Write lock interface 'console' to wait for existing references.
2023-11-03 22:31:15.249655 80.00% [CONSOLE] switch_loadable_module.c:2354 Stopping: mod_console
2023-11-03 22:31:15.249655 80.00% [DEBUG] switch_loadable_module.c:1350 Write lock interface 'mod_tone_stream' to wait for existing references.
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'tone_stream'
2023-11-03 22:31:15.249655 80.00% [DEBUG] switch_loadable_module.c:1350 Write lock interface 'mod_tone_stream' to wait for existing references.
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'silence_stream'
2023-11-03 22:31:15.249655 80.00% [CONSOLE] switch_loadable_module.c:2357 mod_tone_stream has no shutdown routine
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PROXY-VID 31 PROXY VIDEO PASS-THROUGH 90000hz 0ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PROXY 0 PROXY PASS-THROUGH 8000hz 20ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PROXY 0 PROXY PASS-THROUGH 8000hz 20ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 11025hz 32ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 11025hz 32ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 11025hz 40ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 11025hz 40ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 22050hz 20ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 22050hz 20ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 44100hz 30ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 44100hz 30ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 44100hz 20ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 44100hz 20ms
2023-11-03 22:31:15.230276 80.00% [DEBUG] switch_core_state_machine.c:932 (sofia/external/+15553332901) State REPORTING
2023-11-03 22:31:15.249655 80.00% [DEBUG] switch_core_state_machine.c:168 sofia/external/+15553332901 Standard REPORTING, cause: NO_ROUTE_DESTINATION
2023-11-03 22:31:15.249655 80.00% [DEBUG] switch_core_state_machine.c:932 (sofia/external/+15553332901) State REPORTING going to sleep
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 44100hz 10ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 44100hz 10ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 48000hz 40ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 48000hz 40ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 48000hz 30ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 48000hz 30ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 48000hz 20ms
2023-11-03 22:31:15.249655 80.00% [DEBUG] switch_core_state_machine.c:607 (sofia/external/+15553332901) State Change CS_REPORTING -> CS_DESTROY
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 48000hz 20ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 32000hz 8ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 32000hz 8ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 32000hz 6ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 32000hz 6ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 32000hz 4ms
2023-11-03 22:31:15.249655 80.00% [DEBUG] switch_core_session.c:1744 Session 3 (sofia/external/+15553332901) Locked, Waiting on external entities
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_core_session.c:1762 Session 3 (sofia/external/+15553332901) Ended
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_core_session.c:1766 Close Channel sofia/external/+15553332901 [CS_DESTROY]
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 32000hz 4ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 32000hz 2ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 32000hz 2ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 16000hz 8ms
2023-11-03 22:31:15.249655 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 16000hz 8ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 16000hz 6ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 16000hz 6ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 16000hz 4ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 16000hz 4ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 16000hz 2ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 16000hz 2ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 8ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 8ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 6ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 6ms
2023-11-03 22:31:15.269653 80.00% [DEBUG] switch_core_state_machine.c:735 (sofia/external/+15553332901) Running State Change CS_DESTROY (Cur 0 Tot 4)
2023-11-03 22:31:15.269653 80.00% [DEBUG] switch_core_state_machine.c:745 (sofia/external/+15553332901) State DESTROY
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 4ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 4ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 2ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 2ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 48000hz 10ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 48000hz 10ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 48000hz 8ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 48000hz 8ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 48000hz 6ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 48000hz 6ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 48000hz 4ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 48000hz 4ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 48000hz 2ms
2023-11-03 22:31:15.269653 80.00% [DEBUG] mod_sofia.c:380 sofia/external/+15553332901 SOFIA DESTROY
2023-11-03 22:31:15.269653 80.00% [DEBUG] switch_core_state_machine.c:175 sofia/external/+15553332901 Standard DESTROY
2023-11-03 22:31:15.269653 80.00% [DEBUG] switch_core_state_machine.c:745 (sofia/external/+15553332901) State DESTROY going to sleep
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 48000hz 2ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 24000hz 60ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 24000hz 60ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 24000hz 40ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 24000hz 40ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 24000hz 20ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 24000hz 20ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 12000hz 100ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 12000hz 100ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 12000hz 80ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 12000hz 80ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 12000hz 60ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 12000hz 60ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 12000hz 40ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 12000hz 40ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 12000hz 20ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 12000hz 20ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 32000hz 10ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 32000hz 10ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 32000hz 20ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 32000hz 20ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 32000hz 30ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 32000hz 30ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 32000hz 40ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 32000hz 40ms
2023-11-03 22:31:15.269653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 32000hz 50ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 32000hz 50ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 32000hz 60ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 32000hz 60ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 16000hz 10ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 16000hz 10ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 16000hz 20ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 16000hz 20ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 16000hz 30ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 16000hz 30ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 16000hz 40ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 16000hz 40ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 16000hz 50ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 16000hz 50ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 16000hz 60ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 16000hz 60ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 10ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 10ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 20ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 20ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 30ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 30ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 40ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 40ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 50ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 50ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 60ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 60ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 70ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 70ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 80ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 80ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 90ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 90ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 100ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 100ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 110ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 110ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 120ms
2023-11-03 22:31:15.288861 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec L16 100 RAW Signed Linear (16 bit) 8000hz 120ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMU 0 G.711 ulaw 48000hz 10ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMU 0 G.711 ulaw 48000hz 10ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMU 0 G.711 ulaw 8000hz 10ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMU 0 G.711 ulaw 48000hz 20ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMU 0 G.711 ulaw 48000hz 20ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMU 0 G.711 ulaw 8000hz 20ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMU 0 G.711 ulaw 48000hz 30ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMU 0 G.711 ulaw 48000hz 30ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMU 0 G.711 ulaw 8000hz 30ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMU 0 G.711 ulaw 48000hz 40ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMU 0 G.711 ulaw 48000hz 40ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMU 0 G.711 ulaw 8000hz 40ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMU 0 G.711 ulaw 8000hz 50ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMU 0 G.711 ulaw 8000hz 60ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMU 0 G.711 ulaw 8000hz 70ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMU 0 G.711 ulaw 8000hz 80ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMU 0 G.711 ulaw 8000hz 90ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMU 0 G.711 ulaw 8000hz 100ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMU 0 G.711 ulaw 8000hz 110ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMU 0 G.711 ulaw 8000hz 120ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMA 8 G.711 alaw 8000hz 10ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMA 8 G.711 alaw 8000hz 20ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMA 8 G.711 alaw 8000hz 30ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMA 8 G.711 alaw 8000hz 40ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMA 8 G.711 alaw 8000hz 50ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMA 8 G.711 alaw 8000hz 60ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMA 8 G.711 alaw 8000hz 70ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMA 8 G.711 alaw 8000hz 80ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMA 8 G.711 alaw 8000hz 90ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMA 8 G.711 alaw 8000hz 100ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMA 8 G.711 alaw 8000hz 110ms
2023-11-03 22:31:15.309653 80.00% [NOTICE] switch_loadable_module.c:1153 Deleting Codec PCMA 8 G.711 alaw 8000hz 120ms
2023-11-03 22:31:15.309653 80.00% [CONSOLE] switch_loadable_module.c:2354 Stopping: CORE_PCM_MODULE
2023-11-03 22:31:15.309653 80.00% [DEBUG] switch_loadable_module.c:1117 Write lock interface 'sofia' to wait for existing references.
2023-11-03 22:31:15.329656 80.00% [NOTICE] switch_loadable_module.c:1125 Deleting Endpoint 'sofia'
2023-11-03 22:31:15.329656 80.00% [DEBUG] switch_loadable_module.c:1117 Write lock interface 'rtp' to wait for existing references.
2023-11-03 22:31:15.329656 80.00% [NOTICE] switch_loadable_module.c:1125 Deleting Endpoint 'rtp'
2023-11-03 22:31:15.329656 80.00% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'sofia_sla'
2023-11-03 22:31:15.329656 80.00% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'sofia_sla' to wait for existing references.
2023-11-03 22:31:15.329656 80.00% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'sofia_stir_shaken_vs'
2023-11-03 22:31:15.329656 80.00% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'sofia_stir_shaken_vs' to wait for existing references.
2023-11-03 22:31:15.329656 80.00% [NOTICE] switch_loadable_module.c:1285 Deleting API Function 'sofia'
2023-11-03 22:31:15.329656 80.00% [DEBUG] switch_loadable_module.c:1287 Write lock interface 'sofia' to wait for existing references.
2023-11-03 22:31:15.329656 80.00% [NOTICE] switch_loadable_module.c:1285 Deleting API Function 'sofia_gateway_data'
2023-11-03 22:31:15.329656 80.00% [DEBUG] switch_loadable_module.c:1287 Write lock interface 'sofia_gateway_data' to wait for existing references.
2023-11-03 22:31:15.329656 80.00% [NOTICE] switch_loadable_module.c:1285 Deleting API Function 'sofia_username_of'
2023-11-03 22:31:15.329656 80.00% [DEBUG] switch_loadable_module.c:1287 Write lock interface 'sofia_username_of' to wait for existing references.
2023-11-03 22:31:15.329656 80.00% [NOTICE] switch_loadable_module.c:1285 Deleting API Function 'sofia_contact'
2023-11-03 22:31:15.329656 80.00% [DEBUG] switch_loadable_module.c:1287 Write lock interface 'sofia_contact' to wait for existing references.
2023-11-03 22:31:15.329656 80.00% [NOTICE] switch_loadable_module.c:1285 Deleting API Function 'sofia_count_reg'
2023-11-03 22:31:15.329656 80.00% [DEBUG] switch_loadable_module.c:1287 Write lock interface 'sofia_count_reg' to wait for existing references.
2023-11-03 22:31:15.329656 80.00% [NOTICE] switch_loadable_module.c:1285 Deleting API Function 'sofia_dig'
2023-11-03 22:31:15.329656 80.00% [DEBUG] switch_loadable_module.c:1287 Write lock interface 'sofia_dig' to wait for existing references.
2023-11-03 22:31:15.329656 80.00% [NOTICE] switch_loadable_module.c:1285 Deleting API Function 'sofia_presence_data'
2023-11-03 22:31:15.329656 80.00% [DEBUG] switch_loadable_module.c:1287 Write lock interface 'sofia_presence_data' to wait for existing references.
2023-11-03 22:31:15.329656 80.00% [NOTICE] switch_loadable_module.c:1317 Deleting API Function 'sofia.status'
2023-11-03 22:31:15.329656 80.00% [DEBUG] switch_loadable_module.c:1319 Write lock interface 'sofia.status' to wait for existing references.
2023-11-03 22:31:15.329656 80.00% [NOTICE] switch_loadable_module.c:1317 Deleting API Function 'sofia.status.info'
2023-11-03 22:31:15.329656 80.00% [DEBUG] switch_loadable_module.c:1319 Write lock interface 'sofia.status.info' to wait for existing references.
2023-11-03 22:31:15.329656 80.00% [DEBUG] switch_loadable_module.c:1537 Write lock interface 'sip' to wait for existing references.
2023-11-03 22:31:15.329656 80.00% [NOTICE] switch_loadable_module.c:1546 Deleting Chat interface 'sip'
2023-11-03 22:31:15.329656 80.00% [NOTICE] switch_loadable_module.c:1590 Deleting Management interface 'mod_sofia' OID[.1.3.6.1.4.1.27880.1001]
2023-11-03 22:31:15.329656 80.00% [CONSOLE] switch_loadable_module.c:2354 Stopping: mod_sofia
2023-11-03 22:31:15.329656 80.00% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_sofia.c:sofia::notify_refer
2023-11-03 22:31:15.329656 80.00% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_sofia.c:sofia::notify_watched_header
2023-11-03 22:31:15.329656 80.00% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_sofia.c:sofia::unregister
2023-11-03 22:31:15.329656 80.00% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_sofia.c:sofia::profile_start
2023-11-03 22:31:15.349652 80.00% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_sofia.c:sofia::reinvite
2023-11-03 22:31:15.349652 80.00% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_sofia.c:sofia::replaced
2023-11-03 22:31:15.349652 80.00% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_sofia.c:sofia::transferor
2023-11-03 22:31:15.349652 80.00% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_sofia.c:sofia::transferee
2023-11-03 22:31:15.369604 80.00% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_sofia.c:sofia::error
2023-11-03 22:31:15.369604 80.00% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_sofia.c:sofia::intercepted
2023-11-03 22:31:15.369604 80.00% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_sofia.c:sofia::gateway_state
2023-11-03 22:31:15.369604 80.00% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_sofia.c:sofia::sip_user_state
2023-11-03 22:31:15.369604 80.00% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_sofia.c:sofia::gateway_delete
2023-11-03 22:31:15.369604 80.00% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_sofia.c:sofia::expire
2023-11-03 22:31:15.369604 80.00% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_sofia.c:sofia::register_attempt
2023-11-03 22:31:15.369604 80.00% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_sofia.c:sofia::register_failure
2023-11-03 22:31:15.369604 80.00% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_sofia.c:sofia::pre_register
2023-11-03 22:31:15.369604 80.00% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_sofia.c:sofia::register
2023-11-03 22:31:15.369604 80.00% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_sofia.c:sofia::gateway_add
2023-11-03 22:31:15.369604 80.00% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_sofia.c:sofia::bye_response
2023-11-03 22:31:15.369604 80.00% [DEBUG] switch_event.c:2156 Event Binding deleted for mod_sofia:PRESENCE_IN
2023-11-03 22:31:15.369604 80.00% [DEBUG] switch_event.c:2156 Event Binding deleted for mod_sofia:PRESENCE_OUT
2023-11-03 22:31:15.369604 80.00% [DEBUG] switch_event.c:2156 Event Binding deleted for mod_sofia:PRESENCE_PROBE
2023-11-03 22:31:15.369604 80.00% [DEBUG] switch_event.c:2156 Event Binding deleted for mod_sofia:MESSAGE_WAITING
2023-11-03 22:31:15.369604 80.00% [DEBUG] switch_event.c:2156 Event Binding deleted for mod_sofia:ROSTER
2023-11-03 22:31:15.369604 80.00% [DEBUG] switch_event.c:2156 Event Binding deleted for mod_sofia:CONFERENCE_DATA
2023-11-03 22:31:15.369604 80.00% [DEBUG] switch_event.c:2156 Event Binding deleted for mod_sofia:TRAP
2023-11-03 22:31:15.369604 80.00% [DEBUG] switch_event.c:2156 Event Binding deleted for mod_sofia:NOTIFY
2023-11-03 22:31:15.369604 80.00% [DEBUG] switch_event.c:2156 Event Binding deleted for mod_sofia:PHONE_FEATURE
2023-11-03 22:31:15.369604 80.00% [DEBUG] switch_event.c:2156 Event Binding deleted for mod_sofia:SEND_MESSAGE
2023-11-03 22:31:15.369604 80.00% [DEBUG] switch_event.c:2156 Event Binding deleted for mod_sofia:SEND_INFO
2023-11-03 22:31:15.369604 80.00% [DEBUG] switch_event.c:2156 Event Binding deleted for mod_sofia:CUSTOM
2023-11-03 22:31:15.908863 80.00% [NOTICE] sofia.c:3510 Waiting for worker thread
2023-11-03 22:31:15.908863 80.00% [INFO] switch_core_sqldb.c:1874 sofia:internal Destroying SQL queue.
2023-11-03 22:31:16.108863 76.67% [INFO] switch_core_sqldb.c:1825 sofia:internal Stopping SQL thread.
2023-11-03 22:31:16.108863 76.67% [DEBUG] sofia.c:3582 Write lock internal
2023-11-03 22:31:16.108863 76.67% [DEBUG] sofia.c:3595 Write unlock internal
2023-11-03 22:31:16.168857 76.67% [DEBUG] sofia_reg.c:328 Removing gateway external::test_gateway from hash.
2023-11-03 22:31:16.168857 76.67% [NOTICE] sofia_reg.c:342 Deleted gateway test_gateway
2023-11-03 22:31:16.168857 76.67% [NOTICE] sofia.c:3510 Waiting for worker thread
2023-11-03 22:31:16.188860 76.67% [INFO] switch_core_sqldb.c:1874 sofia:external Destroying SQL queue.
2023-11-03 22:31:16.490115 76.67% [INFO] switch_core_sqldb.c:1825 sofia:external Stopping SQL thread.
2023-11-03 22:31:16.490115 76.67% [DEBUG] sofia.c:3582 Write lock external
2023-11-03 22:31:16.490115 76.67% [DEBUG] sofia.c:3595 Write unlock external
2023-11-03 22:31:16.490115 76.67% [WARNING] sofia.c:2308 MSG Thread Ended
2023-11-03 22:31:16.490115 76.67% [DEBUG] switch_loadable_module.c:1117 Write lock interface 'error' to wait for existing references.
2023-11-03 22:31:16.490115 76.67% [NOTICE] switch_loadable_module.c:1125 Deleting Endpoint 'error'
2023-11-03 22:31:16.490115 76.67% [DEBUG] switch_loadable_module.c:1117 Write lock interface 'group' to wait for existing references.
2023-11-03 22:31:16.490115 76.67% [NOTICE] switch_loadable_module.c:1125 Deleting Endpoint 'group'
2023-11-03 22:31:16.490115 76.67% [DEBUG] switch_loadable_module.c:1117 Write lock interface 'user' to wait for existing references.
2023-11-03 22:31:16.490115 76.67% [NOTICE] switch_loadable_module.c:1125 Deleting Endpoint 'user'
2023-11-03 22:31:16.490115 76.67% [DEBUG] switch_loadable_module.c:1117 Write lock interface 'pickup' to wait for existing references.
2023-11-03 22:31:16.490115 76.67% [NOTICE] switch_loadable_module.c:1125 Deleting Endpoint 'pickup'
2023-11-03 22:31:16.490115 76.67% [NOTICE] switch_loadable_module.c:1197 Deleting Dialplan 'inline'
2023-11-03 22:31:16.490115 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'blind_transfer_ack'
2023-11-03 22:31:16.490115 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'blind_transfer_ack' to wait for existing references.
2023-11-03 22:31:16.490115 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'bind_digit_action'
2023-11-03 22:31:16.490115 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'bind_digit_action' to wait for existing references.
2023-11-03 22:31:16.490115 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'capture'
2023-11-03 22:31:16.490115 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'capture' to wait for existing references.
2023-11-03 22:31:16.490115 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'clear_digit_action'
2023-11-03 22:31:16.490115 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'clear_digit_action' to wait for existing references.
2023-11-03 22:31:16.490115 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'digit_action_set_realm'
2023-11-03 22:31:16.490115 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'digit_action_set_realm' to wait for existing references.
2023-11-03 22:31:16.490115 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'privacy'
2023-11-03 22:31:16.490115 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'privacy' to wait for existing references.
2023-11-03 22:31:16.490115 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'set_audio_level'
2023-11-03 22:31:16.490115 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'set_audio_level' to wait for existing references.
2023-11-03 22:31:16.490115 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'set_mute'
2023-11-03 22:31:16.490115 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'set_mute' to wait for existing references.
2023-11-03 22:31:16.490115 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'flush_dtmf'
2023-11-03 22:31:16.490115 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'flush_dtmf' to wait for existing references.
2023-11-03 22:31:16.510093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'hold'
2023-11-03 22:31:16.510093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'hold' to wait for existing references.
2023-11-03 22:31:16.510093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'unhold'
2023-11-03 22:31:16.510093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'unhold' to wait for existing references.
2023-11-03 22:31:16.510093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'mutex'
2023-11-03 22:31:16.510093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'mutex' to wait for existing references.
2023-11-03 22:31:16.510093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'page'
2023-11-03 22:31:16.510093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'page' to wait for existing references.
2023-11-03 22:31:16.510093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'transfer'
2023-11-03 22:31:16.510093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'transfer' to wait for existing references.
2023-11-03 22:31:16.510093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'check_acl'
2023-11-03 22:31:16.510093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'check_acl' to wait for existing references.
2023-11-03 22:31:16.510093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'verbose_events'
2023-11-03 22:31:16.510093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'verbose_events' to wait for existing references.
2023-11-03 22:31:16.510093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'novideo'
2023-11-03 22:31:16.510093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'novideo' to wait for existing references.
2023-11-03 22:31:16.510093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'cng_plc'
2023-11-03 22:31:16.510093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'cng_plc' to wait for existing references.
2023-11-03 22:31:16.510093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'early_hangup'
2023-11-03 22:31:16.510093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'early_hangup' to wait for existing references.
2023-11-03 22:31:16.510093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'sleep'
2023-11-03 22:31:16.510093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'sleep' to wait for existing references.
2023-11-03 22:31:16.510093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'delay_echo'
2023-11-03 22:31:16.510093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'delay_echo' to wait for existing references.
2023-11-03 22:31:16.510093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'strftime'
2023-11-03 22:31:16.510093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'strftime' to wait for existing references.
2023-11-03 22:31:16.510093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'phrase'
2023-11-03 22:31:16.510093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'phrase' to wait for existing references.
2023-11-03 22:31:16.510093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'eval'
2023-11-03 22:31:16.510093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'eval' to wait for existing references.
2023-11-03 22:31:16.510093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'set_media_stats'
2023-11-03 22:31:16.510093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'set_media_stats' to wait for existing references.
2023-11-03 22:31:16.510093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'stop'
2023-11-03 22:31:16.510093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'stop' to wait for existing references.
2023-11-03 22:31:16.510093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'set_zombie_exec'
2023-11-03 22:31:16.510093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'set_zombie_exec' to wait for existing references.
2023-11-03 22:31:16.510093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'pre_answer'
2023-11-03 22:31:16.510093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'pre_answer' to wait for existing references.
2023-11-03 22:31:16.510093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'answer'
2023-11-03 22:31:16.510093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'answer' to wait for existing references.
2023-11-03 22:31:16.510093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'wait_for_answer'
2023-11-03 22:31:16.530094 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'wait_for_answer' to wait for existing references.
2023-11-03 22:31:16.530094 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'wait_for_video_ready'
2023-11-03 22:31:16.530094 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'wait_for_video_ready' to wait for existing references.
2023-11-03 22:31:16.530094 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'hangup'
2023-11-03 22:31:16.530094 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'hangup' to wait for existing references.
2023-11-03 22:31:16.530094 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'set_name'
2023-11-03 22:31:16.530094 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'set_name' to wait for existing references.
2023-11-03 22:31:16.530094 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'presence'
2023-11-03 22:31:16.530094 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'presence' to wait for existing references.
2023-11-03 22:31:16.530094 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'log'
2023-11-03 22:31:16.530094 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'log' to wait for existing references.
2023-11-03 22:31:16.530094 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'info'
2023-11-03 22:31:16.530094 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'info' to wait for existing references.
2023-11-03 22:31:16.530094 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'event'
2023-11-03 22:31:16.530094 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'event' to wait for existing references.
2023-11-03 22:31:16.530094 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'sound_test'
2023-11-03 22:31:16.530094 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'sound_test' to wait for existing references.
2023-11-03 22:31:16.530094 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'export'
2023-11-03 22:31:16.530094 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'export' to wait for existing references.
2023-11-03 22:31:16.530094 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'bridge_export'
2023-11-03 22:31:16.530094 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'bridge_export' to wait for existing references.
2023-11-03 22:31:16.530094 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'set'
2023-11-03 22:31:16.530094 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'set' to wait for existing references.
2023-11-03 22:31:16.530094 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'multiset'
2023-11-03 22:31:16.530094 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'multiset' to wait for existing references.
2023-11-03 22:31:16.530094 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'push'
2023-11-03 22:31:16.530094 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'push' to wait for existing references.
2023-11-03 22:31:16.530094 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'unshift'
2023-11-03 22:31:16.530094 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'unshift' to wait for existing references.
2023-11-03 22:31:16.530094 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'set_global'
2023-11-03 22:31:16.530094 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'set_global' to wait for existing references.
2023-11-03 22:31:16.530094 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'set_profile_var'
2023-11-03 22:31:16.530094 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'set_profile_var' to wait for existing references.
2023-11-03 22:31:16.530094 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'unset'
2023-11-03 22:31:16.530094 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'unset' to wait for existing references.
2023-11-03 22:31:16.530094 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'multiunset'
2023-11-03 22:31:16.530094 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'multiunset' to wait for existing references.
2023-11-03 22:31:16.530094 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'capture_text'
2023-11-03 22:31:16.530094 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'capture_text' to wait for existing references.
2023-11-03 22:31:16.530094 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'acknowledge_call'
2023-11-03 22:31:16.530094 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'acknowledge_call' to wait for existing references.
2023-11-03 22:31:16.530094 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'ring_ready'
2023-11-03 22:31:16.530094 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'ring_ready' to wait for existing references.
2023-11-03 22:31:16.530094 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'remove_bugs'
2023-11-03 22:31:16.550093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'remove_bugs' to wait for existing references.
2023-11-03 22:31:16.550093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'break'
2023-11-03 22:31:16.550093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'break' to wait for existing references.
2023-11-03 22:31:16.550093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'detect_speech'
2023-11-03 22:31:16.550093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'detect_speech' to wait for existing references.
2023-11-03 22:31:16.550093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'play_and_detect_speech'
2023-11-03 22:31:16.550093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'play_and_detect_speech' to wait for existing references.
2023-11-03 22:31:16.550093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'ivr'
2023-11-03 22:31:16.550093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'ivr' to wait for existing references.
2023-11-03 22:31:16.550093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'redirect'
2023-11-03 22:31:16.550093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'redirect' to wait for existing references.
2023-11-03 22:31:16.550093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'video_refresh'
2023-11-03 22:31:16.550093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'video_refresh' to wait for existing references.
2023-11-03 22:31:16.550093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'video_decode'
2023-11-03 22:31:16.550093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'video_decode' to wait for existing references.
2023-11-03 22:31:16.550093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'send_info'
2023-11-03 22:31:16.550093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'send_info' to wait for existing references.
2023-11-03 22:31:16.550093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'jitterbuffer'
2023-11-03 22:31:16.550093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'jitterbuffer' to wait for existing references.
2023-11-03 22:31:16.550093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'send_display'
2023-11-03 22:31:16.550093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'send_display' to wait for existing references.
2023-11-03 22:31:16.550093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'respond'
2023-11-03 22:31:16.550093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'respond' to wait for existing references.
2023-11-03 22:31:16.550093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'deflect'
2023-11-03 22:31:16.550093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'deflect' to wait for existing references.
2023-11-03 22:31:16.550093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'recovery_refresh'
2023-11-03 22:31:16.550093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'recovery_refresh' to wait for existing references.
2023-11-03 22:31:16.550093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'reuse_caller_profile'
2023-11-03 22:31:16.550093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'reuse_caller_profile' to wait for existing references.
2023-11-03 22:31:16.550093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'queue_dtmf'
2023-11-03 22:31:16.550093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'queue_dtmf' to wait for existing references.
2023-11-03 22:31:16.550093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'send_dtmf'
2023-11-03 22:31:16.550093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'send_dtmf' to wait for existing references.
2023-11-03 22:31:16.550093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'sched_cancel'
2023-11-03 22:31:16.550093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'sched_cancel' to wait for existing references.
2023-11-03 22:31:16.550093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'sched_hangup'
2023-11-03 22:31:16.550093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'sched_hangup' to wait for existing references.
2023-11-03 22:31:16.550093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'sched_broadcast'
2023-11-03 22:31:16.550093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'sched_broadcast' to wait for existing references.
2023-11-03 22:31:16.550093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'sched_transfer'
2023-11-03 22:31:16.550093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'sched_transfer' to wait for existing references.
2023-11-03 22:31:16.550093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'execute_extension'
2023-11-03 22:31:16.550093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'execute_extension' to wait for existing references.
2023-11-03 22:31:16.550093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'sched_heartbeat'
2023-11-03 22:31:16.550093 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'sched_heartbeat' to wait for existing references.
2023-11-03 22:31:16.550093 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'enable_heartbeat'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'enable_heartbeat' to wait for existing references.
2023-11-03 22:31:16.570095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'filter_codecs'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'filter_codecs' to wait for existing references.
2023-11-03 22:31:16.570095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'enable_keepalive'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'enable_keepalive' to wait for existing references.
2023-11-03 22:31:16.570095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'media_reset'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'media_reset' to wait for existing references.
2023-11-03 22:31:16.570095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'mkdir'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'mkdir' to wait for existing references.
2023-11-03 22:31:16.570095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'rename'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'rename' to wait for existing references.
2023-11-03 22:31:16.570095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'transfer_vars'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'transfer_vars' to wait for existing references.
2023-11-03 22:31:16.570095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'soft_hold'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'soft_hold' to wait for existing references.
2023-11-03 22:31:16.570095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'bind_meta_app'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'bind_meta_app' to wait for existing references.
2023-11-03 22:31:16.570095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'unbind_meta_app'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'unbind_meta_app' to wait for existing references.
2023-11-03 22:31:16.570095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'block_dtmf'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'block_dtmf' to wait for existing references.
2023-11-03 22:31:16.570095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'unblock_dtmf'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'unblock_dtmf' to wait for existing references.
2023-11-03 22:31:16.570095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'intercept'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'intercept' to wait for existing references.
2023-11-03 22:31:16.570095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'eavesdrop'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'eavesdrop' to wait for existing references.
2023-11-03 22:31:16.570095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'native_eavesdrop'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'native_eavesdrop' to wait for existing references.
2023-11-03 22:31:16.570095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'three_way'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'three_way' to wait for existing references.
2023-11-03 22:31:16.570095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'set_user'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'set_user' to wait for existing references.
2023-11-03 22:31:16.570095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'stop_dtmf'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'stop_dtmf' to wait for existing references.
2023-11-03 22:31:16.570095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'start_dtmf'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'start_dtmf' to wait for existing references.
2023-11-03 22:31:16.570095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'stop_dtmf_generate'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'stop_dtmf_generate' to wait for existing references.
2023-11-03 22:31:16.570095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'start_dtmf_generate'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'start_dtmf_generate' to wait for existing references.
2023-11-03 22:31:16.570095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'stop_tone_detect'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'stop_tone_detect' to wait for existing references.
2023-11-03 22:31:16.570095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'fax_detect'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'fax_detect' to wait for existing references.
2023-11-03 22:31:16.570095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'tone_detect'
2023-11-03 22:31:16.570095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'tone_detect' to wait for existing references.
2023-11-03 22:31:16.590095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'echo'
2023-11-03 22:31:16.590095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'echo' to wait for existing references.
2023-11-03 22:31:16.590095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'park'
2023-11-03 22:31:16.590095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'park' to wait for existing references.
2023-11-03 22:31:16.590095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'park_state'
2023-11-03 22:31:16.590095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'park_state' to wait for existing references.
2023-11-03 22:31:16.590095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'gentones'
2023-11-03 22:31:16.590095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'gentones' to wait for existing references.
2023-11-03 22:31:16.590095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'playback'
2023-11-03 22:31:16.590095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'playback' to wait for existing references.
2023-11-03 22:31:16.590095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'broadcast'
2023-11-03 22:31:16.590095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'broadcast' to wait for existing references.
2023-11-03 22:31:16.590095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'endless_playback'
2023-11-03 22:31:16.590095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'endless_playback' to wait for existing references.
2023-11-03 22:31:16.590095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'loop_playback'
2023-11-03 22:31:16.590095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'loop_playback' to wait for existing references.
2023-11-03 22:31:16.590095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'att_xfer'
2023-11-03 22:31:16.590095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'att_xfer' to wait for existing references.
2023-11-03 22:31:16.590095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'read'
2023-11-03 22:31:16.590095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'read' to wait for existing references.
2023-11-03 22:31:16.590095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'play_and_get_digits'
2023-11-03 22:31:16.590095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'play_and_get_digits' to wait for existing references.
2023-11-03 22:31:16.590095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'stop_video_write_overlay'
2023-11-03 22:31:16.590095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'stop_video_write_overlay' to wait for existing references.
2023-11-03 22:31:16.590095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'video_write_overlay'
2023-11-03 22:31:16.590095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'video_write_overlay' to wait for existing references.
2023-11-03 22:31:16.590095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'stop_record_session'
2023-11-03 22:31:16.590095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'stop_record_session' to wait for existing references.
2023-11-03 22:31:16.590095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'record_session'
2023-11-03 22:31:16.590095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'record_session' to wait for existing references.
2023-11-03 22:31:16.590095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'record_session_mask'
2023-11-03 22:31:16.590095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'record_session_mask' to wait for existing references.
2023-11-03 22:31:16.590095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'record_session_unmask'
2023-11-03 22:31:16.590095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'record_session_unmask' to wait for existing references.
2023-11-03 22:31:16.590095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'record_session_pause'
2023-11-03 22:31:16.590095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'record_session_pause' to wait for existing references.
2023-11-03 22:31:16.590095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'record_session_resume'
2023-11-03 22:31:16.590095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'record_session_resume' to wait for existing references.
2023-11-03 22:31:16.590095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'record'
2023-11-03 22:31:16.590095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'record' to wait for existing references.
2023-11-03 22:31:16.590095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'preprocess'
2023-11-03 22:31:16.590095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'preprocess' to wait for existing references.
2023-11-03 22:31:16.590095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'stop_displace_session'
2023-11-03 22:31:16.590095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'stop_displace_session' to wait for existing references.
2023-11-03 22:31:16.590095 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'displace_session'
2023-11-03 22:31:16.590095 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'displace_session' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'speak'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'speak' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'clear_speech_cache'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'clear_speech_cache' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'bridge'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'bridge' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'system'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'system' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'bgsystem'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'bgsystem' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'say'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'say' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'detect_audio'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'detect_audio' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'detect_silence'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'detect_silence' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'wait_for_silence'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'wait_for_silence' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'session_loglevel'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'session_loglevel' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'limit'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'limit' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'limit_hash'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'limit_hash' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'limit_execute'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'limit_execute' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'limit_hash_execute'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'limit_hash_execute' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'pickup'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'pickup' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'deduplicate_dtmf'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'deduplicate_dtmf' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'vad_test'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'vad_test' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'debug_media'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'debug_media' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1285 Deleting API Function 'strepoch'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1287 Write lock interface 'strepoch' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1285 Deleting API Function 'page'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1287 Write lock interface 'page' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1285 Deleting API Function 'strmicroepoch'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1287 Write lock interface 'strmicroepoch' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1285 Deleting API Function 'chat'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1287 Write lock interface 'chat' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1285 Deleting API Function 'strftime'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1287 Write lock interface 'strftime' to wait for existing references.
2023-11-03 22:31:16.610099 76.67% [NOTICE] switch_loadable_module.c:1285 Deleting API Function 'presence'
2023-11-03 22:31:16.610099 76.67% [DEBUG] switch_loadable_module.c:1287 Write lock interface 'presence' to wait for existing references.
2023-11-03 22:31:16.630096 76.67% [DEBUG] switch_loadable_module.c:1350 Write lock interface 'mod_dptools' to wait for existing references.
2023-11-03 22:31:16.630096 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'file_string'
2023-11-03 22:31:16.630096 76.67% [DEBUG] switch_loadable_module.c:1350 Write lock interface 'mod_dptools' to wait for existing references.
2023-11-03 22:31:16.630096 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'file'
2023-11-03 22:31:16.630096 76.67% [DEBUG] switch_loadable_module.c:1537 Write lock interface 'event' to wait for existing references.
2023-11-03 22:31:16.630096 76.67% [NOTICE] switch_loadable_module.c:1546 Deleting Chat interface 'event'
2023-11-03 22:31:16.630096 76.67% [DEBUG] switch_loadable_module.c:1537 Write lock interface 'api' to wait for existing references.
2023-11-03 22:31:16.630096 76.67% [NOTICE] switch_loadable_module.c:1546 Deleting Chat interface 'api'
2023-11-03 22:31:16.630096 76.67% [CONSOLE] switch_loadable_module.c:2354 Stopping: mod_dptools
2023-11-03 22:31:16.630096 76.67% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_dptools.c:filestring::close
2023-11-03 22:31:16.630096 76.67% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_dptools.c:filestring::fail
2023-11-03 22:31:16.630096 76.67% [NOTICE] switch_event.c:467 Subclass reservation deleted for mod_dptools.c:filestring::open
2023-11-03 22:31:16.630096 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for mod_dptools:PRESENCE_PROBE
2023-11-03 22:31:16.630096 76.67% [NOTICE] switch_loadable_module.c:1214 Deleting Timer 'soft'
2023-11-03 22:31:16.630096 76.67% [CONSOLE] switch_loadable_module.c:2354 Stopping: CORE_SOFTTIMER_MODULE
2023-11-03 22:31:16.650185 76.67% [CONSOLE] switch_time.c:1331 Soft timer thread exiting.
2023-11-03 22:31:16.650279 76.67% [NOTICE] switch_loadable_module.c:125 Thread ended for CORE_SOFTTIMER_MODULE
2023-11-03 22:31:16.655168 76.67% [DEBUG] switch_event.c:2196 Event Binding deleted for CORE_SOFTTIMER_MODULE:RELOADXML
2023-11-03 22:31:16.655294 76.67% [NOTICE] switch_loadable_module.c:1285 Deleting API Function 'sndfile_debug'
2023-11-03 22:31:16.655389 76.67% [DEBUG] switch_loadable_module.c:1287 Write lock interface 'sndfile_debug' to wait for existing references.
2023-11-03 22:31:16.655920 76.67% [DEBUG] switch_loadable_module.c:1350 Write lock interface 'mod_sndfile' to wait for existing references.
2023-11-03 22:31:16.655987 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'aiff'
2023-11-03 22:31:16.656377 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'au'
2023-11-03 22:31:16.656833 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'avr'
2023-11-03 22:31:16.657223 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'caf'
2023-11-03 22:31:16.657592 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'flac'
2023-11-03 22:31:16.658043 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'htk'
2023-11-03 22:31:16.658413 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'iff'
2023-11-03 22:31:16.658793 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'mat'
2023-11-03 22:31:16.659166 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'mpc'
2023-11-03 22:31:16.659549 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'oga'
2023-11-03 22:31:16.659971 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'paf'
2023-11-03 22:31:16.660391 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'pvf'
2023-11-03 22:31:16.660895 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'raw'
2023-11-03 22:31:16.661264 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'rf64'
2023-11-03 22:31:16.661672 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'sd2'
2023-11-03 22:31:16.662073 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'sds'
2023-11-03 22:31:16.663332 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'sf'
2023-11-03 22:31:16.664781 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'voc'
2023-11-03 22:31:16.665205 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'w64'
2023-11-03 22:31:16.665637 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'wav'
2023-11-03 22:31:16.666026 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'wve'
2023-11-03 22:31:16.666392 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'xi'
2023-11-03 22:31:16.666786 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'r8'
2023-11-03 22:31:16.667891 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'r16'
2023-11-03 22:31:16.670054 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'r24'
2023-11-03 22:31:16.670440 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'r32'
2023-11-03 22:31:16.670884 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'gsm'
2023-11-03 22:31:16.671272 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'ul'
2023-11-03 22:31:16.671634 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'ulaw'
2023-11-03 22:31:16.672052 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'al'
2023-11-03 22:31:16.672434 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'alaw'
2023-11-03 22:31:16.673067 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'adpcm'
2023-11-03 22:31:16.673489 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'vox'
2023-11-03 22:31:16.674356 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'oga'
2023-11-03 22:31:16.675382 76.67% [NOTICE] switch_loadable_module.c:1360 Deleting File Format 'ogg'
2023-11-03 22:31:16.675762 76.67% [CONSOLE] switch_loadable_module.c:2354 Stopping: mod_sndfile
2023-11-03 22:31:16.676335 76.67% [NOTICE] switch_loadable_module.c:1230 Deleting Application 'hash'
2023-11-03 22:31:16.676502 76.67% [DEBUG] switch_loadable_module.c:1232 Write lock interface 'hash' to wait for existing references.
2023-11-03 22:31:16.677551 76.67% [NOTICE] switch_loadable_module.c:1285 Deleting API Function 'hash'
2023-11-03 22:31:16.677620 76.67% [DEBUG] switch_loadable_module.c:1287 Write lock interface 'hash' to wait for existing references.
2023-11-03 22:31:16.678112 76.67% [NOTICE] switch_loadable_module.c:1285 Deleting API Function 'hash_dump'
2023-11-03 22:31:16.678175 76.67% [DEBUG] switch_loadable_module.c:1287 Write lock interface 'hash_dump' to wait for existing references.
2023-11-03 22:31:16.678640 76.67% [NOTICE] switch_loadable_module.c:1285 Deleting API Function 'hash_remote'
2023-11-03 22:31:16.678699 76.67% [DEBUG] switch_loadable_module.c:1287 Write lock interface 'hash_remote' to wait for existing references.
2023-11-03 22:31:16.679140 76.67% [NOTICE] switch_loadable_module.c:1608 Deleting Limit interface 'hash'
2023-11-03 22:31:16.679589 76.67% [CONSOLE] switch_loadable_module.c:2354 Stopping: mod_hash
2023-11-03 22:31:16.870021 76.67% [DEBUG] switch_scheduler.c:147 Deleting task 3 limit_hash_cleanup (mod_hash)
2023-11-03 22:31:17.680614 76.67% [CONSOLE] switch_loadable_module.c:2374 mod_dialplan_xml unloaded.
2023-11-03 22:31:17.680716 76.67% [CONSOLE] switch_loadable_module.c:2374 CORE_SPEEX_MODULE unloaded.
2023-11-03 22:31:17.680777 76.67% [CONSOLE] switch_loadable_module.c:2374 CORE_VPX_MODULE unloaded.
2023-11-03 22:31:17.680819 76.67% [CONSOLE] switch_loadable_module.c:2374 mod_loopback unloaded.
2023-11-03 22:31:17.680857 76.67% [CONSOLE] switch_loadable_module.c:2374 mod_console unloaded.
2023-11-03 22:31:17.680895 76.67% [CONSOLE] switch_loadable_module.c:2374 mod_tone_stream unloaded.
2023-11-03 22:31:17.680947 76.67% [CONSOLE] switch_loadable_module.c:2374 mod_sofia unloaded.
2023-11-03 22:31:17.680988 76.67% [CONSOLE] switch_loadable_module.c:2374 mod_dptools unloaded.
2023-11-03 22:31:17.681025 76.67% [CONSOLE] switch_loadable_module.c:2370 CORE_SOFTTIMER_MODULE stopping runtime thread.
2023-11-03 22:31:17.681093 76.67% [CONSOLE] switch_loadable_module.c:2374 CORE_SOFTTIMER_MODULE unloaded.
2023-11-03 22:31:17.681156 76.67% [CONSOLE] switch_loadable_module.c:2374 mod_sndfile unloaded.
2023-11-03 22:31:17.681201 76.67% [CONSOLE] switch_loadable_module.c:2374 mod_hash unloaded.
2023-11-03 22:31:17.681246 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:CHANNEL_CREATE
2023-11-03 22:31:17.681340 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:CHANNEL_DESTROY
2023-11-03 22:31:17.681413 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:CHANNEL_STATE
2023-11-03 22:31:17.681481 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:CHANNEL_CALLSTATE
2023-11-03 22:31:17.681544 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:CHANNEL_ANSWER
2023-11-03 22:31:17.681594 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:CHANNEL_EXECUTE
2023-11-03 22:31:17.681653 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:CHANNEL_HOLD
2023-11-03 22:31:17.681712 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:CHANNEL_UNHOLD
2023-11-03 22:31:17.681770 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:CHANNEL_BRIDGE
2023-11-03 22:31:17.681828 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:CHANNEL_UNBRIDGE
2023-11-03 22:31:17.681888 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:CHANNEL_PROGRESS_MEDIA
2023-11-03 22:31:17.681948 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:CHANNEL_ORIGINATE
2023-11-03 22:31:17.682010 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:CHANNEL_UUID
2023-11-03 22:31:17.682075 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:LOG
2023-11-03 22:31:17.682115 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:SHUTDOWN
2023-11-03 22:31:17.682173 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:MODULE_LOAD
2023-11-03 22:31:17.682253 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:MODULE_UNLOAD
2023-11-03 22:31:17.682319 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:CODEC
2023-11-03 22:31:17.682380 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:ADD_SCHEDULE
2023-11-03 22:31:17.682449 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:DEL_SCHEDULE
2023-11-03 22:31:17.682516 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:EXE_SCHEDULE
2023-11-03 22:31:17.682580 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:RE_SCHEDULE
2023-11-03 22:31:17.682644 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:CALL_SECURE
2023-11-03 22:31:17.682713 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:NAT
2023-11-03 22:31:17.682752 76.67% [DEBUG] switch_event.c:2156 Event Binding deleted for core_db:CALL_UPDATE
2023-11-03 22:31:17.896683 76.67% [INFO] switch_core_sqldb.c:1874 CORE Destroying SQL queue.
2023-11-03 22:31:18.200664 76.67% [INFO] switch_core_sqldb.c:1825 CORE Stopping SQL thread.
2023-11-03 22:31:19.316275 76.67% [CONSOLE] switch_scheduler.c:369 Stopping Task Thread
2023-11-03 22:31:19.380899 76.67% [DEBUG] switch_scheduler.c:147 Deleting task 1 heartbeat (core)
2023-11-03 22:31:19.381390 76.67% [DEBUG] switch_scheduler.c:147 Deleting task 2 check_ip (core)
2023-11-03 22:31:19.381792 76.67% [NOTICE] switch_scheduler.c:199 Task thread ending
2023-11-03 22:31:19.382458 76.67% [DEBUG] switch_rtp.c:2568 Destroy port allocator for 192.168.176.2
2023-11-03 22:31:19.382673 76.67% [NOTICE] switch_msrp.c:356 destroying thread
2023-11-03 22:31:19.382715 76.67% [NOTICE] switch_msrp.c:366 destroy thread done
2023-11-03 22:31:19.385075 76.67% [CONSOLE] switch_core.c:3054 Closing Event Engine.
2023-11-03 22:31:19.385144 76.67% [CONSOLE] switch_event.c:575 Stopping dispatch queues
2023-11-03 22:31:19.385199 76.67% [CONSOLE] switch_event.c:584 Stopping dispatch threads
2023-11-03 22:31:19.386766 76.67% [CONSOLE] switch_event.c:351 Dispatch Thread 0 Ended.
2023-11-03 22:31:19.387058 76.67% [CONSOLE] switch_core.c:3057 Finalizing Shutdown.
2023-11-03 22:31:19.387143 76.67% [CONSOLE] switch_log.c:525 Logger Ended.
2023-11-03 22:31:19.392606 76.67% [CONSOLE] switch_core_memory.c:677 Stopping memory pool queue.

----------------------------------------------------------------------------

FAILED TESTS


identity_compact_check
  switch_sip.c(38):
    (session)

identity_full_check
  switch_sip.c(74):
    (session)



----------------------------------------------------------------------------

FAILED (0/2 tests in 0.850442s)