Some outbound calls drop after 10-15 seconds

Outbound calls work sometimes, and other times drop the call after 10-15 seconds. If the call lasts about 30 seconds or so, it never drops. If it’s going to drop, it does it relatively quickly. I end up with dead air.

All our inbound calls work GREAT.

Any suggestions?

Try to change your SIP-Port. If you are yousing Phones from Siemens change it to 5040.

I tried 5049, 5060, 5061 and 5040. I lost calls on each of them.

What I discovered from speaking with my voip line provider is they are receiving the “bye” from our server EXACTLY 20.0000 seconds after the call is connected.

Does that mean anything to you?

The total lack of workable details is making it hard to help. No versions of anything, don’t know if you have a firewall in place or not.

Please read: http://freepbx.org/forum/freepbx/installation/so-you-have-a-problem-and-want-help

Also post a copy of the call trace and all firewall settings.

You can get a good trace by doing the following:
at the asterisk CLI: type set verbose 5
and make call in, capture the display’s output from the astierks CLI up to and including the hangup.
once you have the trace type set verbose 1 and it will reset the display output back to normal.

Hello,
I got the same problem. After 33 seconds the call hangup.

I only have it with Softphone.
I tryed with my Thomsom ST2030 it works without problems. I tryed:

  • Turning off windows firewall
  • Turning off antivirus

I still have this problem, on every trunks, only outbound calls automatically hang up after 33 seconds. (Incoming calls works withoutproblem)

This is my log file:

[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [33144516699@from-internal:1] Macro(“SIP/101-000002a1”, “user-callerid|SKIPTTL|”) in new stack
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-user-callerid:1] Set(“SIP/101-000002a1”, “AMPUSER=101”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: Set
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-user-callerid:2] GotoIf(“SIP/101-000002a1”, “0?report”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: GotoIf
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-user-callerid:3] ExecIf(“SIP/101-000002a1”, “1|Set|REALCALLERIDNUM=101”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: ExecIf
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-user-callerid:4] Set(“SIP/101-000002a1”, “AMPUSER=101”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: Set
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-user-callerid:5] Set(“SIP/101-000002a1”, “AMPUSERCIDNAME=Fred”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: Set
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-user-callerid:6] GotoIf(“SIP/101-000002a1”, “0?report”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: GotoIf
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-user-callerid:7] Set(“SIP/101-000002a1”, “AMPUSERCID=101”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: Set
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-user-callerid:8] Set(“SIP/101-000002a1”, “CALLERID(all)=“Fred” <101>”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: Set
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-user-callerid:9] ExecIf(“SIP/101-000002a1”, “1|Set|CHANNEL(language)=fr”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: ExecIf
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Last app: Set|CHANNEL(language)=fr
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-user-callerid:10] GotoIf(“SIP/101-000002a1”, “1?continue”) in new stack
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Goto (macro-user-callerid,s,19)
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: GotoIf
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-user-callerid:19] NoOp(“SIP/101-000002a1”, “Using CallerID “Fred” <101>”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: Noop
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [33144516699@from-internal:2] Set(“SIP/101-000002a1”, “_NODEST=”) in new stack
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [33144516699@from-internal:3] Macro(“SIP/101-000002a1”, “record-enable|101|OUT|”) in new stack
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-record-enable:1] GotoIf(“SIP/101-000002a1”, “1?check”) in new stack
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Goto (macro-record-enable,s,4)
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: GotoIf
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-record-enable:4] ExecIf(“SIP/101-000002a1”, “0|MacroExit|”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: ExecIf
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-record-enable:5] GotoIf(“SIP/101-000002a1”, “0?Group:OUT”) in new stack
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Goto (macro-record-enable,s,15)
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: GotoIf
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-record-enable:15] GotoIf(“SIP/101-000002a1”, “0?IN”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: GotoIf
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-record-enable:16] ExecIf(“SIP/101-000002a1”, “1|MacroExit|”) in new stack
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [33144516699@from-internal:4] Macro(“SIP/101-000002a1”, “dialout-trunk|1|33144516699||”) in new stack
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-dialout-trunk:1] Set(“SIP/101-000002a1”, “DIAL_TRUNK=1”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: Set
[Apr 16 09:31:21] DEBUG[17609] func_db.c: DB: AMPUSER/101/pinless not found in database.
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-dialout-trunk:2] GosubIf(“SIP/101-000002a1”, “0?sub-pincheck|s|1”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: GosubIf
[Apr 16 09:31:21] DEBUG[17609] func_db.c: DB: AMPUSER/101/pinless not found in database.
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-dialout-trunk:3] GotoIf(“SIP/101-000002a1”, “0?disabletrunk|1”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: GotoIf
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-dialout-trunk:4] Set(“SIP/101-000002a1”, “DIAL_NUMBER=33144516699”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: Set
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-dialout-trunk:5] Set(“SIP/101-000002a1”, “DIAL_TRUNK_OPTIONS=tr”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: Set
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-dialout-trunk:6] Set(“SIP/101-000002a1”, “OUTBOUND_GROUP=OUT_1”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: Set
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-dialout-trunk:7] GotoIf(“SIP/101-000002a1”, “1?nomax”) in new stack
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Goto (macro-dialout-trunk,s,9)
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: GotoIf
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-dialout-trunk:9] GotoIf(“SIP/101-000002a1”, “0?skipoutcid”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: GotoIf
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-dialout-trunk:10] Set(“SIP/101-000002a1”, “DIAL_TRUNK_OPTIONS=”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: Set
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-dialout-trunk:11] Macro(“SIP/101-000002a1”, “outbound-callerid|1”) in new stack
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-outbound-callerid:1] ExecIf(“SIP/101-000002a1”, “0|SetCallerPres|”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: ExecIf
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-outbound-callerid:2] ExecIf(“SIP/101-000002a1”, “0|Set|REALCALLERIDNUM=101”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: ExecIf
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-outbound-callerid:3] GotoIf(“SIP/101-000002a1”, “1?normcid”) in new stack
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Goto (macro-outbound-callerid,s,6)
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: GotoIf
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-outbound-callerid:6] Set(“SIP/101-000002a1”, “USEROUTCID=”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: Set
[Apr 16 09:31:21] DEBUG[17609] func_db.c: DB: DEVICE/101/emergency_cid not found in database.
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-outbound-callerid:7] Set(“SIP/101-000002a1”, “EMERGENCYCID=”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: Set
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-outbound-callerid:8] Set(“SIP/101-000002a1”, “TRUNKOUTCID=”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: Set
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-outbound-callerid:9] GotoIf(“SIP/101-000002a1”, “1?trunkcid”) in new stack
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Goto (macro-outbound-callerid,s,12)
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: GotoIf
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-outbound-callerid:12] ExecIf(“SIP/101-000002a1”, “0|Set|CALLERID(all)=”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: ExecIf
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-outbound-callerid:13] ExecIf(“SIP/101-000002a1”, “0|Set|CALLERID(all)=”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: ExecIf
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-outbound-callerid:14] ExecIf(“SIP/101-000002a1”, “0|Set|CALLERID(all)=”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: ExecIf
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-outbound-callerid:15] ExecIf(“SIP/101-000002a1”, “0|SetCallerPres|prohib_passed_screen”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: ExecIf
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: Macro
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-dialout-trunk:12] ExecIf(“SIP/101-000002a1”, “0|AGI|fixlocalprefix”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: ExecIf
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-dialout-trunk:13] Set(“SIP/101-000002a1”, “OUTNUM=33144516699”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: Set
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-dialout-trunk:14] Set(“SIP/101-000002a1”, “custom=SIP/voipstunt-out”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: Set
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-dialout-trunk:15] ExecIf(“SIP/101-000002a1”, “0|Set|DIAL_TRUNK_OPTIONS=M(setmusic^)”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: ExecIf
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-dialout-trunk:16] Macro(“SIP/101-000002a1”, “dialout-trunk-predial-hook|”) in new stack
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-dialout-trunk-predial-hook:1] MacroExit(“SIP/101-000002a1”, “”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: Macro
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-dialout-trunk:17] GotoIf(“SIP/101-000002a1”, “0?bypass|1”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: GotoIf
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-dialout-trunk:18] GotoIf(“SIP/101-000002a1”, “0?customtrunk”) in new stack
[Apr 16 09:31:21] DEBUG[17609] app_macro.c: Executed application: GotoIf
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Executing [s@macro-dialout-trunk:19] Dial(“SIP/101-000002a1”, “SIP/voipstunt-out/33144516699|300|”) in new stack
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – Called voipstunt-out/33144516699
[Apr 16 09:31:21] VERBOSE[17609] logger.c: – SIP/voipstunt-out-000002a2 is making progress passing it to SIP/101-000002a1
[Apr 16 09:31:21] VERBOSE[17610] logger.c: == Parsing ‘/etc/asterisk/manager.conf’: [Apr 16 09:31:21] VERBOSE[17610] logger.c: Found
[Apr 16 09:31:21] VERBOSE[17610] logger.c: == Parsing ‘/etc/asterisk/manager_additional.conf’: [Apr 16 09:31:21] VERBOSE[17610] logger.c: Found
[Apr 16 09:31:21] VERBOSE[17610] logger.c: == Parsing ‘/etc/asterisk/manager_custom.conf’: [Apr 16 09:31:21] VERBOSE[17610] logger.c: Found
[Apr 16 09:31:21] VERBOSE[17610] logger.c: == Manager ‘admin’ logged on from 127.0.0.1
[Apr 16 09:31:22] VERBOSE[17610] logger.c: == Manager ‘admin’ logged off from 127.0.0.1
[Apr 16 09:31:28] VERBOSE[17617] logger.c: == Parsing ‘/etc/asterisk/manager.conf’: [Apr 16 09:31:28] VERBOSE[17617] logger.c: Found
[Apr 16 09:31:28] VERBOSE[17617] logger.c: == Parsing ‘/etc/asterisk/manager_additional.conf’: [Apr 16 09:31:28] VERBOSE[17617] logger.c: Found
[Apr 16 09:31:28] VERBOSE[17617] logger.c: == Parsing ‘/etc/asterisk/manager_custom.conf’: [Apr 16 09:31:28] VERBOSE[17617] logger.c: Found
[Apr 16 09:31:28] VERBOSE[17617] logger.c: == Manager ‘admin’ logged on from 127.0.0.1
[Apr 16 09:31:29] VERBOSE[17618] logger.c: == Parsing ‘/etc/asterisk/manager.conf’: [Apr 16 09:31:29] VERBOSE[17618] logger.c: Found
[Apr 16 09:31:29] VERBOSE[17618] logger.c: == Parsing ‘/etc/asterisk/manager_additional.conf’: [Apr 16 09:31:29] VERBOSE[17618] logger.c: Found
[Apr 16 09:31:29] VERBOSE[17618] logger.c: == Parsing ‘/etc/asterisk/manager_custom.conf’: [Apr 16 09:31:29] VERBOSE[17618] logger.c: Found
[Apr 16 09:31:29] VERBOSE[17618] logger.c: == Manager ‘admin’ logged on from 127.0.0.1
[Apr 16 09:31:29] VERBOSE[17617] logger.c: == Manager ‘admin’ logged off from 127.0.0.1
[Apr 16 09:31:30] VERBOSE[17618] logger.c: == Manager ‘admin’ logged off from 127.0.0.1
[Apr 16 09:31:33] VERBOSE[17609] logger.c: – SIP/voipstunt-out-000002a2 answered SIP/101-000002a1
[Apr 16 09:31:36] VERBOSE[17626] logger.c: == Parsing ‘/etc/asterisk/manager.conf’: [Apr 16 09:31:36] VERBOSE[17626] logger.c: Found
[Apr 16 09:31:36] VERBOSE[17626] logger.c: == Parsing ‘/etc/asterisk/manager_additional.conf’: [Apr 16 09:31:36] VERBOSE[17626] logger.c: Found
[Apr 16 09:31:36] VERBOSE[17626] logger.c: == Parsing ‘/etc/asterisk/manager_custom.conf’: [Apr 16 09:31:36] VERBOSE[17626] logger.c: Found
[Apr 16 09:31:36] VERBOSE[17626] logger.c: == Manager ‘admin’ logged on from 127.0.0.1
[Apr 16 09:31:37] VERBOSE[17626] logger.c: == Manager ‘admin’ logged off from 127.0.0.1
[Apr 16 09:31:43] VERBOSE[17633] logger.c: == Parsing ‘/etc/asterisk/manager.conf’: [Apr 16 09:31:43] VERBOSE[17633] logger.c: Found
[Apr 16 09:31:43] VERBOSE[17633] logger.c: == Parsing ‘/etc/asterisk/manager_additional.conf’: [Apr 16 09:31:43] VERBOSE[17633] logger.c: Found
[Apr 16 09:31:43] VERBOSE[17633] logger.c: == Parsing ‘/etc/asterisk/manager_custom.conf’: [Apr 16 09:31:43] VERBOSE[17633] logger.c: Found
[Apr 16 09:31:43] VERBOSE[17633] logger.c: == Manager ‘admin’ logged on from 127.0.0.1
[Apr 16 09:31:44] VERBOSE[17633] logger.c: == Manager ‘admin’ logged off from 127.0.0.1
[Apr 16 09:31:51] VERBOSE[17640] logger.c: == Parsing ‘/etc/asterisk/manager.conf’: [Apr 16 09:31:51] VERBOSE[17640] logger.c: Found
[Apr 16 09:31:51] VERBOSE[17640] logger.c: == Parsing ‘/etc/asterisk/manager_additional.conf’: [Apr 16 09:31:51] VERBOSE[17640] logger.c: Found
[Apr 16 09:31:51] VERBOSE[17640] logger.c: == Parsing ‘/etc/asterisk/manager_custom.conf’: [Apr 16 09:31:51] VERBOSE[17640] logger.c: Found
[Apr 16 09:31:51] VERBOSE[17640] logger.c: == Manager ‘admin’ logged on from 127.0.0.1
[Apr 16 09:31:52] VERBOSE[17640] logger.c: == Manager ‘admin’ logged off from 127.0.0.1
[Apr 16 09:31:58] VERBOSE[17647] logger.c: == Parsing ‘/etc/asterisk/manager.conf’: [Apr 16 09:31:58] VERBOSE[17647] logger.c: Found
[Apr 16 09:31:58] VERBOSE[17647] logger.c: == Parsing ‘/etc/asterisk/manager_additional.conf’: [Apr 16 09:31:58] VERBOSE[17647] logger.c: Found
[Apr 16 09:31:58] VERBOSE[17647] logger.c: == Parsing ‘/etc/asterisk/manager_custom.conf’: [Apr 16 09:31:58] VERBOSE[17647] logger.c: Found
[Apr 16 09:31:58] VERBOSE[17647] logger.c: == Manager ‘admin’ logged on from 127.0.0.1
[Apr 16 09:31:59] VERBOSE[17647] logger.c: == Manager ‘admin’ logged off from 127.0.0.1
[Apr 16 09:32:00] VERBOSE[17654] logger.c: == Parsing ‘/etc/asterisk/manager.conf’: [Apr 16 09:32:00] VERBOSE[17654] logger.c: Found
[Apr 16 09:32:00] VERBOSE[17654] logger.c: == Parsing ‘/etc/asterisk/manager_additional.conf’: [Apr 16 09:32:00] VERBOSE[17654] logger.c: Found
[Apr 16 09:32:00] VERBOSE[17654] logger.c: == Parsing ‘/etc/asterisk/manager_custom.conf’: [Apr 16 09:32:00] VERBOSE[17654] logger.c: Found
[Apr 16 09:32:00] VERBOSE[17654] logger.c: == Manager ‘admin’ logged on from 127.0.0.1
[Apr 16 09:32:00] VERBOSE[17654] logger.c: == Manager ‘admin’ logged off from 127.0.0.1
[Apr 16 09:32:05] VERBOSE[17656] logger.c: == Parsing ‘/etc/asterisk/manager.conf’: [Apr 16 09:32:05] VERBOSE[17656] logger.c: Found
[Apr 16 09:32:05] VERBOSE[17656] logger.c: == Parsing ‘/etc/asterisk/manager_additional.conf’: [Apr 16 09:32:05] VERBOSE[17656] logger.c: Found
[Apr 16 09:32:05] VERBOSE[17656] logger.c: == Parsing ‘/etc/asterisk/manager_custom.conf’: [Apr 16 09:32:05] VERBOSE[17656] logger.c: Found
[Apr 16 09:32:05] VERBOSE[17656] logger.c: == Manager ‘admin’ logged on from 127.0.0.1
[Apr 16 09:32:06] VERBOSE[17609] logger.c: – Executing [h@macro-dialout-trunk:1] Macro(“SIP/101-000002a1”, “hangupcall|”) in new stack
[Apr 16 09:32:06] VERBOSE[17609] logger.c: – Executing [s@macro-hangupcall:1] GotoIf(“SIP/101-000002a1”, “1?skiprg”) in new stack
[Apr 16 09:32:06] VERBOSE[17609] logger.c: – Goto (macro-hangupcall,s,4)
[Apr 16 09:32:06] DEBUG[17609] app_macro.c: Executed application: GotoIf
[Apr 16 09:32:06] VERBOSE[17609] logger.c: – Executing [s@macro-hangupcall:4] GotoIf(“SIP/101-000002a1”, “1?skipblkvm”) in new stack
[Apr 16 09:32:06] VERBOSE[17609] logger.c: – Goto (macro-hangupcall,s,7)
[Apr 16 09:32:06] DEBUG[17609] app_macro.c: Executed application: GotoIf
[Apr 16 09:32:06] VERBOSE[17609] logger.c: – Executing [s@macro-hangupcall:7] GotoIf(“SIP/101-000002a1”, “1?theend”) in new stack
[Apr 16 09:32:06] VERBOSE[17609] logger.c: – Goto (macro-hangupcall,s,9)
[Apr 16 09:32:06] DEBUG[17609] app_macro.c: Executed application: GotoIf
[Apr 16 09:32:06] VERBOSE[17609] logger.c: – Executing [s@macro-hangupcall:9] Hangup(“SIP/101-000002a1”, “”) in new stack
[Apr 16 09:32:06] VERBOSE[17609] logger.c: == Spawn extension (macro-hangupcall, s, 9) exited non-zero on ‘SIP/101-000002a1’ in macro ‘hangupcall’
[Apr 16 09:32:06] VERBOSE[17609] logger.c: == Spawn h extension (macro-dialout-trunk, h, 1) exited non-zero on ‘SIP/101-000002a1’
[Apr 16 09:32:06] VERBOSE[17609] logger.c: == Spawn extension (macro-dialout-trunk, s, 19) exited non-zero on ‘SIP/101-000002a1’ in macro ‘dialout-trunk’

Any idea why all calls are terminated after 33 seconds?

Is this X-Lite softphone ?
If so, there is an "Options>advanced> Checkbox (in Times of network disruption, automatically hang up calls after X seconds… 30 seconds is the default. and the box is checked by default.

This helped for me, the problem was on my softphone

NOTE! Post edited to remove link to site that requires registration to show the answer. I also added the solution. mickecarlsson

Yes, you’re right, the X-lite option was enabled.
It works now