From Innocent Porcupine, 2 Years ago, written in FreeSWITCH.
  1. 2022-04-20 12:37:56.119254 [WARNING] switch_core_state_machine.c:687 88b64423-bcf4-4dae-b840-ab6195737adc sofia/internal/11@156.0.249.118 Abandoned
  2. 2022-04-20 12:37:56.119254 [NOTICE] switch_core_state_machine.c:690 Hangup sofia/internal/11@156.0.249.118 [CS_NEW] [WRONG_CALL_STATE]
  3. 2022-04-20 12:37:56.119254 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_HANGUP (Cur 2 Tot 1554)
  4. 2022-04-20 12:37:56.119254 [DEBUG] switch_core_state_machine.c:850 (sofia/internal/11@156.0.249.118) Callstate Change DOWN -> HANGUP
  5. 2022-04-20 12:37:56.119254 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/11@156.0.249.118) State HANGUP
  6. 2022-04-20 12:37:56.119254 [DEBUG] mod_sofia.c:438 Channel sofia/internal/11@156.0.249.118 hanging up, cause: WRONG_CALL_STATE
  7. 2022-04-20 12:37:56.119254 [DEBUG] switch_core_state_machine.c:60 sofia/internal/11@156.0.249.118 Standard HANGUP, cause: WRONG_CALL_STATE
  8. 2022-04-20 12:37:56.119254 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/11@156.0.249.118) State HANGUP going to sleep
  9. 2022-04-20 12:37:56.119254 [DEBUG] switch_core_state_machine.c:619 (sofia/internal/11@156.0.249.118) State Change CS_HANGUP -> CS_REPORTING
  10. 2022-04-20 12:37:56.119254 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_REPORTING (Cur 2 Tot 1554)
  11. 2022-04-20 12:37:56.119254 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/11@156.0.249.118) State REPORTING
  12. 2022-04-20 12:37:56.119254 [DEBUG] switch_core_state_machine.c:174 sofia/internal/11@156.0.249.118 Standard REPORTING, cause: WRONG_CALL_STATE
  13. 2022-04-20 12:37:56.119254 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/11@156.0.249.118) State REPORTING going to sleep
  14. 2022-04-20 12:37:56.119254 [DEBUG] switch_core_state_machine.c:610 (sofia/internal/11@156.0.249.118) State Change CS_REPORTING -> CS_DESTROY
  15. 2022-04-20 12:37:56.119254 [DEBUG] switch_core_session.c:1665 Session 1553 (sofia/internal/11@156.0.249.118) Locked, Waiting on external entities
  16. 2022-04-20 12:37:56.119254 [NOTICE] switch_core_session.c:1683 Session 1553 (sofia/internal/11@156.0.249.118) Ended
  17. 2022-04-20 12:37:56.119254 [NOTICE] switch_core_session.c:1687 Close Channel sofia/internal/11@156.0.249.118 [CS_DESTROY]
  18. 2022-04-20 12:37:56.139241 [DEBUG] switch_core_state_machine.c:741 (sofia/internal/11@156.0.249.118) Running State Change CS_DESTROY (Cur 1 Tot 1554)
  19. 2022-04-20 12:37:56.139241 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/11@156.0.249.118) State DESTROY
  20. 2022-04-20 12:37:56.139241 [DEBUG] mod_sofia.c:343 sofia/internal/11@156.0.249.118 SOFIA DESTROY
  21. 2022-04-20 12:37:56.139241 [DEBUG] switch_core_state_machine.c:181 sofia/internal/11@156.0.249.118 Standard DESTROY
  22. 2022-04-20 12:37:56.139241 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/11@156.0.249.118) State DESTROY going to sleep
  23. 2022-04-20 12:37:59.279271 [NOTICE] switch_channel.c:1104 New Channel sofia/internal/11@156.0.249.118 [bba3318f-4dca-4739-b5ba-a46095c7c773]
  24. 2022-04-20 12:37:59.279271 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_NEW (Cur 2 Tot 1555)
  25. 2022-04-20 12:37:59.279271 [DEBUG] sofia.c:9873 sofia/internal/11@156.0.249.118 receiving invite from 45.93.16.32:62317 version: 1.6.20 git 43a9feb 2018-05-07 18:56:11Z 64bit
  26. 2022-04-20 12:37:59.279271 [DEBUG] sofia.c:10044 IP 45.93.16.32 Rejected by acl "domains". Falling back to Digest auth.
  27. 2022-04-20 12:37:59.279271 [DEBUG] switch_core_state_machine.c:603 (sofia/internal/11@156.0.249.118) State NEW
  28. 2022-04-20 12:37:59.279271 [DEBUG] sofia.c:2334 detaching session bba3318f-4dca-4739-b5ba-a46095c7c773
  29. 2022-04-20 12:38:01.539263 [NOTICE] switch_channel.c:1104 New Channel sofia/internal/1052@156.0.249.118 [be64492d-7342-4901-9a37-c7a2d3282892]
  30. 2022-04-20 12:38:01.539263 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/1052@156.0.249.118) Running State Change CS_NEW (Cur 3 Tot 1556)
  31. 2022-04-20 12:38:01.539263 [DEBUG] sofia.c:9873 sofia/internal/1052@156.0.249.118 receiving invite from 45.93.16.28:52830 version: 1.6.20 git 43a9feb 2018-05-07 18:56:11Z 64bit
  32. 2022-04-20 12:38:01.539263 [DEBUG] sofia.c:10044 IP 45.93.16.28 Rejected by acl "domains". Falling back to Digest auth.
  33. 2022-04-20 12:38:01.539263 [DEBUG] switch_core_state_machine.c:603 (sofia/internal/1052@156.0.249.118) State NEW
  34. 2022-04-20 12:38:01.539263 [DEBUG] sofia.c:2334 detaching session be64492d-7342-4901-9a37-c7a2d3282892
  35. 2022-04-20 12:38:01.739262 [DEBUG] sofia.c:2442 Re-attaching to session be64492d-7342-4901-9a37-c7a2d3282892
  36. 2022-04-20 12:38:01.739262 [DEBUG] sofia.c:9873 sofia/internal/1052@156.0.249.118 receiving invite from 45.93.16.28:52830 version: 1.6.20 git 43a9feb 2018-05-07 18:56:11Z 64bit
  37. 2022-04-20 12:38:01.739262 [DEBUG] sofia.c:10044 IP 45.93.16.28 Rejected by acl "domains". Falling back to Digest auth.
  38. 2022-04-20 12:38:01.739262 [WARNING] sofia_reg.c:2906 Can't find user [1052@156.0.249.118] from 45.93.16.28
  39. You must define a domain called '156.0.249.118' in your directory and add a user with the id="1052" attribute
  40. and you must configure your device to use the proper domain in it's authentication credentials.
  41. 2022-04-20 12:38:01.739262 [NOTICE] sofia.c:2332 Hangup sofia/internal/1052@156.0.249.118 [CS_NEW] [CALL_REJECTED]
  42. 2022-04-20 12:38:01.759253 [DEBUG] sofia.c:1453 Channel is already hungup.
  43. 2022-04-20 12:38:01.759253 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/1052@156.0.249.118) Running State Change CS_HANGUP (Cur 3 Tot 1556)
  44. 2022-04-20 12:38:01.759253 [DEBUG] switch_core_state_machine.c:850 (sofia/internal/1052@156.0.249.118) Callstate Change DOWN -> HANGUP
  45. 2022-04-20 12:38:01.759253 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/1052@156.0.249.118) State HANGUP
  46. 2022-04-20 12:38:01.759253 [DEBUG] mod_sofia.c:438 Channel sofia/internal/1052@156.0.249.118 hanging up, cause: CALL_REJECTED
  47. 2022-04-20 12:38:01.759253 [DEBUG] switch_core_state_machine.c:60 sofia/internal/1052@156.0.249.118 Standard HANGUP, cause: CALL_REJECTED
  48. 2022-04-20 12:38:01.759253 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/1052@156.0.249.118) State HANGUP going to sleep
  49. 2022-04-20 12:38:01.759253 [DEBUG] switch_core_state_machine.c:619 (sofia/internal/1052@156.0.249.118) State Change CS_HANGUP -> CS_REPORTING
  50. 2022-04-20 12:38:01.759253 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/1052@156.0.249.118) Running State Change CS_REPORTING (Cur 3 Tot 1556)
  51. 2022-04-20 12:38:01.759253 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/1052@156.0.249.118) State REPORTING
  52. 2022-04-20 12:38:01.759253 [DEBUG] switch_core_state_machine.c:174 sofia/internal/1052@156.0.249.118 Standard REPORTING, cause: CALL_REJECTED
  53. 2022-04-20 12:38:01.759253 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/1052@156.0.249.118) State REPORTING going to sleep
  54. 2022-04-20 12:38:01.759253 [DEBUG] switch_core_state_machine.c:610 (sofia/internal/1052@156.0.249.118) State Change CS_REPORTING -> CS_DESTROY
  55. 2022-04-20 12:38:01.759253 [DEBUG] switch_core_session.c:1665 Session 1556 (sofia/internal/1052@156.0.249.118) Locked, Waiting on external entities
  56. 2022-04-20 12:38:01.759253 [NOTICE] switch_core_session.c:1683 Session 1556 (sofia/internal/1052@156.0.249.118) Ended
  57. 2022-04-20 12:38:01.759253 [NOTICE] switch_core_session.c:1687 Close Channel sofia/internal/1052@156.0.249.118 [CS_DESTROY]
  58. 2022-04-20 12:38:01.759253 [DEBUG] switch_core_state_machine.c:741 (sofia/internal/1052@156.0.249.118) Running State Change CS_DESTROY (Cur 2 Tot 1556)
  59. 2022-04-20 12:38:01.759253 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/1052@156.0.249.118) State DESTROY
  60. 2022-04-20 12:38:01.759253 [DEBUG] mod_sofia.c:343 sofia/internal/1052@156.0.249.118 SOFIA DESTROY
  61. 2022-04-20 12:38:01.759253 [DEBUG] switch_core_state_machine.c:181 sofia/internal/1052@156.0.249.118 Standard DESTROY
  62. 2022-04-20 12:38:01.759253 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/1052@156.0.249.118) State DESTROY going to sleep
  63. 2022-04-20 12:38:02.679278 [WARNING] switch_core_state_machine.c:687 3ab6577e-7482-4d4b-a005-2537d4ab0721 sofia/internal/11@156.0.249.118 Abandoned
  64. 2022-04-20 12:38:02.679278 [NOTICE] switch_core_state_machine.c:690 Hangup sofia/internal/11@156.0.249.118 [CS_NEW] [WRONG_CALL_STATE]
  65. 2022-04-20 12:38:02.679278 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_HANGUP (Cur 2 Tot 1556)
  66. 2022-04-20 12:38:02.679278 [DEBUG] switch_core_state_machine.c:850 (sofia/internal/11@156.0.249.118) Callstate Change DOWN -> HANGUP
  67. 2022-04-20 12:38:02.679278 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/11@156.0.249.118) State HANGUP
  68. 2022-04-20 12:38:02.679278 [DEBUG] mod_sofia.c:438 Channel sofia/internal/11@156.0.249.118 hanging up, cause: WRONG_CALL_STATE
  69. 2022-04-20 12:38:02.679278 [DEBUG] switch_core_state_machine.c:60 sofia/internal/11@156.0.249.118 Standard HANGUP, cause: WRONG_CALL_STATE
  70. 2022-04-20 12:38:02.679278 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/11@156.0.249.118) State HANGUP going to sleep
  71. 2022-04-20 12:38:02.679278 [DEBUG] switch_core_state_machine.c:619 (sofia/internal/11@156.0.249.118) State Change CS_HANGUP -> CS_REPORTING
  72. 2022-04-20 12:38:02.679278 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_REPORTING (Cur 2 Tot 1556)
  73. 2022-04-20 12:38:02.679278 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/11@156.0.249.118) State REPORTING
  74. 2022-04-20 12:38:02.679278 [DEBUG] switch_core_state_machine.c:174 sofia/internal/11@156.0.249.118 Standard REPORTING, cause: WRONG_CALL_STATE
  75. 2022-04-20 12:38:02.679278 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/11@156.0.249.118) State REPORTING going to sleep
  76. 2022-04-20 12:38:02.679278 [DEBUG] switch_core_state_machine.c:610 (sofia/internal/11@156.0.249.118) State Change CS_REPORTING -> CS_DESTROY
  77. 2022-04-20 12:38:02.679278 [DEBUG] switch_core_session.c:1665 Session 1554 (sofia/internal/11@156.0.249.118) Locked, Waiting on external entities
  78. 2022-04-20 12:38:02.679278 [NOTICE] switch_core_session.c:1683 Session 1554 (sofia/internal/11@156.0.249.118) Ended
  79. 2022-04-20 12:38:02.679278 [NOTICE] switch_core_session.c:1687 Close Channel sofia/internal/11@156.0.249.118 [CS_DESTROY]
  80. 2022-04-20 12:38:02.679278 [DEBUG] switch_core_state_machine.c:741 (sofia/internal/11@156.0.249.118) Running State Change CS_DESTROY (Cur 1 Tot 1556)
  81. 2022-04-20 12:38:02.679278 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/11@156.0.249.118) State DESTROY
  82. 2022-04-20 12:38:02.679278 [DEBUG] mod_sofia.c:343 sofia/internal/11@156.0.249.118 SOFIA DESTROY
  83. 2022-04-20 12:38:02.679278 [DEBUG] switch_core_state_machine.c:181 sofia/internal/11@156.0.249.118 Standard DESTROY
  84. 2022-04-20 12:38:02.679278 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/11@156.0.249.118) State DESTROY going to sleep
  85. 2022-04-20 12:38:05.679269 [NOTICE] switch_channel.c:1104 New Channel sofia/internal/11@156.0.249.118 [d18c9584-9ff9-4b9e-bed4-cfe7ddfabb15]
  86. 2022-04-20 12:38:05.679269 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_NEW (Cur 2 Tot 1557)
  87. 2022-04-20 12:38:05.679269 [DEBUG] sofia.c:9873 sofia/internal/11@156.0.249.118 receiving invite from 45.93.16.32:57482 version: 1.6.20 git 43a9feb 2018-05-07 18:56:11Z 64bit
  88. 2022-04-20 12:38:05.679269 [DEBUG] sofia.c:10044 IP 45.93.16.32 Rejected by acl "domains". Falling back to Digest auth.
  89. 2022-04-20 12:38:05.679269 [DEBUG] switch_core_state_machine.c:603 (sofia/internal/11@156.0.249.118) State NEW
  90. 2022-04-20 12:38:05.679269 [DEBUG] sofia.c:2334 detaching session d18c9584-9ff9-4b9e-bed4-cfe7ddfabb15
  91. 2022-04-20 12:38:07.639274 [NOTICE] switch_channel.c:1104 New Channel sofia/internal/0106@156.0.249.118 [2612168c-d391-4485-9beb-92ced25d7c70]
  92. 2022-04-20 12:38:07.639274 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/0106@156.0.249.118) Running State Change CS_NEW (Cur 3 Tot 1558)
  93. 2022-04-20 12:38:07.639274 [DEBUG] sofia.c:9873 sofia/internal/0106@156.0.249.118 receiving invite from 207.244.235.91:56998 version: 1.6.20 git 43a9feb 2018-05-07 18:56:11Z 64bit
  94. 2022-04-20 12:38:07.639274 [DEBUG] sofia.c:10044 IP 207.244.235.91 Rejected by acl "domains". Falling back to Digest auth.
  95. 2022-04-20 12:38:07.639274 [DEBUG] switch_core_state_machine.c:603 (sofia/internal/0106@156.0.249.118) State NEW
  96. 2022-04-20 12:38:07.639274 [DEBUG] sofia.c:2334 detaching session 2612168c-d391-4485-9beb-92ced25d7c70
  97. 2022-04-20 12:38:07.879275 [DEBUG] sofia.c:2442 Re-attaching to session 2612168c-d391-4485-9beb-92ced25d7c70
  98. 2022-04-20 12:38:07.879275 [DEBUG] sofia.c:9873 sofia/internal/0106@156.0.249.118 receiving invite from 207.244.235.91:56998 version: 1.6.20 git 43a9feb 2018-05-07 18:56:11Z 64bit
  99. 2022-04-20 12:38:07.879275 [DEBUG] sofia.c:10044 IP 207.244.235.91 Rejected by acl "domains". Falling back to Digest auth.
  100. 2022-04-20 12:38:07.879275 [WARNING] sofia_reg.c:2906 Can't find user [0106@156.0.249.118] from 207.244.235.91
  101. You must define a domain called '156.0.249.118' in your directory and add a user with the id="0106" attribute
  102. and you must configure your device to use the proper domain in it's authentication credentials.
  103. 2022-04-20 12:38:07.879275 [NOTICE] sofia.c:2332 Hangup sofia/internal/0106@156.0.249.118 [CS_NEW] [CALL_REJECTED]
  104. 2022-04-20 12:38:07.899285 [DEBUG] sofia.c:1453 Channel is already hungup.
  105. 2022-04-20 12:38:07.899285 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/0106@156.0.249.118) Running State Change CS_HANGUP (Cur 3 Tot 1558)
  106. 2022-04-20 12:38:07.899285 [DEBUG] switch_core_state_machine.c:850 (sofia/internal/0106@156.0.249.118) Callstate Change DOWN -> HANGUP
  107. 2022-04-20 12:38:07.899285 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/0106@156.0.249.118) State HANGUP
  108. 2022-04-20 12:38:07.899285 [DEBUG] mod_sofia.c:438 Channel sofia/internal/0106@156.0.249.118 hanging up, cause: CALL_REJECTED
  109. 2022-04-20 12:38:07.899285 [DEBUG] switch_core_state_machine.c:60 sofia/internal/0106@156.0.249.118 Standard HANGUP, cause: CALL_REJECTED
  110. 2022-04-20 12:38:07.899285 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/0106@156.0.249.118) State HANGUP going to sleep
  111. 2022-04-20 12:38:07.899285 [DEBUG] switch_core_state_machine.c:619 (sofia/internal/0106@156.0.249.118) State Change CS_HANGUP -> CS_REPORTING
  112. 2022-04-20 12:38:07.899285 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/0106@156.0.249.118) Running State Change CS_REPORTING (Cur 3 Tot 1558)
  113. 2022-04-20 12:38:07.899285 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/0106@156.0.249.118) State REPORTING
  114. 2022-04-20 12:38:07.899285 [DEBUG] switch_core_state_machine.c:174 sofia/internal/0106@156.0.249.118 Standard REPORTING, cause: CALL_REJECTED
  115. 2022-04-20 12:38:07.899285 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/0106@156.0.249.118) State REPORTING going to sleep
  116. 2022-04-20 12:38:07.899285 [DEBUG] switch_core_state_machine.c:610 (sofia/internal/0106@156.0.249.118) State Change CS_REPORTING -> CS_DESTROY
  117. 2022-04-20 12:38:07.899285 [DEBUG] switch_core_session.c:1665 Session 1558 (sofia/internal/0106@156.0.249.118) Locked, Waiting on external entities
  118. 2022-04-20 12:38:07.899285 [NOTICE] switch_core_session.c:1683 Session 1558 (sofia/internal/0106@156.0.249.118) Ended
  119. 2022-04-20 12:38:07.899285 [NOTICE] switch_core_session.c:1687 Close Channel sofia/internal/0106@156.0.249.118 [CS_DESTROY]
  120. 2022-04-20 12:38:07.899285 [DEBUG] switch_core_state_machine.c:741 (sofia/internal/0106@156.0.249.118) Running State Change CS_DESTROY (Cur 2 Tot 1558)
  121. 2022-04-20 12:38:07.899285 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/0106@156.0.249.118) State DESTROY
  122. 2022-04-20 12:38:07.899285 [DEBUG] mod_sofia.c:343 sofia/internal/0106@156.0.249.118 SOFIA DESTROY
  123. 2022-04-20 12:38:07.899285 [DEBUG] switch_core_state_machine.c:181 sofia/internal/0106@156.0.249.118 Standard DESTROY
  124. 2022-04-20 12:38:07.899285 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/0106@156.0.249.118) State DESTROY going to sleep
  125. 2022-04-20 12:38:09.299270 [WARNING] switch_core_state_machine.c:687 bba3318f-4dca-4739-b5ba-a46095c7c773 sofia/internal/11@156.0.249.118 Abandoned
  126. 2022-04-20 12:38:09.299270 [NOTICE] switch_core_state_machine.c:690 Hangup sofia/internal/11@156.0.249.118 [CS_NEW] [WRONG_CALL_STATE]
  127. 2022-04-20 12:38:09.299270 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_HANGUP (Cur 2 Tot 1558)
  128. 2022-04-20 12:38:09.299270 [DEBUG] switch_core_state_machine.c:850 (sofia/internal/11@156.0.249.118) Callstate Change DOWN -> HANGUP
  129. 2022-04-20 12:38:09.299270 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/11@156.0.249.118) State HANGUP
  130. 2022-04-20 12:38:09.299270 [DEBUG] mod_sofia.c:438 Channel sofia/internal/11@156.0.249.118 hanging up, cause: WRONG_CALL_STATE
  131. 2022-04-20 12:38:09.299270 [DEBUG] switch_core_state_machine.c:60 sofia/internal/11@156.0.249.118 Standard HANGUP, cause: WRONG_CALL_STATE
  132. 2022-04-20 12:38:09.299270 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/11@156.0.249.118) State HANGUP going to sleep
  133. 2022-04-20 12:38:09.299270 [DEBUG] switch_core_state_machine.c:619 (sofia/internal/11@156.0.249.118) State Change CS_HANGUP -> CS_REPORTING
  134. 2022-04-20 12:38:09.299270 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_REPORTING (Cur 2 Tot 1558)
  135. 2022-04-20 12:38:09.299270 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/11@156.0.249.118) State REPORTING
  136. 2022-04-20 12:38:09.299270 [DEBUG] switch_core_state_machine.c:174 sofia/internal/11@156.0.249.118 Standard REPORTING, cause: WRONG_CALL_STATE
  137. 2022-04-20 12:38:09.299270 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/11@156.0.249.118) State REPORTING going to sleep
  138. 2022-04-20 12:38:09.299270 [DEBUG] switch_core_state_machine.c:610 (sofia/internal/11@156.0.249.118) State Change CS_REPORTING -> CS_DESTROY
  139. 2022-04-20 12:38:09.299270 [DEBUG] switch_core_session.c:1665 Session 1555 (sofia/internal/11@156.0.249.118) Locked, Waiting on external entities
  140. 2022-04-20 12:38:09.299270 [NOTICE] switch_core_session.c:1683 Session 1555 (sofia/internal/11@156.0.249.118) Ended
  141. 2022-04-20 12:38:09.299270 [NOTICE] switch_core_session.c:1687 Close Channel sofia/internal/11@156.0.249.118 [CS_DESTROY]
  142. 2022-04-20 12:38:09.299270 [DEBUG] switch_core_state_machine.c:741 (sofia/internal/11@156.0.249.118) Running State Change CS_DESTROY (Cur 1 Tot 1558)
  143. 2022-04-20 12:38:09.299270 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/11@156.0.249.118) State DESTROY
  144. 2022-04-20 12:38:09.299270 [DEBUG] mod_sofia.c:343 sofia/internal/11@156.0.249.118 SOFIA DESTROY
  145. 2022-04-20 12:38:09.299270 [DEBUG] switch_core_state_machine.c:181 sofia/internal/11@156.0.249.118 Standard DESTROY
  146. 2022-04-20 12:38:09.299270 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/11@156.0.249.118) State DESTROY going to sleep
  147. 2022-04-20 12:38:12.039267 [NOTICE] switch_channel.c:1104 New Channel sofia/internal/11@156.0.249.118 [c8d90229-ace2-4505-8281-2081282592f1]
  148. 2022-04-20 12:38:12.039267 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_NEW (Cur 2 Tot 1559)
  149. 2022-04-20 12:38:12.039267 [DEBUG] sofia.c:9873 sofia/internal/11@156.0.249.118 receiving invite from 45.93.16.32:53798 version: 1.6.20 git 43a9feb 2018-05-07 18:56:11Z 64bit
  150. 2022-04-20 12:38:12.039267 [DEBUG] sofia.c:10044 IP 45.93.16.32 Rejected by acl "domains". Falling back to Digest auth.
  151. 2022-04-20 12:38:12.039267 [DEBUG] switch_core_state_machine.c:603 (sofia/internal/11@156.0.249.118) State NEW
  152. 2022-04-20 12:38:12.039267 [DEBUG] sofia.c:2334 detaching session c8d90229-ace2-4505-8281-2081282592f1
  153. 2022-04-20 12:38:15.699273 [WARNING] switch_core_state_machine.c:687 d18c9584-9ff9-4b9e-bed4-cfe7ddfabb15 sofia/internal/11@156.0.249.118 Abandoned
  154. 2022-04-20 12:38:15.699273 [NOTICE] switch_core_state_machine.c:690 Hangup sofia/internal/11@156.0.249.118 [CS_NEW] [WRONG_CALL_STATE]
  155. 2022-04-20 12:38:15.699273 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_HANGUP (Cur 2 Tot 1559)
  156. 2022-04-20 12:38:15.699273 [DEBUG] switch_core_state_machine.c:850 (sofia/internal/11@156.0.249.118) Callstate Change DOWN -> HANGUP
  157. 2022-04-20 12:38:15.699273 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/11@156.0.249.118) State HANGUP
  158. 2022-04-20 12:38:15.699273 [DEBUG] mod_sofia.c:438 Channel sofia/internal/11@156.0.249.118 hanging up, cause: WRONG_CALL_STATE
  159. 2022-04-20 12:38:15.699273 [DEBUG] switch_core_state_machine.c:60 sofia/internal/11@156.0.249.118 Standard HANGUP, cause: WRONG_CALL_STATE
  160. 2022-04-20 12:38:15.699273 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/11@156.0.249.118) State HANGUP going to sleep
  161. 2022-04-20 12:38:15.699273 [DEBUG] switch_core_state_machine.c:619 (sofia/internal/11@156.0.249.118) State Change CS_HANGUP -> CS_REPORTING
  162. 2022-04-20 12:38:15.699273 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_REPORTING (Cur 2 Tot 1559)
  163. 2022-04-20 12:38:15.699273 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/11@156.0.249.118) State REPORTING
  164. 2022-04-20 12:38:15.699273 [DEBUG] switch_core_state_machine.c:174 sofia/internal/11@156.0.249.118 Standard REPORTING, cause: WRONG_CALL_STATE
  165. 2022-04-20 12:38:15.699273 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/11@156.0.249.118) State REPORTING going to sleep
  166. 2022-04-20 12:38:15.699273 [DEBUG] switch_core_state_machine.c:610 (sofia/internal/11@156.0.249.118) State Change CS_REPORTING -> CS_DESTROY
  167. 2022-04-20 12:38:15.699273 [DEBUG] switch_core_session.c:1665 Session 1557 (sofia/internal/11@156.0.249.118) Locked, Waiting on external entities
  168. 2022-04-20 12:38:15.699273 [NOTICE] switch_core_session.c:1683 Session 1557 (sofia/internal/11@156.0.249.118) Ended
  169. 2022-04-20 12:38:15.699273 [NOTICE] switch_core_session.c:1687 Close Channel sofia/internal/11@156.0.249.118 [CS_DESTROY]
  170. 2022-04-20 12:38:15.699273 [DEBUG] switch_core_state_machine.c:741 (sofia/internal/11@156.0.249.118) Running State Change CS_DESTROY (Cur 1 Tot 1559)
  171. 2022-04-20 12:38:15.699273 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/11@156.0.249.118) State DESTROY
  172. 2022-04-20 12:38:15.699273 [DEBUG] mod_sofia.c:343 sofia/internal/11@156.0.249.118 SOFIA DESTROY
  173. 2022-04-20 12:38:15.699273 [DEBUG] switch_core_state_machine.c:181 sofia/internal/11@156.0.249.118 Standard DESTROY
  174. 2022-04-20 12:38:15.699273 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/11@156.0.249.118) State DESTROY going to sleep
  175. 2022-04-20 12:38:17.819281 [NOTICE] switch_channel.c:1104 New Channel sofia/internal/11@156.0.249.118 [dfd50d21-126d-4d54-9145-78e52a5a2cdb]
  176. 2022-04-20 12:38:17.819281 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_NEW (Cur 2 Tot 1560)
  177. 2022-04-20 12:38:17.819281 [DEBUG] sofia.c:9873 sofia/internal/11@156.0.249.118 receiving invite from 45.93.16.32:49608 version: 1.6.20 git 43a9feb 2018-05-07 18:56:11Z 64bit
  178. 2022-04-20 12:38:17.819281 [DEBUG] sofia.c:10044 IP 45.93.16.32 Rejected by acl "domains". Falling back to Digest auth.
  179. 2022-04-20 12:38:17.819281 [DEBUG] switch_core_state_machine.c:603 (sofia/internal/11@156.0.249.118) State NEW
  180. 2022-04-20 12:38:17.819281 [DEBUG] sofia.c:2334 detaching session dfd50d21-126d-4d54-9145-78e52a5a2cdb
  181. 2022-04-20 12:38:18.639253 [NOTICE] switch_channel.c:1104 New Channel sofia/external/08176416480@37.9.63.182:5060 [ff8a7151-8d7e-4054-b8a7-1fb5ff2ae201]
  182. 2022-04-20 12:38:18.639253 [DEBUG] switch_core_state_machine.c:584 (sofia/external/08176416480@37.9.63.182:5060) Running State Change CS_NEW (Cur 3 Tot 1561)
  183. 2022-04-20 12:38:18.639253 [DEBUG] sofia.c:9873 sofia/external/08176416480@37.9.63.182:5060 receiving invite from 37.9.63.182:5060 version: 1.6.20 git 43a9feb 2018-05-07 18:56:11Z 64bit
  184. 2022-04-20 12:38:18.639253 [DEBUG] sofia.c:7084 Channel sofia/external/08176416480@37.9.63.182:5060 entering state [received][100]
  185. 2022-04-20 12:38:18.639253 [DEBUG] sofia.c:7094 Remote SDP:
  186. v=0
  187. o=- 67801204 67801205 IN IP4 37.9.63.182
  188. s=VoipSIP
  189. c=IN IP4 37.9.63.182
  190. t=0 0
  191. m=audio 8754 RTP/AVP 0 8 18 116
  192. a=rtpmap:0 PCMU/8000
  193. a=rtpmap:8 PCMA/8000
  194. a=rtpmap:18 G729/8000/1
  195. a=fmtp:18 annexb=no
  196. a=rtpmap:116 telephone-event/8000
  197.  
  198. 2022-04-20 12:38:18.639253 [DEBUG] sofia.c:7486 (sofia/external/08176416480@37.9.63.182:5060) State Change CS_NEW -> CS_INIT
  199. 2022-04-20 12:38:18.639253 [DEBUG] switch_core_state_machine.c:603 (sofia/external/08176416480@37.9.63.182:5060) State NEW
  200. 2022-04-20 12:38:18.639253 [DEBUG] switch_core_state_machine.c:584 (sofia/external/08176416480@37.9.63.182:5060) Running State Change CS_INIT (Cur 3 Tot 1561)
  201. 2022-04-20 12:38:18.639253 [DEBUG] switch_core_state_machine.c:627 (sofia/external/08176416480@37.9.63.182:5060) State INIT
  202. 2022-04-20 12:38:18.639253 [DEBUG] mod_sofia.c:90 sofia/external/08176416480@37.9.63.182:5060 SOFIA INIT
  203. 2022-04-20 12:38:18.639253 [DEBUG] switch_core_state_machine.c:40 sofia/external/08176416480@37.9.63.182:5060 Standard INIT
  204. 2022-04-20 12:38:18.639253 [DEBUG] switch_core_state_machine.c:48 (sofia/external/08176416480@37.9.63.182:5060) State Change CS_INIT -> CS_ROUTING
  205. 2022-04-20 12:38:18.639253 [DEBUG] switch_core_state_machine.c:627 (sofia/external/08176416480@37.9.63.182:5060) State INIT going to sleep
  206. 2022-04-20 12:38:18.639253 [DEBUG] switch_core_state_machine.c:584 (sofia/external/08176416480@37.9.63.182:5060) Running State Change CS_ROUTING (Cur 3 Tot 1561)
  207. 2022-04-20 12:38:18.639253 [DEBUG] switch_channel.c:2249 (sofia/external/08176416480@37.9.63.182:5060) Callstate Change DOWN -> RINGING
  208. 2022-04-20 12:38:18.639253 [DEBUG] switch_core_state_machine.c:643 (sofia/external/08176416480@37.9.63.182:5060) State ROUTING
  209. 2022-04-20 12:38:18.639253 [DEBUG] mod_sofia.c:143 sofia/external/08176416480@37.9.63.182:5060 SOFIA ROUTING
  210. 2022-04-20 12:38:18.639253 [DEBUG] switch_core_state_machine.c:236 sofia/external/08176416480@37.9.63.182:5060 Standard ROUTING
  211. 2022-04-20 12:38:18.639253 [INFO] mod_dialplan_xml.c:637 Processing 08176416480 <08176416480>->connekt in context public
  212. Dialplan: sofia/external/08176416480@37.9.63.182:5060 parsing [public->unloop] continue=false
  213. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Regex (PASS) [unloop] ${unroll_loops}(true) =~ /^true$/ break=on-false
  214. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Regex (FAIL) [unloop] ${sip_looped_call}() =~ /^true$/ break=on-false
  215. Dialplan: sofia/external/08176416480@37.9.63.182:5060 parsing [public->outside_call] continue=true
  216. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Absolute Condition [outside_call]
  217. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Action set(outside_call=true)
  218. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Action export(RFC2822_DATE=${strftime(%a, %d %b %Y %T %z)})
  219. Dialplan: sofia/external/08176416480@37.9.63.182:5060 parsing [public->call_debug] continue=true
  220. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Regex (FAIL) [call_debug] ${call_debug}(false) =~ /^true$/ break=never
  221. Dialplan: sofia/external/08176416480@37.9.63.182:5060 parsing [public->public_extensions] continue=false
  222. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Regex (FAIL) [public_extensions] destination_number(connekt) =~ /^(10[01][0-9])$/ break=on-false
  223. Dialplan: sofia/external/08176416480@37.9.63.182:5060 parsing [public->public_did] continue=false
  224. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Regex (FAIL) [public_did] destination_number(connekt) =~ /^(5551212)$/ break=on-false
  225. Dialplan: sofia/external/08176416480@37.9.63.182:5060 parsing [public->mydid] continue=false
  226. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Regex (FAIL) [mydid] destination_number(connekt) =~ /^(018888325)$/ break=on-false
  227. 2022-04-20 12:38:18.659251 [DEBUG] switch_core_state_machine.c:286 (sofia/external/08176416480@37.9.63.182:5060) State Change CS_ROUTING -> CS_EXECUTE
  228. 2022-04-20 12:38:18.659251 [DEBUG] switch_core_state_machine.c:643 (sofia/external/08176416480@37.9.63.182:5060) State ROUTING going to sleep
  229. 2022-04-20 12:38:18.659251 [DEBUG] switch_core_state_machine.c:584 (sofia/external/08176416480@37.9.63.182:5060) Running State Change CS_EXECUTE (Cur 3 Tot 1561)
  230. 2022-04-20 12:38:18.659251 [DEBUG] switch_core_state_machine.c:650 (sofia/external/08176416480@37.9.63.182:5060) State EXECUTE
  231. 2022-04-20 12:38:18.659251 [DEBUG] mod_sofia.c:198 sofia/external/08176416480@37.9.63.182:5060 SOFIA EXECUTE
  232. 2022-04-20 12:38:18.659251 [DEBUG] switch_core_state_machine.c:328 sofia/external/08176416480@37.9.63.182:5060 Standard EXECUTE
  233. EXECUTE sofia/external/08176416480@37.9.63.182:5060 set(outside_call=true)
  234. 2022-04-20 12:38:18.659251 [DEBUG] mod_dptools.c:1548 SET sofia/external/08176416480@37.9.63.182:5060 [outside_call]=[true]
  235. EXECUTE sofia/external/08176416480@37.9.63.182:5060 export(RFC2822_DATE=Wed, 20 Apr 2022 12:38:18 +0100)
  236. 2022-04-20 12:38:18.659251 [DEBUG] switch_channel.c:1296 EXPORT (export_vars) [RFC2822_DATE]=[Wed, 20 Apr 2022 12:38:18 +0100]
  237. 2022-04-20 12:38:18.659251 [NOTICE] switch_core_state_machine.c:385 sofia/external/08176416480@37.9.63.182:5060 has executed the last dialplan instruction, hanging up.
  238. 2022-04-20 12:38:18.659251 [NOTICE] switch_core_state_machine.c:387 Hangup sofia/external/08176416480@37.9.63.182:5060 [CS_EXECUTE] [NORMAL_CLEARING]
  239. 2022-04-20 12:38:18.659251 [DEBUG] switch_core_state_machine.c:650 (sofia/external/08176416480@37.9.63.182:5060) State EXECUTE going to sleep
  240. 2022-04-20 12:38:18.659251 [DEBUG] switch_core_state_machine.c:584 (sofia/external/08176416480@37.9.63.182:5060) Running State Change CS_HANGUP (Cur 3 Tot 1561)
  241. 2022-04-20 12:38:18.659251 [DEBUG] switch_core_state_machine.c:850 (sofia/external/08176416480@37.9.63.182:5060) Callstate Change RINGING -> HANGUP
  242. 2022-04-20 12:38:18.659251 [DEBUG] switch_core_state_machine.c:852 (sofia/external/08176416480@37.9.63.182:5060) State HANGUP
  243. 2022-04-20 12:38:18.659251 [DEBUG] mod_sofia.c:438 Channel sofia/external/08176416480@37.9.63.182:5060 hanging up, cause: NORMAL_CLEARING
  244. 2022-04-20 12:38:18.659251 [DEBUG] mod_sofia.c:577 Responding to INVITE with: 480
  245. 2022-04-20 12:38:18.659251 [DEBUG] switch_core_state_machine.c:60 sofia/external/08176416480@37.9.63.182:5060 Standard HANGUP, cause: NORMAL_CLEARING
  246. 2022-04-20 12:38:18.659251 [DEBUG] switch_core_state_machine.c:852 (sofia/external/08176416480@37.9.63.182:5060) State HANGUP going to sleep
  247. 2022-04-20 12:38:18.659251 [DEBUG] switch_core_state_machine.c:619 (sofia/external/08176416480@37.9.63.182:5060) State Change CS_HANGUP -> CS_REPORTING
  248. 2022-04-20 12:38:18.659251 [DEBUG] switch_core_state_machine.c:584 (sofia/external/08176416480@37.9.63.182:5060) Running State Change CS_REPORTING (Cur 3 Tot 1561)
  249. 2022-04-20 12:38:18.659251 [DEBUG] switch_core_state_machine.c:938 (sofia/external/08176416480@37.9.63.182:5060) State REPORTING
  250. 2022-04-20 12:38:18.659251 [DEBUG] switch_core_state_machine.c:174 sofia/external/08176416480@37.9.63.182:5060 Standard REPORTING, cause: NORMAL_CLEARING
  251. 2022-04-20 12:38:18.659251 [DEBUG] switch_core_state_machine.c:938 (sofia/external/08176416480@37.9.63.182:5060) State REPORTING going to sleep
  252. 2022-04-20 12:38:18.659251 [DEBUG] switch_core_state_machine.c:610 (sofia/external/08176416480@37.9.63.182:5060) State Change CS_REPORTING -> CS_DESTROY
  253. 2022-04-20 12:38:18.659251 [DEBUG] switch_core_session.c:1665 Session 1561 (sofia/external/08176416480@37.9.63.182:5060) Locked, Waiting on external entities
  254. 2022-04-20 12:38:18.659251 [NOTICE] switch_core_session.c:1683 Session 1561 (sofia/external/08176416480@37.9.63.182:5060) Ended
  255. 2022-04-20 12:38:18.659251 [NOTICE] switch_core_session.c:1687 Close Channel sofia/external/08176416480@37.9.63.182:5060 [CS_DESTROY]
  256. 2022-04-20 12:38:18.659251 [DEBUG] switch_core_state_machine.c:741 (sofia/external/08176416480@37.9.63.182:5060) Running State Change CS_DESTROY (Cur 2 Tot 1561)
  257. 2022-04-20 12:38:18.659251 [DEBUG] switch_core_state_machine.c:751 (sofia/external/08176416480@37.9.63.182:5060) State DESTROY
  258. 2022-04-20 12:38:18.659251 [DEBUG] mod_sofia.c:343 sofia/external/08176416480@37.9.63.182:5060 SOFIA DESTROY
  259. 2022-04-20 12:38:18.659251 [DEBUG] switch_core_state_machine.c:181 sofia/external/08176416480@37.9.63.182:5060 Standard DESTROY
  260. 2022-04-20 12:38:18.659251 [DEBUG] switch_core_state_machine.c:751 (sofia/external/08176416480@37.9.63.182:5060) State DESTROY going to sleep
  261. 2022-04-20 12:38:22.059263 [WARNING] switch_core_state_machine.c:687 c8d90229-ace2-4505-8281-2081282592f1 sofia/internal/11@156.0.249.118 Abandoned
  262. 2022-04-20 12:38:22.059263 [NOTICE] switch_core_state_machine.c:690 Hangup sofia/internal/11@156.0.249.118 [CS_NEW] [WRONG_CALL_STATE]
  263. 2022-04-20 12:38:22.059263 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_HANGUP (Cur 2 Tot 1561)
  264. 2022-04-20 12:38:22.059263 [DEBUG] switch_core_state_machine.c:850 (sofia/internal/11@156.0.249.118) Callstate Change DOWN -> HANGUP
  265. 2022-04-20 12:38:22.059263 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/11@156.0.249.118) State HANGUP
  266. 2022-04-20 12:38:22.059263 [DEBUG] mod_sofia.c:438 Channel sofia/internal/11@156.0.249.118 hanging up, cause: WRONG_CALL_STATE
  267. 2022-04-20 12:38:22.059263 [DEBUG] switch_core_state_machine.c:60 sofia/internal/11@156.0.249.118 Standard HANGUP, cause: WRONG_CALL_STATE
  268. 2022-04-20 12:38:22.059263 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/11@156.0.249.118) State HANGUP going to sleep
  269. 2022-04-20 12:38:22.059263 [DEBUG] switch_core_state_machine.c:619 (sofia/internal/11@156.0.249.118) State Change CS_HANGUP -> CS_REPORTING
  270. 2022-04-20 12:38:22.059263 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_REPORTING (Cur 2 Tot 1561)
  271. 2022-04-20 12:38:22.059263 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/11@156.0.249.118) State REPORTING
  272. 2022-04-20 12:38:22.059263 [DEBUG] switch_core_state_machine.c:174 sofia/internal/11@156.0.249.118 Standard REPORTING, cause: WRONG_CALL_STATE
  273. 2022-04-20 12:38:22.059263 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/11@156.0.249.118) State REPORTING going to sleep
  274. 2022-04-20 12:38:22.059263 [DEBUG] switch_core_state_machine.c:610 (sofia/internal/11@156.0.249.118) State Change CS_REPORTING -> CS_DESTROY
  275. 2022-04-20 12:38:22.059263 [DEBUG] switch_core_session.c:1665 Session 1559 (sofia/internal/11@156.0.249.118) Locked, Waiting on external entities
  276. 2022-04-20 12:38:22.059263 [NOTICE] switch_core_session.c:1683 Session 1559 (sofia/internal/11@156.0.249.118) Ended
  277. 2022-04-20 12:38:22.059263 [NOTICE] switch_core_session.c:1687 Close Channel sofia/internal/11@156.0.249.118 [CS_DESTROY]
  278. 2022-04-20 12:38:22.059263 [DEBUG] switch_core_state_machine.c:741 (sofia/internal/11@156.0.249.118) Running State Change CS_DESTROY (Cur 1 Tot 1561)
  279. 2022-04-20 12:38:22.059263 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/11@156.0.249.118) State DESTROY
  280. 2022-04-20 12:38:22.059263 [DEBUG] mod_sofia.c:343 sofia/internal/11@156.0.249.118 SOFIA DESTROY
  281. 2022-04-20 12:38:22.059263 [DEBUG] switch_core_state_machine.c:181 sofia/internal/11@156.0.249.118 Standard DESTROY
  282. 2022-04-20 12:38:22.059263 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/11@156.0.249.118) State DESTROY going to sleep
  283. 2022-04-20 12:38:24.159266 [NOTICE] switch_channel.c:1104 New Channel sofia/internal/11@156.0.249.118 [936a037a-63ce-47e9-b5aa-4361c20bee69]
  284. 2022-04-20 12:38:24.159266 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_NEW (Cur 2 Tot 1562)
  285. 2022-04-20 12:38:24.159266 [DEBUG] sofia.c:9873 sofia/internal/11@156.0.249.118 receiving invite from 45.93.16.32:61754 version: 1.6.20 git 43a9feb 2018-05-07 18:56:11Z 64bit
  286. 2022-04-20 12:38:24.159266 [DEBUG] sofia.c:10044 IP 45.93.16.32 Rejected by acl "domains". Falling back to Digest auth.
  287. 2022-04-20 12:38:24.159266 [DEBUG] sofia.c:2334 detaching session 936a037a-63ce-47e9-b5aa-4361c20bee69
  288. 2022-04-20 12:38:24.159266 [DEBUG] switch_core_state_machine.c:603 (sofia/internal/11@156.0.249.118) State NEW
  289. 2022-04-20 12:38:25.099308 [DEBUG] mod_verto.c:4139 45.137.23.207:42696 Client Connect from 45.137.23.207:42696 accepted
  290. 2022-04-20 12:38:25.099308 [DEBUG] mod_verto.c:1992 45.137.23.207:42696 Starting client thread.
  291. 2022-04-20 12:38:25.099308 [DEBUG] mod_verto.c:1839 45.137.23.207:42696 WS SETUP FAILED
  292. 2022-04-20 12:38:25.099308 [DEBUG] mod_verto.c:2019 45.137.23.207:42696 Ending client thread.
  293. 2022-04-20 12:38:25.099308 [DEBUG] mod_verto.c:2027 45.137.23.207:42696 Thread ended
  294. 2022-04-20 12:38:27.839268 [WARNING] switch_core_state_machine.c:687 dfd50d21-126d-4d54-9145-78e52a5a2cdb sofia/internal/11@156.0.249.118 Abandoned
  295. 2022-04-20 12:38:27.839268 [NOTICE] switch_core_state_machine.c:690 Hangup sofia/internal/11@156.0.249.118 [CS_NEW] [WRONG_CALL_STATE]
  296. 2022-04-20 12:38:27.839268 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_HANGUP (Cur 2 Tot 1562)
  297. 2022-04-20 12:38:27.839268 [DEBUG] switch_core_state_machine.c:850 (sofia/internal/11@156.0.249.118) Callstate Change DOWN -> HANGUP
  298. 2022-04-20 12:38:27.839268 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/11@156.0.249.118) State HANGUP
  299. 2022-04-20 12:38:27.839268 [DEBUG] mod_sofia.c:438 Channel sofia/internal/11@156.0.249.118 hanging up, cause: WRONG_CALL_STATE
  300. 2022-04-20 12:38:27.859251 [DEBUG] switch_core_state_machine.c:60 sofia/internal/11@156.0.249.118 Standard HANGUP, cause: WRONG_CALL_STATE
  301. 2022-04-20 12:38:27.859251 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/11@156.0.249.118) State HANGUP going to sleep
  302. 2022-04-20 12:38:27.859251 [DEBUG] switch_core_state_machine.c:619 (sofia/internal/11@156.0.249.118) State Change CS_HANGUP -> CS_REPORTING
  303. 2022-04-20 12:38:27.859251 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_REPORTING (Cur 2 Tot 1562)
  304. 2022-04-20 12:38:27.859251 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/11@156.0.249.118) State REPORTING
  305. 2022-04-20 12:38:27.859251 [DEBUG] switch_core_state_machine.c:174 sofia/internal/11@156.0.249.118 Standard REPORTING, cause: WRONG_CALL_STATE
  306. 2022-04-20 12:38:27.859251 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/11@156.0.249.118) State REPORTING going to sleep
  307. 2022-04-20 12:38:27.859251 [DEBUG] switch_core_state_machine.c:610 (sofia/internal/11@156.0.249.118) State Change CS_REPORTING -> CS_DESTROY
  308. 2022-04-20 12:38:27.859251 [DEBUG] switch_core_session.c:1665 Session 1560 (sofia/internal/11@156.0.249.118) Locked, Waiting on external entities
  309. 2022-04-20 12:38:27.859251 [NOTICE] switch_core_session.c:1683 Session 1560 (sofia/internal/11@156.0.249.118) Ended
  310. 2022-04-20 12:38:27.859251 [NOTICE] switch_core_session.c:1687 Close Channel sofia/internal/11@156.0.249.118 [CS_DESTROY]
  311. 2022-04-20 12:38:27.859251 [DEBUG] switch_core_state_machine.c:741 (sofia/internal/11@156.0.249.118) Running State Change CS_DESTROY (Cur 1 Tot 1562)
  312. 2022-04-20 12:38:27.859251 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/11@156.0.249.118) State DESTROY
  313. 2022-04-20 12:38:27.859251 [DEBUG] mod_sofia.c:343 sofia/internal/11@156.0.249.118 SOFIA DESTROY
  314. 2022-04-20 12:38:27.859251 [DEBUG] switch_core_state_machine.c:181 sofia/internal/11@156.0.249.118 Standard DESTROY
  315. 2022-04-20 12:38:27.859251 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/11@156.0.249.118) State DESTROY going to sleep
  316. 2022-04-20 12:38:29.659278 [NOTICE] switch_channel.c:1104 New Channel sofia/internal/11@156.0.249.118 [2d31c75a-31d5-4917-90ba-073e399aa982]
  317. 2022-04-20 12:38:29.659278 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_NEW (Cur 2 Tot 1563)
  318. 2022-04-20 12:38:29.659278 [DEBUG] sofia.c:9873 sofia/internal/11@156.0.249.118 receiving invite from 45.93.16.32:56194 version: 1.6.20 git 43a9feb 2018-05-07 18:56:11Z 64bit
  319. 2022-04-20 12:38:29.659278 [DEBUG] sofia.c:10044 IP 45.93.16.32 Rejected by acl "domains". Falling back to Digest auth.
  320. 2022-04-20 12:38:29.659278 [DEBUG] switch_core_state_machine.c:603 (sofia/internal/11@156.0.249.118) State NEW
  321. 2022-04-20 12:38:29.659278 [DEBUG] sofia.c:2334 detaching session 2d31c75a-31d5-4917-90ba-073e399aa982
  322. 2022-04-20 12:38:30.299280 [NOTICE] switch_channel.c:1104 New Channel sofia/internal/1201@156.0.249.118 [cfc79497-4387-4cd0-8220-0c2e45977c6c]
  323. 2022-04-20 12:38:30.299280 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/1201@156.0.249.118) Running State Change CS_NEW (Cur 3 Tot 1564)
  324. 2022-04-20 12:38:30.299280 [DEBUG] sofia.c:9873 sofia/internal/1201@156.0.249.118 receiving invite from 45.93.16.45:53176 version: 1.6.20 git 43a9feb 2018-05-07 18:56:11Z 64bit
  325. 2022-04-20 12:38:30.299280 [DEBUG] sofia.c:10044 IP 45.93.16.45 Rejected by acl "domains". Falling back to Digest auth.
  326. 2022-04-20 12:38:30.299280 [DEBUG] switch_core_state_machine.c:603 (sofia/internal/1201@156.0.249.118) State NEW
  327. 2022-04-20 12:38:30.299280 [DEBUG] sofia.c:2334 detaching session cfc79497-4387-4cd0-8220-0c2e45977c6c
  328. 2022-04-20 12:38:31.519246 [NOTICE] switch_channel.c:1104 New Channel sofia/external/08176416480@37.9.63.182:5060 [26ef3a4f-b66e-421d-bc29-7c4dae852458]
  329. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:584 (sofia/external/08176416480@37.9.63.182:5060) Running State Change CS_NEW (Cur 4 Tot 1565)
  330. 2022-04-20 12:38:31.519246 [DEBUG] sofia.c:9873 sofia/external/08176416480@37.9.63.182:5060 receiving invite from 37.9.63.182:5060 version: 1.6.20 git 43a9feb 2018-05-07 18:56:11Z 64bit
  331. 2022-04-20 12:38:31.519246 [DEBUG] sofia.c:7084 Channel sofia/external/08176416480@37.9.63.182:5060 entering state [received][100]
  332. 2022-04-20 12:38:31.519246 [DEBUG] sofia.c:7094 Remote SDP:
  333. v=0
  334. o=- 4087344135 4087344136 IN IP4 37.9.63.182
  335. s=VoipSIP
  336. c=IN IP4 37.9.63.182
  337. t=0 0
  338. m=audio 10752 RTP/AVP 0 8 18 116
  339. a=rtpmap:0 PCMU/8000
  340. a=rtpmap:8 PCMA/8000
  341. a=rtpmap:18 G729/8000/1
  342. a=fmtp:18 annexb=no
  343. a=rtpmap:116 telephone-event/8000
  344.  
  345. 2022-04-20 12:38:31.519246 [DEBUG] sofia.c:7486 (sofia/external/08176416480@37.9.63.182:5060) State Change CS_NEW -> CS_INIT
  346. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:603 (sofia/external/08176416480@37.9.63.182:5060) State NEW
  347. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:584 (sofia/external/08176416480@37.9.63.182:5060) Running State Change CS_INIT (Cur 4 Tot 1565)
  348. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:627 (sofia/external/08176416480@37.9.63.182:5060) State INIT
  349. 2022-04-20 12:38:31.519246 [DEBUG] mod_sofia.c:90 sofia/external/08176416480@37.9.63.182:5060 SOFIA INIT
  350. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:40 sofia/external/08176416480@37.9.63.182:5060 Standard INIT
  351. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:48 (sofia/external/08176416480@37.9.63.182:5060) State Change CS_INIT -> CS_ROUTING
  352. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:627 (sofia/external/08176416480@37.9.63.182:5060) State INIT going to sleep
  353. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:584 (sofia/external/08176416480@37.9.63.182:5060) Running State Change CS_ROUTING (Cur 4 Tot 1565)
  354. 2022-04-20 12:38:31.519246 [DEBUG] switch_channel.c:2249 (sofia/external/08176416480@37.9.63.182:5060) Callstate Change DOWN -> RINGING
  355. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:643 (sofia/external/08176416480@37.9.63.182:5060) State ROUTING
  356. 2022-04-20 12:38:31.519246 [DEBUG] mod_sofia.c:143 sofia/external/08176416480@37.9.63.182:5060 SOFIA ROUTING
  357. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:236 sofia/external/08176416480@37.9.63.182:5060 Standard ROUTING
  358. 2022-04-20 12:38:31.519246 [INFO] mod_dialplan_xml.c:637 Processing 08176416480 <08176416480>->connekt in context public
  359. Dialplan: sofia/external/08176416480@37.9.63.182:5060 parsing [public->unloop] continue=false
  360. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Regex (PASS) [unloop] ${unroll_loops}(true) =~ /^true$/ break=on-false
  361. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Regex (FAIL) [unloop] ${sip_looped_call}() =~ /^true$/ break=on-false
  362. Dialplan: sofia/external/08176416480@37.9.63.182:5060 parsing [public->outside_call] continue=true
  363. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Absolute Condition [outside_call]
  364. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Action set(outside_call=true)
  365. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Action export(RFC2822_DATE=${strftime(%a, %d %b %Y %T %z)})
  366. Dialplan: sofia/external/08176416480@37.9.63.182:5060 parsing [public->call_debug] continue=true
  367. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Regex (FAIL) [call_debug] ${call_debug}(false) =~ /^true$/ break=never
  368. Dialplan: sofia/external/08176416480@37.9.63.182:5060 parsing [public->public_extensions] continue=false
  369. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Regex (FAIL) [public_extensions] destination_number(connekt) =~ /^(10[01][0-9])$/ break=on-false
  370. Dialplan: sofia/external/08176416480@37.9.63.182:5060 parsing [public->public_did] continue=false
  371. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Regex (FAIL) [public_did] destination_number(connekt) =~ /^(5551212)$/ break=on-false
  372. Dialplan: sofia/external/08176416480@37.9.63.182:5060 parsing [public->mydid] continue=false
  373. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Regex (FAIL) [mydid] destination_number(connekt) =~ /^(018888325)$/ break=on-false
  374. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:286 (sofia/external/08176416480@37.9.63.182:5060) State Change CS_ROUTING -> CS_EXECUTE
  375. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:643 (sofia/external/08176416480@37.9.63.182:5060) State ROUTING going to sleep
  376. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:584 (sofia/external/08176416480@37.9.63.182:5060) Running State Change CS_EXECUTE (Cur 4 Tot 1565)
  377. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:650 (sofia/external/08176416480@37.9.63.182:5060) State EXECUTE
  378. 2022-04-20 12:38:31.519246 [DEBUG] mod_sofia.c:198 sofia/external/08176416480@37.9.63.182:5060 SOFIA EXECUTE
  379. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:328 sofia/external/08176416480@37.9.63.182:5060 Standard EXECUTE
  380. EXECUTE sofia/external/08176416480@37.9.63.182:5060 set(outside_call=true)
  381. 2022-04-20 12:38:31.519246 [DEBUG] mod_dptools.c:1548 SET sofia/external/08176416480@37.9.63.182:5060 [outside_call]=[true]
  382. EXECUTE sofia/external/08176416480@37.9.63.182:5060 export(RFC2822_DATE=Wed, 20 Apr 2022 12:38:31 +0100)
  383. 2022-04-20 12:38:31.519246 [DEBUG] switch_channel.c:1296 EXPORT (export_vars) [RFC2822_DATE]=[Wed, 20 Apr 2022 12:38:31 +0100]
  384. 2022-04-20 12:38:31.519246 [NOTICE] switch_core_state_machine.c:385 sofia/external/08176416480@37.9.63.182:5060 has executed the last dialplan instruction, hanging up.
  385. 2022-04-20 12:38:31.519246 [NOTICE] switch_core_state_machine.c:387 Hangup sofia/external/08176416480@37.9.63.182:5060 [CS_EXECUTE] [NORMAL_CLEARING]
  386. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:650 (sofia/external/08176416480@37.9.63.182:5060) State EXECUTE going to sleep
  387. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:584 (sofia/external/08176416480@37.9.63.182:5060) Running State Change CS_HANGUP (Cur 4 Tot 1565)
  388. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:850 (sofia/external/08176416480@37.9.63.182:5060) Callstate Change RINGING -> HANGUP
  389. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:852 (sofia/external/08176416480@37.9.63.182:5060) State HANGUP
  390. 2022-04-20 12:38:31.519246 [DEBUG] mod_sofia.c:438 Channel sofia/external/08176416480@37.9.63.182:5060 hanging up, cause: NORMAL_CLEARING
  391. 2022-04-20 12:38:31.519246 [DEBUG] mod_sofia.c:577 Responding to INVITE with: 480
  392. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:60 sofia/external/08176416480@37.9.63.182:5060 Standard HANGUP, cause: NORMAL_CLEARING
  393. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:852 (sofia/external/08176416480@37.9.63.182:5060) State HANGUP going to sleep
  394. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:619 (sofia/external/08176416480@37.9.63.182:5060) State Change CS_HANGUP -> CS_REPORTING
  395. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:584 (sofia/external/08176416480@37.9.63.182:5060) Running State Change CS_REPORTING (Cur 4 Tot 1565)
  396. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:938 (sofia/external/08176416480@37.9.63.182:5060) State REPORTING
  397. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:174 sofia/external/08176416480@37.9.63.182:5060 Standard REPORTING, cause: NORMAL_CLEARING
  398. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:938 (sofia/external/08176416480@37.9.63.182:5060) State REPORTING going to sleep
  399. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:610 (sofia/external/08176416480@37.9.63.182:5060) State Change CS_REPORTING -> CS_DESTROY
  400. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_session.c:1665 Session 1565 (sofia/external/08176416480@37.9.63.182:5060) Locked, Waiting on external entities
  401. 2022-04-20 12:38:31.519246 [NOTICE] switch_core_session.c:1683 Session 1565 (sofia/external/08176416480@37.9.63.182:5060) Ended
  402. 2022-04-20 12:38:31.519246 [NOTICE] switch_core_session.c:1687 Close Channel sofia/external/08176416480@37.9.63.182:5060 [CS_DESTROY]
  403. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:741 (sofia/external/08176416480@37.9.63.182:5060) Running State Change CS_DESTROY (Cur 3 Tot 1565)
  404. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:751 (sofia/external/08176416480@37.9.63.182:5060) State DESTROY
  405. 2022-04-20 12:38:31.519246 [DEBUG] mod_sofia.c:343 sofia/external/08176416480@37.9.63.182:5060 SOFIA DESTROY
  406. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:181 sofia/external/08176416480@37.9.63.182:5060 Standard DESTROY
  407. 2022-04-20 12:38:31.519246 [DEBUG] switch_core_state_machine.c:751 (sofia/external/08176416480@37.9.63.182:5060) State DESTROY going to sleep
  408. 2022-04-20 12:38:34.199258 [WARNING] switch_core_state_machine.c:687 936a037a-63ce-47e9-b5aa-4361c20bee69 sofia/internal/11@156.0.249.118 Abandoned
  409. 2022-04-20 12:38:34.199258 [NOTICE] switch_core_state_machine.c:690 Hangup sofia/internal/11@156.0.249.118 [CS_NEW] [WRONG_CALL_STATE]
  410. 2022-04-20 12:38:34.199258 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_HANGUP (Cur 3 Tot 1565)
  411. 2022-04-20 12:38:34.199258 [DEBUG] switch_core_state_machine.c:850 (sofia/internal/11@156.0.249.118) Callstate Change DOWN -> HANGUP
  412. 2022-04-20 12:38:34.199258 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/11@156.0.249.118) State HANGUP
  413. 2022-04-20 12:38:34.199258 [DEBUG] mod_sofia.c:438 Channel sofia/internal/11@156.0.249.118 hanging up, cause: WRONG_CALL_STATE
  414. 2022-04-20 12:38:34.199258 [DEBUG] switch_core_state_machine.c:60 sofia/internal/11@156.0.249.118 Standard HANGUP, cause: WRONG_CALL_STATE
  415. 2022-04-20 12:38:34.199258 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/11@156.0.249.118) State HANGUP going to sleep
  416. 2022-04-20 12:38:34.199258 [DEBUG] switch_core_state_machine.c:619 (sofia/internal/11@156.0.249.118) State Change CS_HANGUP -> CS_REPORTING
  417. 2022-04-20 12:38:34.199258 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_REPORTING (Cur 3 Tot 1565)
  418. 2022-04-20 12:38:34.199258 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/11@156.0.249.118) State REPORTING
  419. 2022-04-20 12:38:34.199258 [DEBUG] switch_core_state_machine.c:174 sofia/internal/11@156.0.249.118 Standard REPORTING, cause: WRONG_CALL_STATE
  420. 2022-04-20 12:38:34.199258 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/11@156.0.249.118) State REPORTING going to sleep
  421. 2022-04-20 12:38:34.199258 [DEBUG] switch_core_state_machine.c:610 (sofia/internal/11@156.0.249.118) State Change CS_REPORTING -> CS_DESTROY
  422. 2022-04-20 12:38:34.199258 [DEBUG] switch_core_session.c:1665 Session 1562 (sofia/internal/11@156.0.249.118) Locked, Waiting on external entities
  423. 2022-04-20 12:38:34.199258 [NOTICE] switch_core_session.c:1683 Session 1562 (sofia/internal/11@156.0.249.118) Ended
  424. 2022-04-20 12:38:34.199258 [NOTICE] switch_core_session.c:1687 Close Channel sofia/internal/11@156.0.249.118 [CS_DESTROY]
  425. 2022-04-20 12:38:34.199258 [DEBUG] switch_core_state_machine.c:741 (sofia/internal/11@156.0.249.118) Running State Change CS_DESTROY (Cur 2 Tot 1565)
  426. 2022-04-20 12:38:34.199258 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/11@156.0.249.118) State DESTROY
  427. 2022-04-20 12:38:34.199258 [DEBUG] mod_sofia.c:343 sofia/internal/11@156.0.249.118 SOFIA DESTROY
  428. 2022-04-20 12:38:34.199258 [DEBUG] switch_core_state_machine.c:181 sofia/internal/11@156.0.249.118 Standard DESTROY
  429. 2022-04-20 12:38:34.199258 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/11@156.0.249.118) State DESTROY going to sleep
  430. 2022-04-20 12:38:36.239265 [NOTICE] switch_channel.c:1104 New Channel sofia/internal/11@156.0.249.118 [750e2bee-fec9-4d74-9780-43b963ddcd76]
  431. 2022-04-20 12:38:36.239265 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_NEW (Cur 3 Tot 1566)
  432. 2022-04-20 12:38:36.239265 [DEBUG] sofia.c:9873 sofia/internal/11@156.0.249.118 receiving invite from 45.93.16.32:52161 version: 1.6.20 git 43a9feb 2018-05-07 18:56:11Z 64bit
  433. 2022-04-20 12:38:36.239265 [DEBUG] sofia.c:10044 IP 45.93.16.32 Rejected by acl "domains". Falling back to Digest auth.
  434. 2022-04-20 12:38:36.239265 [DEBUG] switch_core_state_machine.c:603 (sofia/internal/11@156.0.249.118) State NEW
  435. 2022-04-20 12:38:36.239265 [DEBUG] sofia.c:2334 detaching session 750e2bee-fec9-4d74-9780-43b963ddcd76
  436. 2022-04-20 12:38:38.279253 [NOTICE] switch_channel.c:1104 New Channel sofia/external/08176416480@37.9.63.182:5060 [ed90d8df-0797-426c-af9e-32989f941696]
  437. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:584 (sofia/external/08176416480@37.9.63.182:5060) Running State Change CS_NEW (Cur 4 Tot 1567)
  438. 2022-04-20 12:38:38.279253 [DEBUG] sofia.c:9873 sofia/external/08176416480@37.9.63.182:5060 receiving invite from 37.9.63.182:5060 version: 1.6.20 git 43a9feb 2018-05-07 18:56:11Z 64bit
  439. 2022-04-20 12:38:38.279253 [DEBUG] sofia.c:7084 Channel sofia/external/08176416480@37.9.63.182:5060 entering state [received][100]
  440. 2022-04-20 12:38:38.279253 [DEBUG] sofia.c:7094 Remote SDP:
  441. v=0
  442. o=- 4213178293 4213178294 IN IP4 37.9.63.182
  443. s=VoipSIP
  444. c=IN IP4 37.9.63.182
  445. t=0 0
  446. m=audio 9290 RTP/AVP 0 8 18 116
  447. a=rtpmap:0 PCMU/8000
  448. a=rtpmap:8 PCMA/8000
  449. a=rtpmap:18 G729/8000/1
  450. a=fmtp:18 annexb=no
  451. a=rtpmap:116 telephone-event/8000
  452.  
  453. 2022-04-20 12:38:38.279253 [DEBUG] sofia.c:7486 (sofia/external/08176416480@37.9.63.182:5060) State Change CS_NEW -> CS_INIT
  454. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:603 (sofia/external/08176416480@37.9.63.182:5060) State NEW
  455. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:584 (sofia/external/08176416480@37.9.63.182:5060) Running State Change CS_INIT (Cur 4 Tot 1567)
  456. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:627 (sofia/external/08176416480@37.9.63.182:5060) State INIT
  457. 2022-04-20 12:38:38.279253 [DEBUG] mod_sofia.c:90 sofia/external/08176416480@37.9.63.182:5060 SOFIA INIT
  458. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:40 sofia/external/08176416480@37.9.63.182:5060 Standard INIT
  459. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:48 (sofia/external/08176416480@37.9.63.182:5060) State Change CS_INIT -> CS_ROUTING
  460. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:627 (sofia/external/08176416480@37.9.63.182:5060) State INIT going to sleep
  461. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:584 (sofia/external/08176416480@37.9.63.182:5060) Running State Change CS_ROUTING (Cur 4 Tot 1567)
  462. 2022-04-20 12:38:38.279253 [DEBUG] switch_channel.c:2249 (sofia/external/08176416480@37.9.63.182:5060) Callstate Change DOWN -> RINGING
  463. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:643 (sofia/external/08176416480@37.9.63.182:5060) State ROUTING
  464. 2022-04-20 12:38:38.279253 [DEBUG] mod_sofia.c:143 sofia/external/08176416480@37.9.63.182:5060 SOFIA ROUTING
  465. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:236 sofia/external/08176416480@37.9.63.182:5060 Standard ROUTING
  466. 2022-04-20 12:38:38.279253 [INFO] mod_dialplan_xml.c:637 Processing 08176416480 <08176416480>->connekt in context public
  467. Dialplan: sofia/external/08176416480@37.9.63.182:5060 parsing [public->unloop] continue=false
  468. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Regex (PASS) [unloop] ${unroll_loops}(true) =~ /^true$/ break=on-false
  469. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Regex (FAIL) [unloop] ${sip_looped_call}() =~ /^true$/ break=on-false
  470. Dialplan: sofia/external/08176416480@37.9.63.182:5060 parsing [public->outside_call] continue=true
  471. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Absolute Condition [outside_call]
  472. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Action set(outside_call=true)
  473. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Action export(RFC2822_DATE=${strftime(%a, %d %b %Y %T %z)})
  474. Dialplan: sofia/external/08176416480@37.9.63.182:5060 parsing [public->call_debug] continue=true
  475. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Regex (FAIL) [call_debug] ${call_debug}(false) =~ /^true$/ break=never
  476. Dialplan: sofia/external/08176416480@37.9.63.182:5060 parsing [public->public_extensions] continue=false
  477. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Regex (FAIL) [public_extensions] destination_number(connekt) =~ /^(10[01][0-9])$/ break=on-false
  478. Dialplan: sofia/external/08176416480@37.9.63.182:5060 parsing [public->public_did] continue=false
  479. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Regex (FAIL) [public_did] destination_number(connekt) =~ /^(5551212)$/ break=on-false
  480. Dialplan: sofia/external/08176416480@37.9.63.182:5060 parsing [public->mydid] continue=false
  481. Dialplan: sofia/external/08176416480@37.9.63.182:5060 Regex (FAIL) [mydid] destination_number(connekt) =~ /^(018888325)$/ break=on-false
  482. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:286 (sofia/external/08176416480@37.9.63.182:5060) State Change CS_ROUTING -> CS_EXECUTE
  483. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:643 (sofia/external/08176416480@37.9.63.182:5060) State ROUTING going to sleep
  484. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:584 (sofia/external/08176416480@37.9.63.182:5060) Running State Change CS_EXECUTE (Cur 4 Tot 1567)
  485. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:650 (sofia/external/08176416480@37.9.63.182:5060) State EXECUTE
  486. 2022-04-20 12:38:38.279253 [DEBUG] mod_sofia.c:198 sofia/external/08176416480@37.9.63.182:5060 SOFIA EXECUTE
  487. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:328 sofia/external/08176416480@37.9.63.182:5060 Standard EXECUTE
  488. EXECUTE sofia/external/08176416480@37.9.63.182:5060 set(outside_call=true)
  489. 2022-04-20 12:38:38.279253 [DEBUG] mod_dptools.c:1548 SET sofia/external/08176416480@37.9.63.182:5060 [outside_call]=[true]
  490. EXECUTE sofia/external/08176416480@37.9.63.182:5060 export(RFC2822_DATE=Wed, 20 Apr 2022 12:38:38 +0100)
  491. 2022-04-20 12:38:38.279253 [DEBUG] switch_channel.c:1296 EXPORT (export_vars) [RFC2822_DATE]=[Wed, 20 Apr 2022 12:38:38 +0100]
  492. 2022-04-20 12:38:38.279253 [NOTICE] switch_core_state_machine.c:385 sofia/external/08176416480@37.9.63.182:5060 has executed the last dialplan instruction, hanging up.
  493. 2022-04-20 12:38:38.279253 [NOTICE] switch_core_state_machine.c:387 Hangup sofia/external/08176416480@37.9.63.182:5060 [CS_EXECUTE] [NORMAL_CLEARING]
  494. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:650 (sofia/external/08176416480@37.9.63.182:5060) State EXECUTE going to sleep
  495. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:584 (sofia/external/08176416480@37.9.63.182:5060) Running State Change CS_HANGUP (Cur 4 Tot 1567)
  496. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:850 (sofia/external/08176416480@37.9.63.182:5060) Callstate Change RINGING -> HANGUP
  497. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:852 (sofia/external/08176416480@37.9.63.182:5060) State HANGUP
  498. 2022-04-20 12:38:38.279253 [DEBUG] mod_sofia.c:438 Channel sofia/external/08176416480@37.9.63.182:5060 hanging up, cause: NORMAL_CLEARING
  499. 2022-04-20 12:38:38.279253 [DEBUG] mod_sofia.c:577 Responding to INVITE with: 480
  500. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:60 sofia/external/08176416480@37.9.63.182:5060 Standard HANGUP, cause: NORMAL_CLEARING
  501. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:852 (sofia/external/08176416480@37.9.63.182:5060) State HANGUP going to sleep
  502. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:619 (sofia/external/08176416480@37.9.63.182:5060) State Change CS_HANGUP -> CS_REPORTING
  503. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:584 (sofia/external/08176416480@37.9.63.182:5060) Running State Change CS_REPORTING (Cur 4 Tot 1567)
  504. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:938 (sofia/external/08176416480@37.9.63.182:5060) State REPORTING
  505. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:174 sofia/external/08176416480@37.9.63.182:5060 Standard REPORTING, cause: NORMAL_CLEARING
  506. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:938 (sofia/external/08176416480@37.9.63.182:5060) State REPORTING going to sleep
  507. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:610 (sofia/external/08176416480@37.9.63.182:5060) State Change CS_REPORTING -> CS_DESTROY
  508. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_session.c:1665 Session 1567 (sofia/external/08176416480@37.9.63.182:5060) Locked, Waiting on external entities
  509. 2022-04-20 12:38:38.279253 [NOTICE] switch_core_session.c:1683 Session 1567 (sofia/external/08176416480@37.9.63.182:5060) Ended
  510. 2022-04-20 12:38:38.279253 [NOTICE] switch_core_session.c:1687 Close Channel sofia/external/08176416480@37.9.63.182:5060 [CS_DESTROY]
  511. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:741 (sofia/external/08176416480@37.9.63.182:5060) Running State Change CS_DESTROY (Cur 3 Tot 1567)
  512. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:751 (sofia/external/08176416480@37.9.63.182:5060) State DESTROY
  513. 2022-04-20 12:38:38.279253 [DEBUG] mod_sofia.c:343 sofia/external/08176416480@37.9.63.182:5060 SOFIA DESTROY
  514. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:181 sofia/external/08176416480@37.9.63.182:5060 Standard DESTROY
  515. 2022-04-20 12:38:38.279253 [DEBUG] switch_core_state_machine.c:751 (sofia/external/08176416480@37.9.63.182:5060) State DESTROY going to sleep
  516. 2022-04-20 12:38:39.679291 [WARNING] switch_core_state_machine.c:687 2d31c75a-31d5-4917-90ba-073e399aa982 sofia/internal/11@156.0.249.118 Abandoned
  517. 2022-04-20 12:38:39.679291 [NOTICE] switch_core_state_machine.c:690 Hangup sofia/internal/11@156.0.249.118 [CS_NEW] [WRONG_CALL_STATE]
  518. 2022-04-20 12:38:39.679291 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_HANGUP (Cur 3 Tot 1567)
  519. 2022-04-20 12:38:39.679291 [DEBUG] switch_core_state_machine.c:850 (sofia/internal/11@156.0.249.118) Callstate Change DOWN -> HANGUP
  520. 2022-04-20 12:38:39.679291 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/11@156.0.249.118) State HANGUP
  521. 2022-04-20 12:38:39.679291 [DEBUG] mod_sofia.c:438 Channel sofia/internal/11@156.0.249.118 hanging up, cause: WRONG_CALL_STATE
  522. 2022-04-20 12:38:39.679291 [DEBUG] switch_core_state_machine.c:60 sofia/internal/11@156.0.249.118 Standard HANGUP, cause: WRONG_CALL_STATE
  523. 2022-04-20 12:38:39.679291 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/11@156.0.249.118) State HANGUP going to sleep
  524. 2022-04-20 12:38:39.679291 [DEBUG] switch_core_state_machine.c:619 (sofia/internal/11@156.0.249.118) State Change CS_HANGUP -> CS_REPORTING
  525. 2022-04-20 12:38:39.679291 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_REPORTING (Cur 3 Tot 1567)
  526. 2022-04-20 12:38:39.679291 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/11@156.0.249.118) State REPORTING
  527. 2022-04-20 12:38:39.679291 [DEBUG] switch_core_state_machine.c:174 sofia/internal/11@156.0.249.118 Standard REPORTING, cause: WRONG_CALL_STATE
  528. 2022-04-20 12:38:39.679291 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/11@156.0.249.118) State REPORTING going to sleep
  529. 2022-04-20 12:38:39.679291 [DEBUG] switch_core_state_machine.c:610 (sofia/internal/11@156.0.249.118) State Change CS_REPORTING -> CS_DESTROY
  530. 2022-04-20 12:38:39.679291 [DEBUG] switch_core_session.c:1665 Session 1563 (sofia/internal/11@156.0.249.118) Locked, Waiting on external entities
  531. 2022-04-20 12:38:39.679291 [NOTICE] switch_core_session.c:1683 Session 1563 (sofia/internal/11@156.0.249.118) Ended
  532. 2022-04-20 12:38:39.679291 [NOTICE] switch_core_session.c:1687 Close Channel sofia/internal/11@156.0.249.118 [CS_DESTROY]
  533. 2022-04-20 12:38:39.679291 [DEBUG] switch_core_state_machine.c:741 (sofia/internal/11@156.0.249.118) Running State Change CS_DESTROY (Cur 2 Tot 1567)
  534. 2022-04-20 12:38:39.679291 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/11@156.0.249.118) State DESTROY
  535. 2022-04-20 12:38:39.679291 [DEBUG] mod_sofia.c:343 sofia/internal/11@156.0.249.118 SOFIA DESTROY
  536. 2022-04-20 12:38:39.679291 [DEBUG] switch_core_state_machine.c:181 sofia/internal/11@156.0.249.118 Standard DESTROY
  537. 2022-04-20 12:38:39.679291 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/11@156.0.249.118) State DESTROY going to sleep
  538. 2022-04-20 12:38:40.319327 [WARNING] switch_core_state_machine.c:687 cfc79497-4387-4cd0-8220-0c2e45977c6c sofia/internal/1201@156.0.249.118 Abandoned
  539. 2022-04-20 12:38:40.319327 [NOTICE] switch_core_state_machine.c:690 Hangup sofia/internal/1201@156.0.249.118 [CS_NEW] [WRONG_CALL_STATE]
  540. 2022-04-20 12:38:40.319327 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/1201@156.0.249.118) Running State Change CS_HANGUP (Cur 2 Tot 1567)
  541. 2022-04-20 12:38:40.319327 [DEBUG] switch_core_state_machine.c:850 (sofia/internal/1201@156.0.249.118) Callstate Change DOWN -> HANGUP
  542. 2022-04-20 12:38:40.319327 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/1201@156.0.249.118) State HANGUP
  543. 2022-04-20 12:38:40.319327 [DEBUG] mod_sofia.c:438 Channel sofia/internal/1201@156.0.249.118 hanging up, cause: WRONG_CALL_STATE
  544. 2022-04-20 12:38:40.319327 [DEBUG] switch_core_state_machine.c:60 sofia/internal/1201@156.0.249.118 Standard HANGUP, cause: WRONG_CALL_STATE
  545. 2022-04-20 12:38:40.319327 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/1201@156.0.249.118) State HANGUP going to sleep
  546. 2022-04-20 12:38:40.319327 [DEBUG] switch_core_state_machine.c:619 (sofia/internal/1201@156.0.249.118) State Change CS_HANGUP -> CS_REPORTING
  547. 2022-04-20 12:38:40.319327 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/1201@156.0.249.118) Running State Change CS_REPORTING (Cur 2 Tot 1567)
  548. 2022-04-20 12:38:40.319327 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/1201@156.0.249.118) State REPORTING
  549. 2022-04-20 12:38:40.319327 [DEBUG] switch_core_state_machine.c:174 sofia/internal/1201@156.0.249.118 Standard REPORTING, cause: WRONG_CALL_STATE
  550. 2022-04-20 12:38:40.319327 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/1201@156.0.249.118) State REPORTING going to sleep
  551. 2022-04-20 12:38:40.319327 [DEBUG] switch_core_state_machine.c:610 (sofia/internal/1201@156.0.249.118) State Change CS_REPORTING -> CS_DESTROY
  552. 2022-04-20 12:38:40.319327 [DEBUG] switch_core_session.c:1665 Session 1564 (sofia/internal/1201@156.0.249.118) Locked, Waiting on external entities
  553. 2022-04-20 12:38:40.319327 [NOTICE] switch_core_session.c:1683 Session 1564 (sofia/internal/1201@156.0.249.118) Ended
  554. 2022-04-20 12:38:40.319327 [NOTICE] switch_core_session.c:1687 Close Channel sofia/internal/1201@156.0.249.118 [CS_DESTROY]
  555. 2022-04-20 12:38:40.319327 [DEBUG] switch_core_state_machine.c:741 (sofia/internal/1201@156.0.249.118) Running State Change CS_DESTROY (Cur 1 Tot 1567)
  556. 2022-04-20 12:38:40.319327 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/1201@156.0.249.118) State DESTROY
  557. 2022-04-20 12:38:40.319327 [DEBUG] mod_sofia.c:343 sofia/internal/1201@156.0.249.118 SOFIA DESTROY
  558. 2022-04-20 12:38:40.319327 [DEBUG] switch_core_state_machine.c:181 sofia/internal/1201@156.0.249.118 Standard DESTROY
  559. 2022-04-20 12:38:40.319327 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/1201@156.0.249.118) State DESTROY going to sleep
  560. 2022-04-20 12:38:41.859284 [NOTICE] switch_channel.c:1104 New Channel sofia/internal/11@156.0.249.118 [8140bedc-ef93-48db-9e34-87f22e7bb5dc]
  561. 2022-04-20 12:38:41.859284 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_NEW (Cur 2 Tot 1568)
  562. 2022-04-20 12:38:41.859284 [DEBUG] sofia.c:9873 sofia/internal/11@156.0.249.118 receiving invite from 45.93.16.32:63265 version: 1.6.20 git 43a9feb 2018-05-07 18:56:11Z 64bit
  563. 2022-04-20 12:38:41.859284 [DEBUG] sofia.c:10044 IP 45.93.16.32 Rejected by acl "domains". Falling back to Digest auth.
  564. 2022-04-20 12:38:41.859284 [DEBUG] switch_core_state_machine.c:603 (sofia/internal/11@156.0.249.118) State NEW
  565. 2022-04-20 12:38:41.859284 [DEBUG] sofia.c:2334 detaching session 8140bedc-ef93-48db-9e34-87f22e7bb5dc
  566. 2022-04-20 12:38:46.279268 [WARNING] switch_core_state_machine.c:687 750e2bee-fec9-4d74-9780-43b963ddcd76 sofia/internal/11@156.0.249.118 Abandoned
  567. 2022-04-20 12:38:46.279268 [NOTICE] switch_core_state_machine.c:690 Hangup sofia/internal/11@156.0.249.118 [CS_NEW] [WRONG_CALL_STATE]
  568. 2022-04-20 12:38:46.279268 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_HANGUP (Cur 2 Tot 1568)
  569. 2022-04-20 12:38:46.279268 [DEBUG] switch_core_state_machine.c:850 (sofia/internal/11@156.0.249.118) Callstate Change DOWN -> HANGUP
  570. 2022-04-20 12:38:46.279268 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/11@156.0.249.118) State HANGUP
  571. 2022-04-20 12:38:46.279268 [DEBUG] mod_sofia.c:438 Channel sofia/internal/11@156.0.249.118 hanging up, cause: WRONG_CALL_STATE
  572. 2022-04-20 12:38:46.279268 [DEBUG] switch_core_state_machine.c:60 sofia/internal/11@156.0.249.118 Standard HANGUP, cause: WRONG_CALL_STATE
  573. 2022-04-20 12:38:46.279268 [DEBUG] switch_core_state_machine.c:852 (sofia/internal/11@156.0.249.118) State HANGUP going to sleep
  574. 2022-04-20 12:38:46.279268 [DEBUG] switch_core_state_machine.c:619 (sofia/internal/11@156.0.249.118) State Change CS_HANGUP -> CS_REPORTING
  575. 2022-04-20 12:38:46.279268 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_REPORTING (Cur 2 Tot 1568)
  576. 2022-04-20 12:38:46.279268 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/11@156.0.249.118) State REPORTING
  577. 2022-04-20 12:38:46.279268 [DEBUG] switch_core_state_machine.c:174 sofia/internal/11@156.0.249.118 Standard REPORTING, cause: WRONG_CALL_STATE
  578. 2022-04-20 12:38:46.279268 [DEBUG] switch_core_state_machine.c:938 (sofia/internal/11@156.0.249.118) State REPORTING going to sleep
  579. 2022-04-20 12:38:46.279268 [DEBUG] switch_core_state_machine.c:610 (sofia/internal/11@156.0.249.118) State Change CS_REPORTING -> CS_DESTROY
  580. 2022-04-20 12:38:46.279268 [DEBUG] switch_core_session.c:1665 Session 1566 (sofia/internal/11@156.0.249.118) Locked, Waiting on external entities
  581. 2022-04-20 12:38:46.279268 [NOTICE] switch_core_session.c:1683 Session 1566 (sofia/internal/11@156.0.249.118) Ended
  582. 2022-04-20 12:38:46.279268 [NOTICE] switch_core_session.c:1687 Close Channel sofia/internal/11@156.0.249.118 [CS_DESTROY]
  583. 2022-04-20 12:38:46.279268 [DEBUG] switch_core_state_machine.c:741 (sofia/internal/11@156.0.249.118) Running State Change CS_DESTROY (Cur 1 Tot 1568)
  584. 2022-04-20 12:38:46.279268 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/11@156.0.249.118) State DESTROY
  585. 2022-04-20 12:38:46.279268 [DEBUG] mod_sofia.c:343 sofia/internal/11@156.0.249.118 SOFIA DESTROY
  586. 2022-04-20 12:38:46.279268 [DEBUG] switch_core_state_machine.c:181 sofia/internal/11@156.0.249.118 Standard DESTROY
  587. 2022-04-20 12:38:46.279268 [DEBUG] switch_core_state_machine.c:751 (sofia/internal/11@156.0.249.118) State DESTROY going to sleep
  588. 2022-04-20 12:38:48.279265 [NOTICE] switch_channel.c:1104 New Channel sofia/internal/11@156.0.249.118 [75937dc3-5f04-41a4-9a1c-426e8b57fc0d]
  589. 2022-04-20 12:38:48.279265 [DEBUG] switch_core_state_machine.c:584 (sofia/internal/11@156.0.249.118) Running State Change CS_NEW (Cur 2 Tot 1569)
  590. 2022-04-20 12:38:48.279265 [DEBUG] sofia.c:9873 sofia/internal/11@156.0.249.118 receiving invite from 45.93.16.32:58600 version: 1.6.20 git 43a9feb 2018-05-07 18:56:11Z 64bit
  591. 2022-04-20 12:38:48.279265 [DEBUG] sofia.c:10044 IP 45.93.16.32 Rejected by acl "domains". Falling back to Digest auth.
  592. 2022-04-20 12:38:48.279265 [DEBUG] switch_core_state_machine.c:603 (sofia/internal/11@156.0.249.118) State NEW
  593. 2022-04-20 12:38:48.279265 [DEBUG] sofia.c:2334 detaching session 75937dc3-5f04-41a4-9a1c-426e8b57fc0d
  594. 2022-04-20 12:38:49.599294 [WARNING] sofia_reg.c:2906 Can't find user [4309@156.0.249.118] from 185.108.24.44
  595. You must define a domain called '156.0.249.118' in your directory and add a user with the id="4309" attribute
  596. and you must configure your device to use the proper domain in it's authentication credentials.
  597.