Re: DMQ issues and CRITICAL errors
Sergio Charrua via sr-users <[email protected]> Thu, 9 Jul 2026 10:11:10 +0200
| Newsgroups | gmane.comp.voip.ser |
|---|---|
| Message-ID | <CALZWR5z7KUjz6s6LE=kmNycB_LZx_EbRGoTfMYjyoKyNx3wM-w@mail.gmail.com> |
--===============0188057266== Content-Type: multipart/alternative; boundary="000000000000dd12ef0656292c26" --000000000000dd12ef0656292c26 Content-Type: text/plain; charset="UTF-8" Content-Transfer-Encoding: quoted-printable Thanks Henning, I did a mistake, we are not using 6.0.1 but 6.1.1. >From the release notes and changelogs I see that 6.0.7 was release on 19 June but 6.1.1 was on 25 May. I wonder if 6.1.1 has the same patches than 6.0.7. Can you confirm please? Atenciosamente / Kind Regards / Cordialement / Un saludo, *S=C3=A9rgio Charrua* *www.kahea.ai <http://www.kahea.ai> / www.voip.pt <http://www.voip.pt>* *OpenTelecom* - Consulting for Telecoms, Lda Tel.: +351 <callto:+351+91+104+12+66>91 631 11 44 Email : *[email protected] <[email protected]> / **[email protected] <[email protected]> * This message and any files or documents attached are strictly confidential or otherwise legally protected. It is intended only for the individual or entity named. If you are not the named addressee or have received this email in error, please inform the sender immediately, delete it from your system and do not copy or disclose it or its contents or use it for any purpose. Please also note that transmission cannot be guaranteed to be secure or error-free. On Wed, Jul 8, 2026 at 2:07=E2=80=AFPM Sergio Charrua <sergio.charrua@voip.= pt> wrote: > Ok, I will try 6.0.7. > > I share your expectations as well... but it is not executed, i'm afraid. > > > Atenciosamente / Kind Regards / Cordialement / Un saludo, > > > *S=C3=A9rgio Charrua* > > *www.kahea.ai <http://www.kahea.ai> / www.voip.pt <http://www.voip.pt>* > > *OpenTelecom* - Consulting for Telecoms, Lda > Tel.: +351 <callto:+351+91+104+12+66>91 631 11 44 > > Email : *[email protected] <[email protected]>* > > This message and any files or documents attached are strictly confidentia= l > or otherwise legally protected. > > It is intended only for the individual or entity named. If you are not th= e > named addressee or have received this email in error, please inform the > sender immediately, delete it from your system and do not copy or disclos= e > it or its contents or use it for any purpose. Please also note that > transmission cannot be guaranteed to be secure or error-free. > > > > > > > > > On Wed, Jul 8, 2026 at 12:49=E2=80=AFPM Henning Westerholt <[email protected]= > wrote: > >> Hello Sergio, >> >> >> >> I would recommend updating to the latest 6.0.7 alone for security >> reasons. >> >> >> >> Regarding the PR improvement, Stefan already replied to your e-mail as >> well. Maybe you can give this a try. >> >> >> >> I would expect that the MANAGE_REPLY onreply route is executed regardles= s >> of an internal dialog issue. The first one is related to a dialog, and t= he >> latter to the SIP transaction of course. >> >> >> >> Cheers, >> >> >> >> Henning >> >> >> >> *From:* Sergio Charrua <[email protected]> >> *Sent:* Mittwoch, 8. Juli 2026 12:38 >> *To:* Henning Westerholt <[email protected]> >> *Cc:* Kamailio (SER) - Users Mailing List <[email protected]> >> *Subject:* Re: [SR-Users] DMQ issues and CRITICAL errors >> >> >> >> Hey Henning, >> >> I am running version 6.0.1. >> >> DMQ and other module params are as follows: >> >> >> >> modparam("dmq", "server_address", " >> sip:10.20.0.4:5062;transport=3Dudp" ) >> modparam("dmq", "notification_address", " >> sip:10.20.0.1:5060;transport=3Dudp" ) >> modparam("dmq", "multi_notify", 0) >> >> modparam("dmq", "num_workers", 12) >> >> modparam("dmq", "ping_interval", 60) >> >> >> >> >> modparam("dialog", "db_mode", 0) >> >> modparam("dialog", "enable_dmq", 1) >> >> modparam("dialog", "timer_procs", 1) >> modparam("dialog", "db_fetch_rows", 500) >> modparam("dialog", "track_cseq_updates", 1) >> modparam("dialog", "dlg_match_mode", 1) >> modparam("dialog", "default_timeout", CALL_TIME_LIMIT) >> modparam("dialog", "send_bye", 0) >> modparam("dialog", "early_timeout", 300) >> modparam("dialog", "noack_timeout", 60) >> modparam("dialog", "hash_size", 262144) >> >> modparam("dialog", "enable_stats", 1) >> >> >> >> modparam("htable", "htable", >> "evsent=3D>size=3D2048;autoexpire=3D600;dbmode=3D0;dmqreplicate=3D1") >> modparam("htable", "htable", >> "evapistatus=3D>size=3D1;autoexpire=3D0;dbmode=3D0;dmqreplicate=3D0;init= val=3D0") >> modparam("htable", "htable", >> "gw_last=3D>size=3D16;autoexpire=3D50;dmqreplicate=3D0;updateexpire=3D1"= ) >> modparam("htable", "htable", >> "gw_local=3D>size=3D16;autoexpire=3D0;dbmode=3D0;dmqreplicate=3D1;update= expire=3D1") >> modparam("htable", "htable", >> "sbcstatus=3D>size=3D64;autoexpire=3D3600;dbmode=3D0;dmqreplicate=3D0") >> modparam("htable", "htable", >> "gw_probe=3D>size=3D16;autoexpire=3D0;dmqreplicate=3D0;initval=3D-1") >> modparam("htable", "htable", >> "local_bye=3D>size=3D13;autoexpire=3D120;dbmode=3D0;dmqreplicate=3D1;") >> >> modparam("htable", "htable", "ha_state=3D>size=3D2;autoexpire=3D0M"= ) >> >> I'll check the recent PRs on DMQ dialog behavior. I was hoping the issue >> was just related to the FSM state mismatch on failover, but if there are >> known improvements I should definitely check them. >> >> >> >> Some additional script lines: >> >> >> >> request_route{ >> >> route(HANDLE_DMQ); >> >> route(HANDLE_RETRANS); >> >> route(REQINIT); >> route(HANDLE_CANCEL); >> route(WITHINDLG); >> >> if (is_method("INVITE")) >> { >> # record routing for dialog forming requests (in case they >> are routed) >> # - remove preloaded route headers >> remove_hf("Route"); >> record_route(); >> route(RESET_VARS); >> dlg_manage(); >> route(HANDLE_INVITE); >> exit; >> } >> >> route(RELAY); >> exit; >> >> } >> >> >> >> route[HANDLE_DMQ] >> { >> if( is_method("KDMQ") && $rp =3D=3D DMQ_PORT) >> { >> dmq_handle_message(); >> exit; >> } >> } >> >> >> >> route[TRACK_ACK] { >> # Guard: only record the first ACK (re-INVITEs also produce ACKs) >> if ($dlg_var(ts_ack_usec) !=3D $null) { >> return; >> } >> $dlg_var(ts_ack_usec) =3D $TV(Sn); >> $sht(local_bye=3D>$ci|ack_time) =3D $dlg_var(ts_ack_usec); # >> capture-time write (dialog:end may never fire on an adopted replica) >> xlog("L_INFO","TRACK_ACK - saving ACK timestamp $dlg_var(ts_ack_usec= ) >> \n"); >> } >> >> >> >> onreply_route{ >> >> xlog("L_INFO","onreply_route - $rs : $rm replied from sip:$si:$s= p >> with SIP $T_reply_code \n"); >> if (is_method("BYE")) >> { >> xlog("L_WARN","onreply_route - BYE detected\n"); >> if ($mt =3D=3D 2) >> { >> xlog("L_INFO","onreply_route - BYE and response >> received\n"); >> >> # Atomically read-and-consume the htable snapshot. >> # sht_lock prevents the second process from reading >> # the same values and sending a duplicate CALL_FINISH. >> if ($sht(local_bye=3D>$ci|is_local) =3D=3D 1) >> { >> xlog("L_INFO","onreply_route - local BYE detected fo= r >> call_id $ci - restoring cached values for CALL_FINISH\n"); >> $var(islocal) =3D 1; >> } >> >> route(TRACK_BYE_200); >> route(SEND_CALL_STATUS); >> } >> } >> } >> >> >> >> onreply_route[MANAGE_REPLY] { >> xlog("L_INFO", "MANAGE_REPLY - Incoming reply $rm $rs \n"); >> >> $var(statuskey) =3D "sip:" + $si + ":" + $sp; >> >> // the outbound endpoint replied something, so it is alive! >> xlog("L_INFO", "MANAGE_REPLY - Starting monitoring counter for >> endpoint $var(statuskey) \n"); >> $sht(gw_last=3D>$var(statuskey)) =3D $Ts; # remember last INVITE = time >> if (status =3D=3D "100"){ >> xlog("L_INFO","MANAGE_REPLY - Forwarding 100 Trying \n"); >> route(RESET_FAILURE_COUNTER); >> } >> else if (status =3D~ "^(180|183)$" || $rs =3D~ "^(180|183)$" ) >> { >> xlog("L_INFO","MANAGE_REPLY - Forwarding 180/183 Session >> Progress\n"); >> $dlg_var(first_18x_ts) =3D $TV(Sn); >> >> if (status =3D=3D "180") >> $dlg_var(first_180_ts) =3D $TV(Sn); >> else if (status =3D=3D "183") >> $dlg_var(first_183_ts) =3D $TV(Sn); >> >> if ($dlg_var(first_180_ts) !=3D $null) >> $sht(local_bye=3D>$ci|180_time) =3D $dlg_var(first_180_ts); = # >> capture-time write >> if ($dlg_var(first_183_ts) !=3D $null) >> $sht(local_bye=3D>$ci|183_time) =3D $dlg_var(first_183_ts); = # >> capture-time write >> >> xlog("L_INFO","MANAGE_REPLY - setting Ringing Timestamp to >> $dlg_var(first_18x_ts)"); >> route(RESET_FAILURE_COUNTER); >> } >> else if (status =3D=3D "200") >> { >> if ($dlg_var(ts_200ok_usec) =3D=3D $null || $dlg_var(ts_200ok_us= ec) >> =3D=3D "") >> route(CALL_CONNECT); >> } >> else if (status =3D=3D "487") >> { >> xlog("L_INFO","MANAGE_REPLY - Forwarding 487 Request Terminated >> on Caller's side\n"); >> route(RESET_FAILURE_COUNTER); >> } >> else if (status =3D~ "4[0-9][0-9]|5[0-9][0-9]|6[0-9][0-9]") >> { >> xlog("L_INFO","MANAGE_REPLY - CALL REJECTED with code >> $T_reply_code !! \n"); >> $var(type) =3D "CALL_REJECT"; >> route(RESET_FAILURE_COUNTER); >> route(SPOOL_CALL_STATUS); >> } >> } >> >> >> >> failure_route[MANAGE_FAILURE] { >> >> .... standard failure handling .... >> >> } >> >> >> >> >> >> >> >> the rest of the script does the normal processing of the call, including >> EVAPI requests to get list of routes, crankback in case of failures, >> etc.... >> >> on the MANAGE_REPLY upon call answer (200 OK) a call to CALL_CONNECT is >> executed. >> >> What I have found so far is that upon a CRITICAL error as listed in the >> provided logs, the MANAGE_REPLY is not executed, but only the global >> onreply_route{ } is. So, routing engine is not notified of the call >> being answered implying that CDR is not started and some of the $dlg_var= () >> with timestamps are not initiated. >> >> However, the CALL_FINISH route (not provided here) is executed with some >> missing values, because MANAGE_REPLY wasn't executed, which is also an >> issue for the routing engine. >> >> I solved the missing CALL_CONNECT by adding following lines to the globa= l >> onreply_route{}: >> >> .... >> >> else if (is_method("INVITE|UPDATE") && $rs >=3D 200 && $rs < 300) >> { >> xlog("L_INFO","onreply_route - INVITE/UPDATE 2xx replied fro= m >> sip:$si:$sp with SIP $T_reply_code \n"); >> route(CALL_CONNECT); >> } >> >> ... >> >> >> >> but I'm finding weird that the MANAGE_REPLY route being not called, >> eventually due to the CRITICAL error.... >> >> >> >> If you check the logs, the global onreply_route{} is executed when a 200 >> OK is received: >> >> onreply_route - 200 : INVITE replied from sip:*.*.12.209:5253 with SIP >> 200 >> >> And then the route TRACK_ACK is executed too, assigning ACK timestamp to >> a $dlg_var(). Right after that, the CRITICAL error is thrown and the MAN= AGE_REPLY >> is not executed. >> >> >> >> Is that an expected behaviour? I would expect that the MANAGE_REPLY rout= e >> be executed after the global onreply_route{} as usual even after a CRITI= CAL >> error..... >> >> Note that the call is still processed normally, just the MANAGE_REPLY is >> ignored. But why? >> >> >> >> >> >> Atenciosamente / Kind Regards / Cordialement / Un saludo, >> >> >> >> *S=C3=A9rgio Charrua* >> >> *www.kahea.ai <http://www.kahea.ai> / www.voip.pt <http://www.voip.pt>* >> >> *OpenTelecom* - Consulting for Telecoms, Lda >> Tel.: +351 <callto:+351+91+104+12+66>91 631 11 44 >> >> Email : *[email protected] <[email protected]>* >> >> This message and any files or documents attached are strictly >> confidential or otherwise legally protected. >> >> It is intended only for the individual or entity named. If you are not >> the named addressee or have received this email in error, please inform = the >> sender immediately, delete it from your system and do not copy or disclo= se >> it or its contents or use it for any purpose. Please also note that >> transmission cannot be guaranteed to be secure or error-free. >> >> >> >> >> >> >> >> >> >> >> >> On Wed, Jul 8, 2026 at 11:44=E2=80=AFAM Henning Westerholt <[email protected]= m> wrote: >> >> Hello, >> >> >> >> I can not comment on the effect of the error in the dialog module on you= r >> calls as it depends on your configuration dialog module usage. >> >> >> >> There have been some PRs recently to improve the behaviour of DMQ dialog >> behaviour, some of them already get merged. >> >> >> >> I did not saw your Kamailio version that you are using, so it=E2=80=99s = difficult >> to say if you already have them integrated. >> >> >> >> Cheers, >> >> >> >> Henning >> >> >> >> *From:* Sergio Charrua via sr-users <[email protected]> >> *Sent:* Freitag, 3. Juli 2026 17:52 >> *To:* Kamailio (SER) - Users Mailing List <[email protected]> >> *Cc:* Sergio Charrua <[email protected]> >> *Subject:* [SR-Users] DMQ issues and CRITICAL errors >> >> >> >> Hi all, >> >> >> >> have a standard HA setup using 2 kamailio nodes (SIP 1 and SIP 2) and a >> VIP managed by Keepalid service. >> >> Both kamailio nodes use same configuration and while one is the Active >> node (where the VIP is present) the other is Backup node. Not rocket >> science. >> >> We use DMQ to share dialog data between nodes, using a second IP:Port >> address (Node 1 is .126:5062 , Node 2 is .125:5062) >> >> The VIP is .147 and SIP is listened on the VIP at .147:5060 >> >> >> >> Here is the test scenario: >> >> - SIP 1 (Active node) receives the initial INVITE, requests Routing >> Engine for a list of routes (uses EVAPI script who interacts with a REST >> service) >> >> - call is routed to egress endpoint according to the route list received >> >> - some SIP 183 is replied back and forwarded to ingress endpoint >> >> - a PRACK is received as a reply from the previous SIP 183 and kamailio >> forwards to egress side >> >> - *** Kamailio SIP 1 instance is stopped (service kamailio stop) **** >> >> - VIP switches to node SIP 2 >> >> - SIP 2 gets a reply SIP 200 OK from egress side (assuming a >> retransmission) >> >> - *** CRITICAL error is logged with : >> >> CRITICAL: {1783082372.409470 857991 1 >> 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 ACK}dialog >> [dlg_hash.c:1276]: next_state_dlg(): bogus event 6 in state 2 for dlg >> 0x7f4d7c886990 [193061:598258] with clid '48c1e14ce80dbdd6beacacda1aa8f7= 9c@*.*.12.209' >> and tags '*.*.12.209+2+32486fa4+25838f19' '' >> >> - *** there should be a call to EVAPI script to notify the call was >> answered (CALL_CONNECT notification) but there is none ----> Meanwhile = i >> solved this, and CALL_CONNECT is sent event if there is a CRITICAL event >> >> - call seems to continue perfectly until BYE is received and a EVAPI >> script is notified with a CALL_FINISH request >> >> >> >> Here are the logs on SIP 1 who received the initial INVITE: >> >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930200]: INFO: >> {1783082368.672371 930193 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: Processing INVITE from *.*.12.209:5242 to >> sip:+33100001209@*.*.12.137:5242;user=3Dphone >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930200]: INFO: >> {1783082368.673719 930193 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: HANDLE_INVITE - suspended transaction for INVITE >> INVITE:::{"sip_invite":{"Via":"SIP/2.0/UDP >> *.*.12.209:5242;branch=3Dz9hG4bK+bb3831916f972b133610a3eb7d60da343+sip+2= +a65dede3","From":"\"+33000007\" >> <sip:+33000000012@*.*.12.107;user=3Dphone >> >;tag=3D*.*.12.209+2+32486fa4+25838f19","To":"< >> sip:+33100001209@*.*.12.137;user=3Dphone>","CSeq":"1 >> INVITE","Content-Length":"175","Supported":"timer,histinfo,replaces, >> 100rel","P-Charging-Vector":"icid-value=3D1a18eec80dbf1bcaa957e9322967a9= d7;orig-ioi=3DBICS","Contact":"< >> sip:+33000000012@*.*.12.209:5242;transport=3Dudp;user=3Dphone >> >","Content-Type":"application/sdp","Call-ID":" >> 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209","Accept":"application/sdp, >> application/isup, >> application/dtmf,multipart/mixed","Max-Forwards":"68","Session-Expires":= "1800","Min-SE":"90","P-Asserted-Identity":"\"+33000000012\" >> <sip:+33000000012@*.*.12.107;user=3Dphone>","X-REFERRED-BY":["< >> sip:[email protected]:5060;user=3Dphone>","< >> sip:[email protected]:5060;user=3Dphone >> >"],"X-tgrp":"CloudCom","X-Test":"CC_Outb_23","X-bababa-PID":"11283","X-= History-Info":["< >> sip:+380930539504@*.*.12.107;user=3Dphone;cause=3D408>;index=3D1","< >> sip:380930539504@*.*.12.107;user=3Dphone;cause=3D486;transport=3Dudp >> >;index=3D1.1","< >> sip:+3354806000999@*.*.12.110:5060?reason=3DSIP%3Bcause%3D302>;index=3D1= ,< >> sip:+33969990333@*.*.12.110:5060;user=3Dphone>;index=3D1.1,< >> sip:380930539504@*.*.12.107;user=3Dphone;cause=3D481;transport=3Dudp >> >;index=3D1.1.1,< >> sip:334444444444444@*.*.12.107;user=3Dphone;cause=3D481;transport=3Dudp >> >;index=3D1.1.1.1"],"Diversion":"<sip:[email protected] >> >","Allow":"INVITE,ACK,CANCEL,BYE,REGISTER,SUBSCRIBE,NOTIFY,UPDATE,OPTIO= NS,MESSAGE,PUBLISH","Privacy":"none","Method":"INVITE","Request-URI":" >> sip:+33100001209@*.*.12.137:5242;user=3Dphone >> "},"remote_ip_port":"*.*.12.209:5242","local_ip_port":"10.242.17.147:506= 0 >> ","protocol":"udp","retry":0,"timestamp":"1783082368.672364"} >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930200]: INFO: >> {1783082368.673764 930193 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: HANDLE_INVITE - suspended transaction for INVITE / >> CALL_ATTEMPT. Index: <null> - Label: <null> >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: >> {1783082368.749972 930193 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: EVAPIRESPONSE - TRANSACTION 62044|1856782967 >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: >> {1783082368.750015 930193 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: EVAPIRESPONSE - Resumed with RESPONSE {"action": "ROUTE= ", >> "routes": [{"tkg_eid": "101253", "crankback_profile": [{"sip_errors": >> ["403", "500", "503", "408", "cb_to_transit"], "next_tkg_eid": "101254"}= ], >> "dst_uri": "sip:*.*.12.209:5253", "uri": " >> sip:+33100001209@*.*.12.209:5253;user=3Dphone", "headers": {"delete": >> null, "add": [{"P-Access-Network-Info": >> "GSTN;operator-specific-GI=3D\"011921212\";network-provided"}], "from": >> {"display": "+33000007", "uri": "sip:+33000000012@*.*.12.107;user=3Dphon= e"}, >> "to": {"uri": "sip:+33100001209@*.*.12.209:5253;user=3Dphone"}}, >> "max_call_duration": 43200}, {"tkg_eid": "101254", "crankback_profile": = [], >> "dst_uri": "sip:*.*.199.167:5254", "uri": " >> sip:+33100001209@*.*.199.167:5254;user=3Dphone", "headers": {"delete": >> null, "add": [{"P-Access-Network-Info": >> "GSTN;operator-specific-GI=3D\"011921212\";network-provided"}], "from": >> {"display": "+33000007", "uri": "sip:+33000000012@*.*.12.107;user=3Dphon= e"}, >> "to": {"uri": "sip:+33100001209@*.*.199.167:5254;user=3Dphone"}}, >> "max_call_duration": 43200}], "retry_on_failure": false, >> "max_number_of_crankbacks": 2, "version": "1.0", "method": "INVITE", >> "routing": "serial", "call_id": " >> 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209"} >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: >> {1783082368.750121 930193 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: EVAPIRESPONSE - ROUTE action >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: >> {1783082368.750166 930193 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: EVAPIRESPONSE - NO retry_on_failure FOUND or >> retry_on_failure =3D 0 ! >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: >> {1783082368.750213 930193 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: EVAPIRESPONSE - retry_on_failure =3D 0 >> max_number_of_crankbacks =3D 2 >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: >> {1783082368.750239 930193 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: JSON_ROUTE_PROCESS - start retry=3D0 >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: >> {1783082368.750310 930193 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: JSON_ROUTE_PROCESS - 2 route(s) available - >> max_crankbacks=3D2 >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: >> {1783082368.750419 930193 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: APPLY_ROUTE_AND_RELAY - idx=3D0 - ru=3Dsip:+33100001209= @*.*.12.209:5253;user=3Dphone >> du=3Dsip:*.*.12.209:5253 >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: >> {1783082368.750617 930193 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: RELAY - tkg_eid=3D101253 idx=3D0 ru=3Dsip:+33100001209= @*.*.12.209:5253;user=3Dphone >> du=3Dsip:*.*.12.209:5253 >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: >> {1783082368.750726 930193 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<core> [core/kemi.c:155]: sr_kemi_core_log(): modify_invite_heade= rs: >> rtjsonValue is empty, undefined or null, trying to get from $var(cur_rou= te) >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: >> {1783082368.750974 930193 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: PIN_SOCKET - socket is pinned 1 >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: >> {1783082368.751036 930193 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: MANAGE_BRANCH - initializing new branch [1] to >> sip:+33100001209@*.*.12.209:5253;user=3Dphone >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: >> {1783082368.751054 930193 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: MANAGE_BRANCH - Starting monitoring counter for endpoin= t >> sip:*.*.12.209:5253 from *.*.17.147:5060 at 1783082368 >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930196]: INFO: >> {1783082368.753932 930193 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: onreply_route - 100 : INVITE replied from >> sip:*.*.12.209:5253 with SIP 100 >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930196]: INFO: >> {1783082368.753994 930193 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: MANAGE_REPLY - Incoming reply INVITE 100 >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930196]: INFO: >> {1783082368.754012 930193 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: MANAGE_REPLY - Starting monitoring counter for endpoint >> sip:*.*.12.209:5253 >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930196]: INFO: >> {1783082368.754025 930193 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: MANAGE_REPLY - Forwarding 100 Trying >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930196]: INFO: >> {1783082368.754033 930193 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: RESET_FAILURE_COUNTER - resetting failure counter for >> sip:*.*.12.209:5253 to 0 >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930195]: INFO: >> {1783082368.866708 930193 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: onreply_route - 183 : INVITE replied from >> sip:*.*.12.209:5253 with SIP 183 >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930195]: INFO: >> {1783082368.866815 930193 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: MANAGE_REPLY - Incoming reply INVITE 183 >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930195]: INFO: >> {1783082368.866835 930193 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: MANAGE_REPLY - Starting monitoring counter for endpoint >> sip:*.*.12.209:5253 >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930195]: INFO: >> {1783082368.866855 930193 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: MANAGE_REPLY - Forwarding 180/183 Session Progress >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930195]: INFO: >> {1783082368.867114 930193 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: MANAGE_REPLY - setting Ringing Timestamp to >> 1783082368.866860 >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930195]: INFO: >> {1783082368.867141 930193 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: RESET_FAILURE_COUNTER - resetting failure counter for >> sip:*.*.12.209:5253 to 0 >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930202]: INFO: >> {1783082368.876888 930193 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> PRACK}<script>: PIN_SOCKET - socket is pinned 1 >> Jul 3 12:39:28 bl1649 /usr/local/sbin/kamailio[930201]: INFO: >> {1783082368.882525 930193 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> PRACK}<script>: onreply_route - 200 : PRACK replied from >> sip:*.*.12.209:5253 with SIP 200 >> Jul 3 12:39:29 bl1649 /usr/local/sbin/kamailio[930202]: INFO: >> {1783082369.884679 930193 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: onreply_route - 180 : INVITE replied from >> sip:*.*.12.209:5253 with SIP 180 >> Jul 3 12:39:29 bl1649 /usr/local/sbin/kamailio[930202]: INFO: >> {1783082369.884771 930193 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: MANAGE_REPLY - Incoming reply INVITE 180 >> Jul 3 12:39:29 bl1649 /usr/local/sbin/kamailio[930202]: INFO: >> {1783082369.884790 930193 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: MANAGE_REPLY - Starting monitoring counter for endpoint >> sip:*.*.12.209:5253 >> Jul 3 12:39:29 bl1649 /usr/local/sbin/kamailio[930202]: INFO: >> {1783082369.884815 930193 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: MANAGE_REPLY - Forwarding 180/183 Session Progress >> Jul 3 12:39:29 bl1649 /usr/local/sbin/kamailio[930202]: INFO: >> {1783082369.885326 930193 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: MANAGE_REPLY - setting Ringing Timestamp to >> 1783082369.884822 >> Jul 3 12:39:29 bl1649 /usr/local/sbin/kamailio[930202]: INFO: >> {1783082369.885357 930193 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: RESET_FAILURE_COUNTER - resetting failure counter for >> sip:*.*.12.209:5253 to 0 >> Jul 3 12:39:29 bl1649 /usr/local/sbin/kamailio[930201]: INFO: >> {1783082369.892923 930193 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> PRACK}<script>: PIN_SOCKET - socket is pinned 1 >> Jul 3 12:39:29 bl1649 /usr/local/sbin/kamailio[930199]: INFO: >> {1783082369.899687 930193 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> PRACK}<script>: onreply_route - 200 : PRACK replied from >> sip:*.*.12.209:5253 with SIP 200 >> >> >> >> These are the logs from SIP 2 after the VIP has switched: >> >> >> Jul 3 12:39:32 bl1650 /usr/local/sbin/kamailio[857997]: INFO: >> {1783082372.401717 857991 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> INVITE}<script>: onreply_route - 200 : INVITE replied from >> sip:*.*.12.209:5253 with SIP 200 >> Jul 3 12:39:32 bl1650 /usr/local/sbin/kamailio[857996]: INFO: >> {1783082372.409421 857991 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> ACK}<script>: TRACK_ACK - saving ACK timestamp 1783082372.409075 >> *Jul 3 12:39:32 bl1650 /usr/local/sbin/kamailio[857996]: CRITICAL: >> {1783082372.409470 857991 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> <48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209> ACK}dialog [dlg_hash.c:127= 6]: >> next_state_dlg(): bogus event 6 in state 2 for dlg 0x7f4d7c886990 >> [193061:598258] with clid '48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209' = and >> tags '*.*.12.209+2+32486fa4+25838f19' ''* >> Jul 3 12:39:32 bl1650 /usr/local/sbin/kamailio[857996]: INFO: >> {1783082372.409553 857991 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> ACK}<script>: PIN_SOCKET - stored dlg_sock=3Dudp:10.242.17.147:5060 >> Jul 3 12:39:32 bl1650 /usr/local/sbin/kamailio[857996]: INFO: >> {1783082372.409604 857991 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> ACK}<script>: PIN_SOCKET - forcing <udp:10.242.17.147:5060> (recv udp: >> 10.242.17.147:5060) >> Jul 3 12:39:32 bl1650 /usr/local/sbin/kamailio[857996]: INFO: >> {1783082372.409631 857991 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> ACK}<script>: PIN_SOCKET - socket is pinned 0 >> Jul 3 12:39:42 bl1650 /usr/local/sbin/kamailio[858001]: INFO: >> {1783082382.429353 857991 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> BYE}<script>: WITHINDLG - method is BYE - going to TRACK_BYE >> Jul 3 12:39:42 bl1650 /usr/local/sbin/kamailio[858001]: INFO: >> {1783082382.429883 857991 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> BYE}<script>: TRACK_BYE - CALLED side finished the call >> Jul 3 12:39:42 bl1650 /usr/local/sbin/kamailio[858001]: INFO: >> {1783082382.429903 857991 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> BYE}<script>: TRACK_BYE - setting ts_bye_usec 1783082382.429388 and >> bye_originator *.*.12.209 sent from CALLED >> Jul 3 12:39:42 bl1650 /usr/local/sbin/kamailio[858001]: WARNING: >> {1783082382.429954 857991 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> BYE}<script>: WITHINDLG - BYE detected >> Jul 3 12:39:42 bl1650 /usr/local/sbin/kamailio[858001]: INFO: >> {1783082382.429982 857991 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> BYE}<script>: PIN_SOCKET - socket is pinned 1 >> Jul 3 12:39:42 bl1650 /usr/local/sbin/kamailio[858001]: INFO: >> {1783082382.430041 857991 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> BYE}<script>: MANAGE_BRANCH - initializing new branch [0] to >> sip:+33000000012@*.*.12.209:5242;transport=3Dudp;user=3Dphone >> Jul 3 12:39:42 bl1650 /usr/local/sbin/kamailio[858001]: INFO: >> {1783082382.430081 857991 1 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> BYE}<script>: MANAGE_BRANCH - Starting monitoring counter for endpoint >> sip:*.*.12.209:5242 from 10.242.17.147:5060 at 1783082382 >> Jul 3 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: >> {1783082382.437745 857991 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> BYE}<script>: onreply_route - 200 : BYE replied from sip:*.*.12.209:5242 >> with SIP 200 >> Jul 3 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: WARNING: >> {1783082382.437780 857991 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> BYE}<script>: onreply_route - BYE detected >> Jul 3 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: >> {1783082382.437800 857991 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> BYE}<script>: onreply_route - BYE and response received >> Jul 3 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: >> {1783082382.438136 857991 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> BYE}<script>: TRACK_BYE_200 - setting ts_bye_200ok_usec value >> 1783082382.437886 >> Jul 3 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: >> {1783082382.438162 857991 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> BYE}<script>: SEND_CALL_STATUS - checking call status t_check_status(200= ) =3D >> 200 ; method =3D BYE >> Jul 3 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: >> {1783082382.438392 857991 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> BYE}<script>: SEND_CALL_STATUS - crankback_history set to [] >> Jul 3 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: >> {1783082382.438441 857991 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> BYE}<script>: SEND_CALL_STATUS - processing BYE, checking if call was >> answered with t_check_status(200) =3D 200 >> Jul 3 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: >> {1783082382.438503 857991 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> BYE}<script>: SEND_CALL_STATUS - processing BYE, finished_by set to CALL= ED >> Jul 3 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: >> {1783082382.438549 857991 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> BYE}<script>: SEND_CALL_STATUS - processing BYE, bye_time set to >> 1783082382.429388 >> Jul 3 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: >> {1783082382.438597 857991 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> BYE}<script>: SEND_CALL_STATUS - processing BYE, invite_ack_time set to >> 1783082372.409075 >> Jul 3 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: >> {1783082382.438655 857991 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> BYE}<script>: SEND_CALL_STATUS - processing BYE, bye_200_time set to >> 1783082382.437886 - $var(cached_ack_time)=3D0; >> Jul 3 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: >> {1783082382.438694 857991 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> BYE}<script>: EV_MAKE_KEY - building event key for CALL_FINISH with hint >> BYE|-1 >> Jul 3 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: >> {1783082382.438924 857991 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> BYE}<script>: EV_GUARD_ONCE - first time (CALL_FINISH) >> key=3D[48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209|CALL_FINISH] -> SEND >> Jul 3 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: >> {1783082382.438964 857991 2 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209 >> BYE}<script>: SEND_CALL_STATUS - sending CALL_FINISH:{"call_id":" >> 48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209","from":"< >> sip:+33100001209@*.*.12.209:5253;user=3Dphone>;tag=3Dsip+2+b8f70030+683b= f4af","to":"+33000007 >> <sip:+33000000012@*.*.12.107;user=3Dphone >> >;tag=3D*.*.12.209+2+32486fa4+25838f19","timestamp":"1783082382.438283",= "tkg_eid":"101253","remote_ip_port":"*.*.12.209:5242","local_ip_port":"*.*.= 17.147:5060","crankback_history":[],"finished_by":"CALLED","bye_time":"1783= 082382.429388","invite_ack_time":"1783082372.409075","bye_200_time":"178308= 2382.437886","type":"CALL_FINISH"} >> >> >> >> My question is related with the lines above that I prefixed with *** and >> to log lines marked with orange background and bold fonts: I understand = the >> CRITICAL error on SIP 2 is due to the Finite State Machine (FSM) that do= es >> not expect a ACK/PRACK or 200 OK at this point, but I wonder if this is = an >> issue for processing calls? >> >> >> >> We have been testing at 2 CAPS and this issue happens quite often. We ar= e >> aiming to 2000 CAPS minimum, so the issue will be exponential and we can= 't >> go live like this, at least without knowing if there are any effects on >> calls. >> >> >> >> Thanks in advance. >> >> >> >> >> >> Atenciosamente / Kind Regards / Cordialement / Un saludo, >> >> >> >> *S=C3=A9rgio Charrua* >> >> *www.kahea.ai <http://www.kahea.ai> / www.voip.pt <http://www.voip.pt>* >> >> *OpenTelecom* - Consulting for Telecoms, Lda >> Tel.: +351 <callto:+351+91+104+12+66>91 631 11 44 >> >> Email : *[email protected] <[email protected]>* >> >> This message and any files or documents attached are strictly >> confidential or otherwise legally protected. >> >> It is intended only for the individual or entity named. If you are not >> the named addressee or have received this email in error, please inform = the >> sender immediately, delete it from your system and do not copy or disclo= se >> it or its contents or use it for any purpose. Please also note that >> transmission cannot be guaranteed to be secure or error-free. >> >> >> >> >> >> >> >> --000000000000dd12ef0656292c26 Content-Type: text/html; charset="UTF-8" Content-Transfer-Encoding: quoted-printable <div dir=3D"ltr"><div>Thanks Henning,</div><div><br></div><div>I did a mist= ake, we are not using 6.0.1 but 6.1.1.=C2=A0</div><div>From the release not= es and changelogs I see that 6.0.7 was release on 19 June but 6.1.1 was on = 25 May. I wonder if 6.1.1 has the same patches than 6.0.7.=C2=A0</div><div>= Can you confirm please?</div><div><br></div><div><br></div><div><div dir=3D= "ltr" class=3D"gmail_signature" data-smartmail=3D"gmail_signature"><div dir= =3D"ltr"><div dir=3D"ltr"><div dir=3D"ltr"><div dir=3D"ltr"><div dir=3D"ltr= "><p style=3D"color:rgb(0,0,0);margin:0px;font-family:Calibri,sans-serif;ba= ckground-color:rgb(253,253,253)"><span style=3D"font-family:Arial,sans-seri= f">Atenciosamente / Kind Regards / Cordialement / Un saludo,</span></p><p s= tyle=3D"color:rgb(0,0,0);margin:0px;font-family:Calibri,sans-serif;backgrou= nd-color:rgb(253,253,253)"><b><span style=3D"font-family:Arial,sans-serif">= <br></span></b></p><p style=3D"color:rgb(0,0,0);margin:0px;font-family:Cali= bri,sans-serif;background-color:rgb(253,253,253)"><b><span style=3D"font-fa= mily:Arial,sans-serif">S=C3=A9rgio Charrua</span></b></p><div><div dir=3D"l= tr"><p style=3D"font-size:11pt;color:rgb(0,0,0);margin:0px;font-family:Cali= bri,sans-serif;background-color:rgb(253,253,253)"><b><span style=3D"font-si= ze:9pt;font-family:Arial,sans-serif;color:red"><span style=3D"color:rgb(0,0= ,0)"></span><span style=3D"color:rgb(51,102,255)"><a href=3D"http://www.kah= ea.ai" target=3D"_blank">www.kahea.ai</a> /=C2=A0<a href=3D"http://www.voip= .pt" target=3D"_blank">www.voip.pt</a></span></span></b></p><p style=3D"mar= gin:0px;font-family:Calibri,sans-serif;background-color:rgb(253,253,253)"><= span style=3D"font-family:Arial,sans-serif"><span style=3D"font-size:12px">= <font color=3D"#000000"><b>OpenTelecom</b> - Consulting for Telecoms, Lda</= font><br></span></span><span style=3D"color:rgb(0,0,0);font-size:x-small;fo= nt-family:Arial,sans-serif">Tel.:=C2=A0<span style=3D"color:rgb(51,102,153)= "><a href=3D"callto:+351+91+104+12+66" style=3D"color:rgb(51,102,153);text-= decoration:none" target=3D"_blank">+351=C2=A0</a>91 631 11 44<br></span></s= pan><font color=3D"#000000" size=3D"1"><span style=3D"font-family:"Tim= es New Roman",serif"></span></font></p><p style=3D"font-size:11pt;colo= r:rgb(0,0,0);margin:0px;font-family:Calibri,sans-serif;background-color:rgb= (253,253,253)"><span style=3D"font-size:x-small"><span style=3D"font-family= :Arial,sans-serif;color:rgb(187,187,187)"><span style=3D"color:rgb(128,128,= 128)">Email :=C2=A0<strong><a href=3D"mailto:[email protected]" style= =3D"color:rgb(17,85,204)" target=3D"_blank">[email protected]</a>=C2= =A0/=C2=A0</strong></span></span></span><strong style=3D"color:rgb(128,128,= 128);font-family:Arial,sans-serif;font-size:x-small"><a href=3D"mailto:serg= [email protected]" style=3D"color:rgb(17,85,204)" target=3D"_blank">sergi= [email protected]</a>=C2=A0</strong><span style=3D"font-size:x-small"><spa= n style=3D"font-family:Arial,sans-serif;color:rgb(187,187,187)"><br></span>= </span></p><table border=3D"0" cellspacing=3D"0" cellpadding=3D"0" width=3D= "650" style=3D"width:487.5pt"> <tbody><tr> <td style=3D"padding:0cm"> <p class=3D"MsoNormal"><span lang=3D"EN-US" style=3D"font-family:"Vo= dafone Rg";color:rgb(204,204,204)">This message and any files or documents attached are strictly confidential or otherwis= e legally protected.=C2=A0</span></p><p class=3D"MsoNormal"><span lang=3D"E= N-US" style=3D"font-family:"Vodafone Rg";color:rgb(204,204,204)">= It is intended only for the individual or entity named. If you are not the named addressee or have received this email in error, ple= ase inform the sender immediately, delete it from your system and do not copy= or disclose it or its contents or use it for any purpose. Please also note t= hat transmission cannot be guaranteed to be secure or error-free. </span><spa= n lang=3D"EN-US" style=3D"font-family:"Times New Roman",serif"><s= pan></span></span></p> </td> </tr> </tbody></table><p style=3D"color:rgb(0,0,0);margin:0px;font-family:Calibri= ,sans-serif;background-color:rgb(253,253,253)"> <span style=3D"font-family:"Times New Roman",serif"></span></p><p= class=3D"MsoNormal"><span lang=3D"EN-US">=C2=A0</span></p><p style=3D"colo= r:rgb(0,0,0);margin:0px;font-family:Calibri,sans-serif;background-color:rgb= (253,253,253)">=C2=A0</p></div></div><div style=3D"font-size:small"><br><br= ></div></div></div></div></div></div></div></div><br></div><br><div class= =3D"gmail_quote gmail_quote_container"><div dir=3D"ltr" class=3D"gmail_attr= ">On Wed, Jul 8, 2026 at 2:07=E2=80=AFPM Sergio Charrua <<a href=3D"mail= to:[email protected]">[email protected]</a>> wrote:<br></div><= blockquote class=3D"gmail_quote" style=3D"margin:0px 0px 0px 0.8ex;border-l= eft:1px solid rgb(204,204,204);padding-left:1ex"><div dir=3D"ltr"><div>Ok, = I will try 6.0.7.</div><div><br></div><div>I share your expectations as wel= l... but it is not executed, i'm afraid.</div><div><br></div><div><br><= /div><div><div dir=3D"ltr" class=3D"gmail_signature"><div dir=3D"ltr"><div = dir=3D"ltr"><div dir=3D"ltr"><div dir=3D"ltr"><div dir=3D"ltr"><p style=3D"= color:rgb(0,0,0);margin:0px;font-family:Calibri,sans-serif;background-color= :rgb(253,253,253)"><span style=3D"font-family:Arial,sans-serif">Atenciosame= nte / Kind Regards / Cordialement / Un saludo,</span></p><p style=3D"color:= rgb(0,0,0);margin:0px;font-family:Calibri,sans-serif;background-color:rgb(2= 53,253,253)"><b><span style=3D"font-family:Arial,sans-serif"><br></span></b= ></p><p style=3D"color:rgb(0,0,0);margin:0px;font-family:Calibri,sans-serif= ;background-color:rgb(253,253,253)"><b><span style=3D"font-family:Arial,san= s-serif">S=C3=A9rgio Charrua</span></b></p><div><div dir=3D"ltr"><p style= =3D"font-size:11pt;color:rgb(0,0,0);margin:0px;font-family:Calibri,sans-ser= if;background-color:rgb(253,253,253)"><b><span style=3D"font-size:9pt;font-= family:Arial,sans-serif;color:red"><span style=3D"color:rgb(0,0,0)"></span>= <span style=3D"color:rgb(51,102,255)"><a href=3D"http://www.kahea.ai" targe= t=3D"_blank">www.kahea.ai</a> /=C2=A0<a href=3D"http://www.voip.pt" target= =3D"_blank">www.voip.pt</a></span></span></b></p><p style=3D"margin:0px;fon= t-family:Calibri,sans-serif;background-color:rgb(253,253,253)"><span style= =3D"font-family:Arial,sans-serif"><span style=3D"font-size:12px"><font colo= r=3D"#000000"><b>OpenTelecom</b> - Consulting for Telecoms, Lda</font><br><= /span></span><span style=3D"color:rgb(0,0,0);font-size:x-small;font-family:= Arial,sans-serif">Tel.:=C2=A0<span style=3D"color:rgb(51,102,153)"><a href= =3D"callto:+351+91+104+12+66" style=3D"color:rgb(51,102,153);text-decoratio= n:none" target=3D"_blank">+351=C2=A0</a>91 631 11 44<br></span></span><font= color=3D"#000000" size=3D"1"><span style=3D"font-family:"Times New Ro= man",serif"></span></font></p><p style=3D"font-size:11pt;color:rgb(0,0= ,0);margin:0px;font-family:Calibri,sans-serif;background-color:rgb(253,253,= 253)"><span style=3D"font-size:x-small"><span style=3D"font-family:Arial,sa= ns-serif;color:rgb(187,187,187)"><span style=3D"color:rgb(128,128,128)">Ema= il :=C2=A0<strong><a href=3D"mailto:[email protected]" style=3D"color:= rgb(17,85,204)" target=3D"_blank">[email protected]</a></strong></span= ><br></span></span></p><table border=3D"0" cellspacing=3D"0" cellpadding=3D= "0" width=3D"650" style=3D"width:487.5pt"> <tbody><tr> <td style=3D"padding:0cm"> <p class=3D"MsoNormal"><span lang=3D"EN-US" style=3D"font-family:"Vo= dafone Rg";color:rgb(204,204,204)">This message and any files or documents attached are strictly confidential or otherwis= e legally protected.=C2=A0</span></p><p class=3D"MsoNormal"><span lang=3D"E= N-US" style=3D"font-family:"Vodafone Rg";color:rgb(204,204,204)">= It is intended only for the individual or entity named. If you are not the named addressee or have received this email in error, ple= ase inform the sender immediately, delete it from your system and do not copy= or disclose it or its contents or use it for any purpose. Please also note t= hat transmission cannot be guaranteed to be secure or error-free. </span><spa= n lang=3D"EN-US" style=3D"font-family:"Times New Roman",serif"><s= pan></span></span></p> </td> </tr> </tbody></table><p style=3D"color:rgb(0,0,0);margin:0px;font-family:Calibri= ,sans-serif;background-color:rgb(253,253,253)"> <span style=3D"font-family:"Times New Roman",serif"></span></p><p= class=3D"MsoNormal"><span lang=3D"EN-US">=C2=A0</span></p><p style=3D"colo= r:rgb(0,0,0);margin:0px;font-family:Calibri,sans-serif;background-color:rgb= (253,253,253)">=C2=A0</p></div></div><div style=3D"font-size:small"><br><br= ></div></div></div></div></div></div></div></div><br></div><br><div class= =3D"gmail_quote"><div dir=3D"ltr" class=3D"gmail_attr">On Wed, Jul 8, 2026 = at 12:49=E2=80=AFPM Henning Westerholt <<a href=3D"mailto:[email protected]"= target=3D"_blank">[email protected]</a>> wrote:<br></div><blockquote class= =3D"gmail_quote" style=3D"margin:0px 0px 0px 0.8ex;border-left:1px solid rg= b(204,204,204);padding-left:1ex"><div> <div lang=3D"EN-GB"> <div> <p class=3D"MsoNormal"><span style=3D"font-size:11pt">Hello Sergio,<u></u><= u></u></span></p> <p class=3D"MsoNormal"><span style=3D"font-size:11pt"><u></u>=C2=A0<u></u><= /span></p> <p class=3D"MsoNormal"><span style=3D"font-size:11pt">I would recommend upd= ating to the latest 6.0.7 alone for security reasons. <u></u><u></u></span></p> <p class=3D"MsoNormal"><span style=3D"font-size:11pt"><u></u>=C2=A0<u></u><= /span></p> <p class=3D"MsoNormal"><span style=3D"font-size:11pt">Regarding the PR impr= ovement, Stefan already replied to your e-mail as well. Maybe you can give = this a try.<u></u><u></u></span></p> <p class=3D"MsoNormal"><span style=3D"font-size:11pt"><u></u>=C2=A0<u></u><= /span></p> <p class=3D"MsoNormal"><span style=3D"font-size:11pt">I would expect that t= he MANAGE_REPLY onreply route is executed regardless of an internal dialog = issue. The first one is related to a dialog, and the latter to the SIP tran= saction of course.<u></u><u></u></span></p> <p class=3D"MsoNormal"><span style=3D"font-size:11pt"><u></u>=C2=A0<u></u><= /span></p> <p class=3D"MsoNormal"><span style=3D"font-size:11pt">Cheers,<u></u><u></u>= </span></p> <p class=3D"MsoNormal"><span style=3D"font-size:11pt"><u></u>=C2=A0<u></u><= /span></p> <p class=3D"MsoNormal"><span style=3D"font-size:11pt">Henning<u></u><u></u>= </span></p> <p class=3D"MsoNormal"><span style=3D"font-size:11pt"><u></u>=C2=A0<u></u><= /span></p> <div style=3D"border-width:medium medium medium 1.5pt;border-style:none non= e none solid;border-color:currentcolor currentcolor currentcolor blue;paddi= ng:0cm 0cm 0cm 4pt"> <div> <div style=3D"border-width:1pt medium medium;border-style:solid none none;b= order-color:rgb(225,225,225) currentcolor currentcolor;padding:3pt 0cm 0cm"= > <p class=3D"MsoNormal"><b><span style=3D"font-family:Calibri,sans-serif">Fr= om:</span></b><span style=3D"font-family:Calibri,sans-serif"> Sergio Charru= a <<a href=3D"mailto:[email protected]" target=3D"_blank">sergio.ch= [email protected]</a>> <br> <b>Sent:</b> Mittwoch, 8. Juli 2026 12:38<br> <b>To:</b> Henning Westerholt <<a href=3D"mailto:[email protected]" target= =3D"_blank">[email protected]</a>><br> <b>Cc:</b> Kamailio (SER) - Users Mailing List <<a href=3D"mailto:sr-use= [email protected]" target=3D"_blank">[email protected]</a>>= ;<br> <b>Subject:</b> Re: [SR-Users] DMQ issues and CRITICAL errors<u></u><u></u>= </span></p> </div> </div> <p class=3D"MsoNormal"><u></u>=C2=A0<u></u></p> <div> <p class=3D"MsoNormal">Hey Henning,<br> <br> I am running version 6.0.1.=C2=A0<u></u><u></u></p> <div> <p class=3D"MsoNormal">DMQ and other module params are as follows:<u></u><u= ></u></p> </div> <div> <p class=3D"MsoNormal"><u></u>=C2=A0<u></u></p> </div> <div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= modparam("dmq", =C2=A0 =C2=A0 =C2=A0 =C2=A0 "server_address&= quot;, =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 "<a>sip:10.20.0.4:5062;trans= port=3Dudp</a>" )<br> modparam("dmq", =C2=A0 =C2=A0 =C2=A0 =C2=A0 "notification_ad= dress", =C2=A0 =C2=A0 "<a>sip:10.20.0.1:5060;transport=3Dudp</a>&= quot; )<br> modparam("dmq", =C2=A0 =C2=A0 =C2=A0 =C2=A0 "multi_notify&qu= ot;, =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 0) =C2=A0 =C2=A0 =C2=A0 =C2= =A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 = =C2=A0 =C2=A0 =C2=A0<br> modparam("dmq", =C2=A0 =C2=A0 =C2=A0 =C2=A0 "num_workers&quo= t;, =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A012) =C2=A0 =C2=A0 =C2= =A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 = =C2=A0 =C2=A0 =C2=A0 <br> modparam("dmq", =C2=A0 =C2=A0 =C2=A0 =C2=A0 "ping_interval&q= uot;, =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A060) =C2=A0 =C2=A0 =C2=A0 =C2= =A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 = =C2=A0 =C2=A0<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2= =A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 = =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2= =A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 = =C2=A0 =C2=A0=C2=A0</span><u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= modparam("dialog", =C2=A0 =C2=A0 =C2=A0"db_mode", =C2= =A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A00)</span><u></u>= <u></u></p> </div> <div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= modparam("dialog", =C2=A0 =C2=A0 =C2=A0"enable_dmq", = =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 1)</span><u></u><u></u></p= > </div> <div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= modparam("dialog", =C2=A0 =C2=A0 =C2=A0"timer_procs", = =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A01) =C2=A0 =C2=A0 =C2=A0 =C2= =A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 <br> modparam("dialog", =C2=A0 =C2=A0 =C2=A0"db_fetch_rows",= =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0500) =C2=A0 =C2=A0 =C2=A0 =C2=A0 = =C2=A0 =C2=A0 =C2=A0 =C2=A0 <br> modparam("dialog", =C2=A0 =C2=A0 =C2=A0"track_cseq_updates&q= uot;, =C2=A0 =C2=A01) =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2= =A0 =C2=A0 <br> modparam("dialog", =C2=A0 =C2=A0 =C2=A0"dlg_match_mode"= , =C2=A0 =C2=A01) =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 = =C2=A0 <br> modparam("dialog", =C2=A0 =C2=A0 =C2=A0"default_timeout"= ;, =C2=A0 =C2=A0CALL_TIME_LIMIT) =C2=A0 =C2=A0 <br> modparam("dialog", =C2=A0 =C2=A0 =C2=A0"send_bye", =C2= =A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 0) =C2=A0 =C2=A0 =C2= =A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 <br> modparam("dialog", =C2=A0 =C2=A0 =C2=A0"early_timeout",= =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0300) =C2=A0 =C2=A0 =C2=A0 =C2=A0 = =C2=A0 =C2=A0 =C2=A0 =C2=A0 <br> modparam("dialog", =C2=A0 =C2=A0 =C2=A0"noack_timeout",= =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A060) =C2=A0 =C2=A0 =C2=A0 =C2=A0 = =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0<br> modparam("dialog", =C2=A0 =C2=A0 =C2=A0"hash_size", =C2= =A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0262144)=C2=A0 =C2=A0 =C2=A0 =C2=A0 = =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2= =A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 = =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0=C2=A0<br> modparam("dialog", =C2=A0 =C2=A0 =C2=A0"enable_stats", = =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 1)=C2=A0 =C2=A0 =C2=A0 =C2=A0</sp= an><u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><u></u>=C2=A0<u></u></p> </div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= modparam("htable", =C2=A0 =C2=A0 =C2=A0"htable", "= evsent=3D>size=3D2048;autoexpire=3D600;dbmode=3D0;dmqreplicate=3D1"= )=C2=A0<br> modparam("htable", =C2=A0 =C2=A0 =C2=A0"htable", "= evapistatus=3D>size=3D1;autoexpire=3D0;dbmode=3D0;dmqreplicate=3D0;initv= al=3D0") modparam("htable", =C2=A0 =C2=A0 =C2=A0"htable= ", "gw_last=3D>size=3D16;autoexpire=3D50;dmqreplicate=3D0;upda= teexpire=3D1")=C2=A0<br> modparam("htable", =C2=A0 =C2=A0 =C2=A0"htable", "= gw_local=3D>size=3D16;autoexpire=3D0;dbmode=3D0;dmqreplicate=3D1;updatee= xpire=3D1")=C2=A0<br> modparam("htable", =C2=A0 =C2=A0 =C2=A0"htable", "= sbcstatus=3D>size=3D64;autoexpire=3D3600;dbmode=3D0;dmqreplicate=3D0&quo= t;)=C2=A0<br> modparam("htable", =C2=A0 =C2=A0 =C2=A0"htable", "= gw_probe=3D>size=3D16;autoexpire=3D0;dmqreplicate=3D0;initval=3D-1"= )=C2=A0<br> modparam("htable", =C2=A0 =C2=A0 =C2=A0"htable", "= local_bye=3D>size=3D13;autoexpire=3D120;dbmode=3D0;dmqreplicate=3D1;&quo= t;)</span><u></u><u></u></p> <div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= modparam("htable", =C2=A0 =C2=A0 =C2=A0"htable", "= ha_state=3D>size=3D2;autoexpire=3D0M")=C2=A0</span><br> <br> I'll check the recent PRs on DMQ dialog behavior. I was hoping the issu= e was just related to the FSM state mismatch on failover, but if there are = known improvements I should definitely check them.<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><u></u>=C2=A0<u></u></p> </div> <div> <p class=3D"MsoNormal">Some additional script lines:<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><u></u>=C2=A0<u></u></p> </div> <div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= request_route{</span><u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= =C2=A0 =C2=A0 =C2=A0 route(HANDLE_DMQ);</span><u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= =C2=A0 =C2=A0 =C2=A0=C2=A0route(HANDLE_RETRANS);</span><u></u><u></u></p> </div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= =C2=A0 =C2=A0 =C2=A0=C2=A0route(REQINIT);<br> =C2=A0 =C2=A0 =C2=A0 route(HANDLE_CANCEL);<br> =C2=A0 =C2=A0 =C2=A0 route(WITHINDLG);</span><u></u><u></u></p> <div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= =C2=A0 =C2=A0 =C2=A0 if (is_method("INVITE"))<br> =C2=A0 =C2=A0 =C2=A0 {<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 # record routing for dialog formi= ng requests (in case they are routed)<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 # - remove preloaded route header= s<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 remove_hf("Route");<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 record_route();<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 route(RESET_VARS);<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 dlg_manage();<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 route(HANDLE_INVITE);<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 exit;<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 }<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0<br> =C2=A0 =C2=A0 route(RELAY);<br> =C2=A0 =C2=A0 exit;</span><u></u><u></u></p> <div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= }</span><u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><u></u>=C2=A0<u></u></p> </div> <div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= route[HANDLE_DMQ]<br> {<br> =C2=A0 =C2=A0 if( is_method("KDMQ") && $rp =3D=3D DMQ_POR= T)<br> =C2=A0 =C2=A0 {<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 dmq_handle_message(); <br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 exit;<br> =C2=A0 =C2=A0 } <br> }</span><u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><u></u>=C2=A0<u></u></p> </div> <div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= route[TRACK_ACK] { =C2=A0 =C2=A0<br> =C2=A0 =C2=A0 # Guard: only record the first ACK (re-INVITEs also produce A= CKs)<br> =C2=A0 =C2=A0 if ($dlg_var(ts_ack_usec) !=3D $null) {<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 return;<br> =C2=A0 =C2=A0 }<br> =C2=A0 =C2=A0 $dlg_var(ts_ack_usec) =3D $TV(Sn);<br> =C2=A0 =C2=A0 $sht(local_bye=3D>$ci|ack_time) =3D $dlg_var(ts_ack_usec);= =C2=A0 # capture-time write (dialog:end may never fire on an adopted repli= ca)<br> =C2=A0 =C2=A0 xlog("L_INFO","TRACK_ACK - saving ACK timestam= p $dlg_var(ts_ack_usec) \n");<br> }</span><u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><u></u>=C2=A0<u></u></p> </div> <div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= onreply_route{<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0=C2=A0<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 xlog("L_INFO","onreply_route - $= rs : $rm replied from <a> sip:$si:$sp</a> with SIP $T_reply_code \n");<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 if (is_method("BYE")) <br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 {<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 xlog("L_WARN","onr= eply_route - BYE detected\n");<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 if ($mt =3D=3D 2) <br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 {<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 xlog("L_INFO&q= uot;,"onreply_route - BYE and response received\n");<br> =C2=A0 =C2=A0 <br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 # Atomically read-a= nd-consume the htable snapshot.<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 # sht_lock prevents= the second process from reading<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 # the same values a= nd sending a duplicate CALL_FINISH.<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 if ($sht(local_bye= =3D>$ci|is_local) =3D=3D 1) <br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 {<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 xlog(= "L_INFO","onreply_route - local BYE detected for call_id $ci= - restoring cached values for CALL_FINISH\n");<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 $var(= islocal) =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =3D 1; =C2=A0 =C2=A0 =C2=A0 =C2= =A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 } =C2=A0 =C2=A0 =C2= =A0 =C2=A0 =C2=A0 =C2=A0<br> =C2=A0 =C2=A0 <br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 route(TRACK_BYE_200= );<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 route(SEND_CALL_STA= TUS);<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 }<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 }<br> }</span><u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><u></u>=C2=A0<u></u></p> </div> <div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= onreply_route[MANAGE_REPLY] {<br> =C2=A0 =C2=A0 xlog("L_INFO", "MANAGE_REPLY - Incoming reply = $rm $rs \n");<br> <br> =C2=A0 =C2=A0 $var(statuskey) =3D "sip:" + $si + ":" + = $sp;<br> =C2=A0 =C2=A0 <br> =C2=A0 =C2=A0 // the outbound endpoint replied something, so it is alive!<b= r> =C2=A0 =C2=A0 xlog("L_INFO", "MANAGE_REPLY - Starting monito= ring counter for endpoint $var(statuskey) \n");<br> =C2=A0 =C2=A0 $sht(gw_last=3D>$var(statuskey)) =3D $Ts; =C2=A0 =C2=A0# r= emember last INVITE time<br> =C2=A0 =C2=A0 if (status =3D=3D "100"){<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 xlog("L_INFO","MANAGE_REPLY - Fo= rwarding 100 Trying \n"); =C2=A0 =C2=A0 =C2=A0 =C2=A0<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 route(RESET_FAILURE_COUNTER);<br> =C2=A0 =C2=A0 }<br> =C2=A0 =C2=A0 else if (status =3D~ "^(180|183)$" || $rs =3D~ &quo= t;^(180|183)$" )<br> =C2=A0 =C2=A0 {<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 xlog("L_INFO","MANAGE_REPLY - Fo= rwarding 180/183 Session Progress\n"); <br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 $dlg_var(first_18x_ts) =3D $TV(Sn);<br> <br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 if (status =3D=3D "180")<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 $dlg_var(first_180_ts) =3D $TV(Sn= );<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 else if (status =3D=3D "183") <br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 $dlg_var(first_183_ts) =3D $TV(Sn= );<br> <br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 if ($dlg_var(first_180_ts) !=3D $null)<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 $sht(local_bye=3D>$ci|180_time= ) =3D $dlg_var(first_180_ts); =C2=A0 # capture-time write<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 if ($dlg_var(first_183_ts) !=3D $null)<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 $sht(local_bye=3D>$ci|183_time= ) =3D $dlg_var(first_183_ts); =C2=A0 # capture-time write<br> <br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 xlog("L_INFO","MANAGE_REPLY - se= tting Ringing Timestamp to $dlg_var(first_18x_ts)"); =C2=A0 =C2=A0 =C2= =A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 <br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 route(RESET_FAILURE_COUNTER);<br> =C2=A0 =C2=A0 } =C2=A0 =C2=A0<br> =C2=A0 =C2=A0 else if (status =3D=3D "200")<br> =C2=A0 =C2=A0 {<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 if ($dlg_var(ts_200ok_usec) =3D=3D $null || $dl= g_var(ts_200ok_usec) =3D=3D "") =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2= =A0 =C2=A0<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0route(CALL_CONNECT);<br> =C2=A0 =C2=A0 } <br> =C2=A0 =C2=A0 else if (status =3D=3D "487")<br> =C2=A0 =C2=A0 {<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 xlog("L_INFO","MANAGE_REPLY - Fo= rwarding 487 Request Terminated on Caller's side\n");<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 route(RESET_FAILURE_COUNTER);<br> =C2=A0 =C2=A0 } =C2=A0 =C2=A0<br> =C2=A0 =C2=A0 else if (status =3D~ "4[0-9][0-9]|5[0-9][0-9]|6[0-9][0-9= ]")<br> =C2=A0 =C2=A0 {<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 xlog("L_INFO","MANAGE_REPLY - CA= LL REJECTED with code $T_reply_code !! \n");<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 $var(type) =3D "CALL_REJECT";<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 route(RESET_FAILURE_COUNTER); =C2=A0 =C2=A0 =C2= =A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 route(SPOOL_CALL_STATUS); =C2=A0 =C2=A0 =C2=A0 = =C2=A0 <br> =C2=A0 =C2=A0 }<br> }</span><u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><u></u>=C2=A0<u></u></p> </div> <div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= failure_route[MANAGE_FAILURE] {</span><u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= =C2=A0 .... standard failure handling ....</span><u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= }</span><u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><u></u>=C2=A0<u></u></p> </div> <div> <p class=3D"MsoNormal"><u></u>=C2=A0<u></u></p> </div> <div> <p class=3D"MsoNormal"><u></u>=C2=A0<u></u></p> </div> <div> <p class=3D"MsoNormal">the rest of the script does the normal processing of= the call, including EVAPI requests to get list of routes, crankback in cas= e of failures, etc....=C2=A0<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">on the=C2=A0<span style=3D"font-family:"Courier= New"">MANAGE_REPLY </span> <span style=3D"font-family:Arial,sans-serif">upon call answer (200 OK) a ca= ll to CALL_CONNECT is executed.</span><u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><span style=3D"font-family:Arial,sans-serif">What I = have found so far is that upon a CRITICAL error as listed in the provided l= ogs, the=C2=A0</span> <span style=3D"font-family:"Courier New"">MANAGE_REPLY </span><sp= an style=3D"font-family:Arial,sans-serif">is not executed, but only the glo= bal onreply_route{ }</span>=C2=A0<span style=3D"font-family:Arial,sans-seri= f">=C2=A0is. So, routing engine is not notified of the call being answered implying that CDR is not started and some of the $dlg_= var() with timestamps are not initiated.</span><u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><span style=3D"font-family:Arial,sans-serif">However= , the CALL_FINISH route (not provided here) is executed with some missing v= alues, because=C2=A0</span> <span style=3D"font-family:"Courier New"">MANAGE_REPLY=C2=A0</spa= n><span style=3D"font-family:Arial,sans-serif">wasn't executed, which i= s also an issue for the routing engine.</span><u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><span style=3D"font-family:Arial,sans-serif">I solve= d the missing CALL_CONNECT by adding following lines to the global onreply_= route{}:</span><u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= =C2=A0 =C2=A0 =C2=A0 ....</span><u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= =C2=A0 =C2=A0 =C2=A0 else if (is_method("INVITE|UPDATE") &&am= p; $rs >=3D 200 && $rs < 300) <br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 {<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 xlog("L_INFO","onr= eply_route - INVITE/UPDATE 2xx replied from <a> sip:$si:$sp</a> with SIP $T_reply_code \n");<br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 =C2=A0 route(CALL_CONNECT); =C2=A0 =C2= =A0 =C2=A0 <br> =C2=A0 =C2=A0 =C2=A0 =C2=A0 }</span><u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= =C2=A0 =C2=A0 =C2=A0 ...</span><u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><u></u>=C2=A0<u></u></p> </div> <div> <p class=3D"MsoNormal">but I'm finding weird that the MANAGE_REPLY rout= e being not called, eventually due to the CRITICAL error....<u></u><u></u><= /p> </div> <div> <p class=3D"MsoNormal"><u></u>=C2=A0<u></u></p> </div> <div> <p class=3D"MsoNormal">If you check the logs, the global onreply_route{} is= executed when a 200 OK is received:<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= onreply_route - 200 : INVITE replied from <a>sip:*.*.12.209:5253</a> with SIP 200</span><u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><span style=3D"font-family:Arial,sans-serif">And the= n the route TRACK_ACK is executed too, assigning ACK timestamp to a $dlg_va= r(). Right after that, the CRITICAL error is thrown and the=C2=A0</span><sp= an style=3D"font-family:"Courier New"">MANAGE_REPLY </span><span style=3D"font-family:Arial,sans-serif">is not executed.=C2=A0<= /span><u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><u></u>=C2=A0<u></u></p> </div> <div> <div> <p class=3D"MsoNormal">Is that an expected behaviour? I would expect that t= he <span style=3D"font-family:"Courier New""> MANAGE_REPLY </span>route be executed after the global onreply_route{} as u= sual even after a CRITICAL error.....<u></u><u></u></p> </div> </div> <div> <p class=3D"MsoNormal">Note that the call is still processed normally, just= the=C2=A0<span style=3D"font-family:"Courier New"">MANAGE_REPLY= =C2=A0</span><span style=3D"font-family:Arial,sans-serif">is ignored. But w= hy?</span><u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><u></u>=C2=A0<u></u></p> </div> <div> <p class=3D"MsoNormal"><u></u>=C2=A0<u></u></p> </div> <div> <div> <div> <div> <div> <div> <div> <div> <p style=3D"margin:0cm;background:rgb(253,253,253)"><span style=3D"font-fam= ily:Arial,sans-serif;color:black">Atenciosamente / Kind Regards / Cordialem= ent / Un saludo,</span><span style=3D"font-family:Calibri,sans-serif;color:= black"><u></u><u></u></span></p> <p style=3D"margin:0cm;background:rgb(253,253,253)"><span style=3D"font-fam= ily:Calibri,sans-serif;color:black"><u></u>=C2=A0<u></u></span></p> <p style=3D"margin:0cm;background:rgb(253,253,253)"><b><span style=3D"font-= family:Arial,sans-serif;color:black">S=C3=A9rgio Charrua</span></b><span st= yle=3D"font-family:Calibri,sans-serif;color:black"><u></u><u></u></span></p= > <div> <div> <p style=3D"margin:0cm;background:rgb(253,253,253)"><b><span style=3D"font-= size:9pt;font-family:Arial,sans-serif;color:rgb(51,102,255)"><a href=3D"htt= p://www.kahea.ai" target=3D"_blank">www.kahea.ai</a> /=C2=A0<a href=3D"http= ://www.voip.pt" target=3D"_blank">www.voip.pt</a></span></b><span style=3D"= font-size:11pt;font-family:Calibri,sans-serif;color:black"><u></u><u></u></= span></p> <p style=3D"margin:0cm;background:rgb(253,253,253)"><b><span style=3D"font-= size:9pt;font-family:Arial,sans-serif;color:black">OpenTelecom</span></b><s= pan style=3D"font-size:9pt;font-family:Arial,sans-serif;color:black"> - Con= sulting for Telecoms, Lda<br> </span><span style=3D"font-size:10pt;font-family:Arial,sans-serif;color:bla= ck">Tel.:=C2=A0</span><span style=3D"font-size:10pt;font-family:Arial,sans-= serif;color:rgb(51,102,153)"><a href=3D"callto:+351+91+104+12+66" target=3D= "_blank"><span style=3D"color:rgb(51,102,153);text-decoration:none">+351=C2= =A0</span></a>91 631 11 44</span><span style=3D"font-family:Calibri,sans-serif"><u></u><u><= /u></span></p> <p style=3D"margin:0cm;background:rgb(253,253,253)"><span style=3D"font-siz= e:10pt;font-family:Arial,sans-serif;color:gray">Email :=C2=A0<strong><span = style=3D"font-family:Arial,sans-serif"><a href=3D"mailto:sergio.charrua@voi= p.pt" target=3D"_blank"><span style=3D"color:rgb(17,85,204)">sergio.charrua= @voip.pt</span></a></span></strong></span><span style=3D"font-size:11pt;fon= t-family:Calibri,sans-serif;color:black"><u></u><u></u></span></p> <table border=3D"0" cellspacing=3D"0" cellpadding=3D"0" width=3D"650" style= =3D"width:487.5pt"> <tbody> <tr> <td style=3D"padding:0cm"> <p class=3D"MsoNormal"><span lang=3D"EN-US" style=3D"font-family:"Voda= fone Rg",serif;color:rgb(204,204,204)">This message and any files or d= ocuments attached are strictly confidential or otherwise legally protected.= =C2=A0</span><u></u><u></u></p> <p class=3D"MsoNormal"><span lang=3D"EN-US" style=3D"font-family:"Voda= fone Rg",serif;color:rgb(204,204,204)">It is intended only for the ind= ividual or entity named. If you are not the named addressee or have receive= d this email in error, please inform the sender immediately, delete it from = your system and do not copy or disclose it or its contents or use it for an= y purpose. Please also note that transmission cannot be guaranteed to be se= cure or error-free. </span><u></u><u></u></p> </td> </tr> </tbody> </table> <p class=3D"MsoNormal"><span lang=3D"EN-US">=C2=A0</span><u></u><u></u></p> <p style=3D"margin:0cm;background:rgb(253,253,253)"><span style=3D"font-fam= ily:Calibri,sans-serif;color:black">=C2=A0<u></u><u></u></span></p> </div> </div> <div> <p class=3D"MsoNormal" style=3D"margin-bottom:12pt"><u></u>=C2=A0<u></u></p= > </div> </div> </div> </div> </div> </div> </div> </div> <p class=3D"MsoNormal"><u></u>=C2=A0<u></u></p> </div> </div> </div> <p class=3D"MsoNormal"><u></u>=C2=A0<u></u></p> <div> <div> <p class=3D"MsoNormal">On Wed, Jul 8, 2026 at 11:44<span style=3D"font-fami= ly:Arial,sans-serif">=E2=80=AF</span>AM Henning Westerholt <<a href=3D"m= ailto:[email protected]" target=3D"_blank">[email protected]</a>> wrote:<u></u><= u></u></p> </div> <blockquote style=3D"border-width:medium medium medium 1pt;border-style:non= e none none solid;border-color:currentcolor currentcolor currentcolor rgb(2= 04,204,204);padding:0cm 0cm 0cm 6pt;margin-left:4.8pt;margin-right:0cm"> <div> <div> <div> <p class=3D"MsoNormal"><span style=3D"font-size:11pt">Hello,</span><u></u><= u></u></p> <p class=3D"MsoNormal"><span style=3D"font-size:11pt">=C2=A0</span><u></u><= u></u></p> <p class=3D"MsoNormal"><span style=3D"font-size:11pt">I can not comment on = the effect of the error in the dialog module on your calls as it depends on= your configuration dialog module usage.</span><u></u><u></u></p> <p class=3D"MsoNormal"><span style=3D"font-size:11pt">=C2=A0</span><u></u><= u></u></p> <p class=3D"MsoNormal"><span style=3D"font-size:11pt">There have been some = PRs recently to improve the behaviour of DMQ dialog behaviour, some of them= already get merged.</span><u></u><u></u></p> <p class=3D"MsoNormal"><span style=3D"font-size:11pt">=C2=A0</span><u></u><= u></u></p> <p class=3D"MsoNormal"><span style=3D"font-size:11pt">I did not saw your Ka= mailio version that you are using, so it=E2=80=99s difficult to say if you = already have them integrated.</span><u></u><u></u></p> <p class=3D"MsoNormal"><span style=3D"font-size:11pt">=C2=A0</span><u></u><= u></u></p> <p class=3D"MsoNormal"><span style=3D"font-size:11pt">Cheers,</span><u></u>= <u></u></p> <p class=3D"MsoNormal"><span style=3D"font-size:11pt">=C2=A0</span><u></u><= u></u></p> <p class=3D"MsoNormal"><span style=3D"font-size:11pt">Henning</span><u></u>= <u></u></p> <p class=3D"MsoNormal"><span style=3D"font-size:11pt">=C2=A0</span><u></u><= u></u></p> <div style=3D"border-width:medium medium medium 1.5pt;border-style:none non= e none solid;padding:0cm 0cm 0cm 4pt;border-color:currentcolor currentcolor= currentcolor blue"> <div> <div style=3D"border-width:1pt medium medium;border-style:solid none none;p= adding:3pt 0cm 0cm;border-color:currentcolor"> <p class=3D"MsoNormal"><b><span style=3D"font-family:Calibri,sans-serif">Fr= om:</span></b><span style=3D"font-family:Calibri,sans-serif"> Sergio Charru= a via sr-users <<a href=3D"mailto:[email protected]" target=3D= "_blank">[email protected]</a>> <br> <b>Sent:</b> Freitag, 3. Juli 2026 17:52<br> <b>To:</b> Kamailio (SER) - Users Mailing List <<a href=3D"mailto:sr-use= [email protected]" target=3D"_blank">[email protected]</a>>= ;<br> <b>Cc:</b> Sergio Charrua <<a href=3D"mailto:[email protected]" tar= get=3D"_blank">[email protected]</a>><br> <b>Subject:</b> [SR-Users] DMQ issues and CRITICAL errors</span><u></u><u><= /u></p> </div> </div> <p class=3D"MsoNormal">=C2=A0<u></u><u></u></p> <div> <div> <p class=3D"MsoNormal">Hi all,<br clear=3D"all"> <u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">=C2=A0<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">have a standard HA setup using 2 kamailio nodes (SIP= 1 and SIP 2) and a VIP managed by Keepalid service.<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">Both kamailio nodes use same configuration and while= one is the Active node (where the VIP is present) the other is Backup node= . Not rocket science.<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">We use DMQ to share dialog data between nodes, using= a second IP:Port address (Node 1 is .126:5062 , Node 2 is .125:5062)<u></u= ><u></u></p> </div> <div> <p class=3D"MsoNormal">The VIP is .147 and=C2=A0SIP is listened on the VIP = at .147:5060<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">=C2=A0<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">Here is the test scenario:<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">- SIP 1 (Active node) receives the initial INVITE, r= equests Routing Engine for a list of routes (uses EVAPI script who interact= s with a REST service)<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">- call is routed to egress endpoint according to the= route list received<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">- some SIP 183 is replied back and forwarded to ingr= ess endpoint<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">- a PRACK is received as a reply from the previous S= IP 183 and kamailio forwards to egress side<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">- *** Kamailio SIP 1 instance is stopped (service ka= mailio stop) ****<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">- VIP switches to node SIP 2<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">- SIP 2 gets a reply SIP 200 OK from egress side (as= suming a retransmission)=C2=A0<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">- *** CRITICAL error is logged with :=C2=A0<u></u><u= ></u></p> </div> <div> <p class=3D"MsoNormal">CRITICAL: {1783082372.409470 857991 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> ACK}dialog [dlg_hash.= c:1276]: next_state_dlg(): bogus event 6 in state 2 for dlg 0x7f4d7c886990 = [193061:598258] with clid '48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209&= #39; and tags '*.*.12.209+2+32486fa4+25838f19' ''<u></u><u></u>= </p> </div> <div> <p class=3D"MsoNormal">- *** there should be a call to EVAPI script to noti= fy the call was answered (CALL_CONNECT notification) but there is none=C2= =A0 ----> Meanwhile i solved this, and CALL_CONNECT is sent event if there is a CRITICAL event<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">- call seems to continue perfectly until BYE is rece= ived and a EVAPI script is notified with a CALL_FINISH request<u></u><u></u= ></p> </div> <div> <p class=3D"MsoNormal">=C2=A0<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">Here are the logs on SIP 1 who received the initial = INVITE:<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><span style=3D"font-family:"Courier New"">= Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930200]: INFO: {178308= 2368.672371 930193 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : Processing INVITE from *.*.12.209:5242 to <a>sip:+33100001209@*.*.12.137:5242;user=3Dphone</a><br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930200]: INFO: {178308= 2368.673719 930193 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : HANDLE_INVITE - suspended transaction for INVITE INVITE:::{"sip_invi= te":{"Via":"SIP/2.0/UDP *.*.12.209:5242;branch=3Dz9hG4b= K+bb3831916f972b133610a3eb7d60da343+sip+2+a65dede3","From":&= quot;\"+33000007\" <<a>sip:+33000000012@*.*.12.107;user=3Dphone</a>>;tag=3D*.*.12.209+2= +32486fa4+25838f19","To":"<<a>sip:+33100001209@*.*.1= 2.137;user=3Dphone</a>>","CSeq":"1 INVITE",&quo= t;Content-Length":"175","Supported":"timer,hi= stinfo,replaces, 100rel","P-Charging-Vector":"icid-value=3D1a18eec80dbf= 1bcaa957e9322967a9d7;orig-ioi=3DBICS","Contact":"<<a= >sip:+33000000012@*.*.12.209:5242;transport=3Dudp;user=3Dphone</a>>"= ;,"Content-Type":"application/sdp","Call-ID":= "<a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target= =3D"_blank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a>","Acc= ept":"application/sdp, application/isup, application/dtmf,multipart/mixed","Max-Forward= s":"68","Session-Expires":"1800","M= in-SE":"90","P-Asserted-Identity":"\"+33= 000000012\" <<a>sip:+33000000012@*.*.12.107;user=3Dphone</a>>&qu= ot;,"X-REFERRED-BY":["<<a>sip:[email protected]= .microsoft.com:5060;user=3Dphone</a>>","<<a>sip:+6436684385= @sip.gcs.pstnhub.microsoft.com:5060;user=3Dphone</a>>"],"X-tgr= p":"CloudCom","X-Test":"CC_Outb_23",&quo= t;X-bababa-PID":"11283","X-History-Info":["&l= t;<a>sip:+380930539504@*.*.12.107;user=3Dphone;cause=3D408</a>>;index=3D= 1","<<a>sip:380930539504@*.*.12.107;user=3Dphone;cause=3D486;t= ransport=3Dudp</a>>;index=3D1.1","<<a>sip:+3354806000999@*.= *.12.110:5060?reason=3DSIP%3Bcause%3D302</a>>;index=3D1,<<a>sip:+3396= 9990333@*.*.12.110:5060;user=3Dphone</a>>;index=3D1.1,<<a>sip:3809305= 39504@*.*.12.107;user=3Dphone;cause=3D481;transport=3Dudp</a>>;index=3D1= .1.1,<<a>sip:334444444444444@*.*.12.107;user=3Dphone;cause=3D481;transpo= rt=3Dudp</a>>;index=3D1.1.1.1"],"Diversion":"<<a = href=3D"mailto:sip%3A%[email protected]" target=3D"_blank">sip:+33548060= [email protected]</a>>","Allow":"INVITE,ACK,CANCEL,BYE,REGI= STER,SUBSCRIBE,NOTIFY,UPDATE,OPTIONS,MESSAGE,PUBLISH","Privacy&qu= ot;:"none","Method":"INVITE","Request-UR= I":"<a>sip:+33100001209@*.*.12.137:5242;user=3Dphone</a>"},&= quot;remote_ip_port":"*.*.12.209:5242","local_ip_port&q= uot;:"<a href=3D"http://10.242.17.147:5060" target=3D"_blank">10.242.1= 7.147:5060</a>","protocol":"udp","retry"= :0,"timestamp":"1783082368.672364"}<br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930200]: INFO: {178308= 2368.673764 930193 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : HANDLE_INVITE - suspended transaction for INVITE / CALL_ATTEMPT. Index: &= lt;null> - Label: <null><br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: {178308= 2368.749972 930193 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : EVAPIRESPONSE - TRANSACTION 62044|1856782967<br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: {178308= 2368.750015 930193 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : EVAPIRESPONSE - Resumed with RESPONSE {"action": "ROUTE&qu= ot;, "routes": [{"tkg_eid": "101253", "c= rankback_profile": [{"sip_errors": ["403", "500", "503", "408", "= ;cb_to_transit"], "next_tkg_eid": "101254"}], &quo= t;dst_uri": "<a>sip:*.*.12.209:5253</a>", "uri": &= quot;<a>sip:+33100001209@*.*.12.209:5253;user=3Dphone</a>", "head= ers": {"delete": null, "add": [{"P-Access-Network-Info&= quot;: "GSTN;operator-specific-GI=3D\"011921212\";network-pr= ovided"}], "from": {"display": "+33000007&quo= t;, "uri": "<a>sip:+33000000012@*.*.12.107;user=3Dphone</a>&= quot;}, "to": {"uri": "<a>sip:+33100001209@*.*.12.209:5253;user=3Dphone</a>"}}, "= max_call_duration": 43200}, {"tkg_eid": "101254", = "crankback_profile": [], "dst_uri": "<a>sip:*.*.19= 9.167:5254</a>", "uri": "<a>sip:+33100001209@*.*.199.167:5254;user=3Dphone</a>", "h= eaders": {"delete": null, "add": [{"P-Access-= Network-Info": "GSTN;operator-specific-GI=3D\"011921212\&quo= t;;network-provided"}], "from": {"display": "= +33000007", "uri": "<a>sip:+33000000012@*.*.12.107;user=3Dphone</a>&quo= t;}, "to": {"uri": "<a>sip:+33100001209@*.*.199.16= 7:5254;user=3Dphone</a>"}}, "max_call_duration": 43200}], "retry_on_failure": false, "max_number_of_crankbacks":= 2, "version": "1.0", "method": "INVITE&= quot;, "routing": "serial", "call_id": "= <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a>"}<br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: {178308= 2368.750121 930193 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : EVAPIRESPONSE - ROUTE action<br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: {178308= 2368.750166 930193 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : EVAPIRESPONSE - NO retry_on_failure FOUND or retry_on_failure =3D 0 !<br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: {178308= 2368.750213 930193 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : EVAPIRESPONSE - retry_on_failure =3D 0 max_number_of_crankbacks =3D 2<br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: {178308= 2368.750239 930193 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : JSON_ROUTE_PROCESS - start =C2=A0retry=3D0<br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: {178308= 2368.750310 930193 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : JSON_ROUTE_PROCESS - 2 route(s) available - max_crankbacks=3D2<br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: {178308= 2368.750419 930193 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : APPLY_ROUTE_AND_RELAY - idx=3D0 - ru=3Dsip:+33100001209@*.*.12.209:5253;u= ser=3Dphone =C2=A0du=3Dsip:*.*.12.209:5253<br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: {178308= 2368.750617 930193 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : RELAY - tkg_eid=3D101253 idx=3D0 =C2=A0ru=3Dsip:+33100001209@*.*.12.209:5= 253;user=3Dphone =C2=A0du=3Dsip:*.*.12.209:5253<br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: {178308= 2368.750726 930193 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<core> [= core/kemi.c:155]: sr_kemi_core_log(): modify_invite_headers: rtjsonValue is= empty, undefined or null, trying to get from $var(cur_route)<br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: {178308= 2368.750974 930193 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : PIN_SOCKET - socket is pinned 1<br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: {178308= 2368.751036 930193 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : MANAGE_BRANCH - initializing new branch [1] to <a>sip:+33100001209@*.*.12.209:5253;user=3Dphone</a><br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930227]: INFO: {178308= 2368.751054 930193 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : MANAGE_BRANCH - Starting monitoring counter for endpoint <a>sip:*.*.12.209:5253</a> from *.*.17.147:5060 at 1783082368<br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930196]: INFO: {178308= 2368.753932 930193 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : onreply_route - 100 : INVITE replied from <a>sip:*.*.12.209:5253</a> with SIP 100<br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930196]: INFO: {178308= 2368.753994 930193 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : MANAGE_REPLY - Incoming reply INVITE 100<br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930196]: INFO: {178308= 2368.754012 930193 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : MANAGE_REPLY - Starting monitoring counter for endpoint <a>sip:*.*.12.209:5253</a><br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930196]: INFO: {178308= 2368.754025 930193 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : MANAGE_REPLY - Forwarding 100 Trying<br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930196]: INFO: {178308= 2368.754033 930193 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : RESET_FAILURE_COUNTER - resetting failure counter for <a>sip:*.*.12.209:5253</a> to 0<br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930195]: INFO: {178308= 2368.866708 930193 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : onreply_route - 183 : INVITE replied from <a>sip:*.*.12.209:5253</a> with SIP 183<br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930195]: INFO: {178308= 2368.866815 930193 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : MANAGE_REPLY - Incoming reply INVITE 183<br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930195]: INFO: {178308= 2368.866835 930193 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : MANAGE_REPLY - Starting monitoring counter for endpoint <a>sip:*.*.12.209:5253</a><br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930195]: INFO: {178308= 2368.866855 930193 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : MANAGE_REPLY - Forwarding 180/183 Session Progress<br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930195]: INFO: {178308= 2368.867114 930193 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : MANAGE_REPLY - setting Ringing Timestamp to 1783082368.866860<br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930195]: INFO: {178308= 2368.867141 930193 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : RESET_FAILURE_COUNTER - resetting failure counter for <a>sip:*.*.12.209:5253</a> to 0<br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930202]: INFO: {178308= 2368.876888 930193 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> PRACK}<script>:= PIN_SOCKET - socket is pinned 1<br> Jul =C2=A03 12:39:28 bl1649 /usr/local/sbin/kamailio[930201]: INFO: {178308= 2368.882525 930193 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> PRACK}<script>:= onreply_route - 200 : PRACK replied from <a>sip:*.*.12.209:5253</a> with SIP 200<br> Jul =C2=A03 12:39:29 bl1649 /usr/local/sbin/kamailio[930202]: INFO: {178308= 2369.884679 930193 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : onreply_route - 180 : INVITE replied from <a>sip:*.*.12.209:5253</a> with SIP 180<br> Jul =C2=A03 12:39:29 bl1649 /usr/local/sbin/kamailio[930202]: INFO: {178308= 2369.884771 930193 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : MANAGE_REPLY - Incoming reply INVITE 180<br> Jul =C2=A03 12:39:29 bl1649 /usr/local/sbin/kamailio[930202]: INFO: {178308= 2369.884790 930193 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : MANAGE_REPLY - Starting monitoring counter for endpoint <a>sip:*.*.12.209:5253</a><br> Jul =C2=A03 12:39:29 bl1649 /usr/local/sbin/kamailio[930202]: INFO: {178308= 2369.884815 930193 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : MANAGE_REPLY - Forwarding 180/183 Session Progress<br> Jul =C2=A03 12:39:29 bl1649 /usr/local/sbin/kamailio[930202]: INFO: {178308= 2369.885326 930193 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : MANAGE_REPLY - setting Ringing Timestamp to 1783082369.884822<br> Jul =C2=A03 12:39:29 bl1649 /usr/local/sbin/kamailio[930202]: INFO: {178308= 2369.885357 930193 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : RESET_FAILURE_COUNTER - resetting failure counter for <a>sip:*.*.12.209:5253</a> to 0<br> Jul =C2=A03 12:39:29 bl1649 /usr/local/sbin/kamailio[930201]: INFO: {178308= 2369.892923 930193 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> PRACK}<script>:= PIN_SOCKET - socket is pinned 1<br> Jul =C2=A03 12:39:29 bl1649 /usr/local/sbin/kamailio[930199]: INFO: {178308= 2369.899687 930193 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> PRACK}<script>:= onreply_route - 200 : PRACK replied from <a>sip:*.*.12.209:5253</a> with SIP 200</span><u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">=C2=A0<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">These are the logs from SIP 2 after the VIP has swit= ched:<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal"><br> <span style=3D"font-family:"Courier New"">Jul =C2=A03 12:39:32 bl= 1650 /usr/local/sbin/kamailio[857997]: INFO: {1783082372.401717 857991 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> INVITE}<script>= : onreply_route - 200 : INVITE replied from <a>sip:*.*.12.209:5253</a> with SIP 200<br> Jul =C2=A03 12:39:32 bl1650 /usr/local/sbin/kamailio[857996]: INFO: {178308= 2372.409421 857991 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> ACK}<script>: T= RACK_ACK - saving ACK timestamp 1783082372.409075<br> <b><span style=3D"color:black;background:rgb(255,153,0)">Jul =C2=A03 12:39:= 32 bl1650 /usr/local/sbin/kamailio[857996]: CRITICAL: {1783082372.409470 85= 7991 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> ACK}dialog [dlg_hash.= c:1276]: next_state_dlg(): bogus event 6 in state 2 for dlg 0x7f4d7c886990 = [193061:598258] with clid '48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209&= #39; and tags '*.*.12.209+2+32486fa4+25838f19' ''</span></b><br= > Jul =C2=A03 12:39:32 bl1650 /usr/local/sbin/kamailio[857996]: INFO: {178308= 2372.409553 857991 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> ACK}<script>: P= IN_SOCKET - stored dlg_sock=3Dudp:<a href=3D"http://10.242.17.147:5060" tar= get=3D"_blank">10.242.17.147:5060</a><br> Jul =C2=A03 12:39:32 bl1650 /usr/local/sbin/kamailio[857996]: INFO: {178308= 2372.409604 857991 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> ACK}<script>: P= IN_SOCKET - forcing <udp:<a href=3D"http://10.242.17.147:5060" target=3D= "_blank">10.242.17.147:5060</a>> (recv udp:<a href=3D"http://10.242.17.1= 47:5060" target=3D"_blank">10.242.17.147:5060</a>)<br> Jul =C2=A03 12:39:32 bl1650 /usr/local/sbin/kamailio[857996]: INFO: {178308= 2372.409631 857991 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> ACK}<script>: P= IN_SOCKET - socket is pinned 0<br> Jul =C2=A03 12:39:42 bl1650 /usr/local/sbin/kamailio[858001]: INFO: {178308= 2382.429353 857991 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> BYE}<script>: W= ITHINDLG - method is BYE - going to TRACK_BYE<br> Jul =C2=A03 12:39:42 bl1650 /usr/local/sbin/kamailio[858001]: INFO: {178308= 2382.429883 857991 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> BYE}<script>: T= RACK_BYE - CALLED side finished the call<br> Jul =C2=A03 12:39:42 bl1650 /usr/local/sbin/kamailio[858001]: INFO: {178308= 2382.429903 857991 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> BYE}<script>: T= RACK_BYE - setting ts_bye_usec 1783082382.429388 and bye_originator *.*.12.= 209 sent from CALLED<br> Jul =C2=A03 12:39:42 bl1650 /usr/local/sbin/kamailio[858001]: WARNING: {178= 3082382.429954 857991 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> BYE}<script>: W= ITHINDLG - BYE detected<br> Jul =C2=A03 12:39:42 bl1650 /usr/local/sbin/kamailio[858001]: INFO: {178308= 2382.429982 857991 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> BYE}<script>: P= IN_SOCKET - socket is pinned 1<br> Jul =C2=A03 12:39:42 bl1650 /usr/local/sbin/kamailio[858001]: INFO: {178308= 2382.430041 857991 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> BYE}<script>: M= ANAGE_BRANCH - initializing new branch [0] to <a>sip:+33000000012@*.*.12.209:5242;transport=3Dudp;user=3Dphone</a><br> Jul =C2=A03 12:39:42 bl1650 /usr/local/sbin/kamailio[858001]: INFO: {178308= 2382.430081 857991 1 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> BYE}<script>: M= ANAGE_BRANCH - Starting monitoring counter for endpoint <a>sip:*.*.12.209:5242</a> from <a href=3D"http://10.242.17.147:5060" targe= t=3D"_blank"> 10.242.17.147:5060</a> at 1783082382<br> Jul =C2=A03 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: {178308= 2382.437745 857991 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> BYE}<script>: o= nreply_route - 200 : BYE replied from <a>sip:*.*.12.209:5242</a> with SIP 200<br> Jul =C2=A03 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: WARNING: {178= 3082382.437780 857991 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> BYE}<script>: o= nreply_route - BYE detected<br> Jul =C2=A03 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: {178308= 2382.437800 857991 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> BYE}<script>: o= nreply_route - BYE and response received<br> Jul =C2=A03 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: {178308= 2382.438136 857991 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> BYE}<script>: T= RACK_BYE_200 - setting ts_bye_200ok_usec value 1783082382.437886<br> Jul =C2=A03 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: {178308= 2382.438162 857991 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> BYE}<script>: S= END_CALL_STATUS - checking call status t_check_status(200) =3D 200 ; method= =3D BYE<br> Jul =C2=A03 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: {178308= 2382.438392 857991 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> BYE}<script>: S= END_CALL_STATUS - crankback_history set to []<br> Jul =C2=A03 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: {178308= 2382.438441 857991 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> BYE}<script>: S= END_CALL_STATUS - processing BYE, checking if call was answered with t_chec= k_status(200) =3D 200<br> Jul =C2=A03 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: {178308= 2382.438503 857991 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> BYE}<script>: S= END_CALL_STATUS - processing BYE, finished_by set to CALLED<br> Jul =C2=A03 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: {178308= 2382.438549 857991 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> BYE}<script>: S= END_CALL_STATUS - processing BYE, bye_time set to 1783082382.429388<br> Jul =C2=A03 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: {178308= 2382.438597 857991 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> BYE}<script>: S= END_CALL_STATUS - processing BYE, invite_ack_time set to 1783082372.409075<= br> Jul =C2=A03 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: {178308= 2382.438655 857991 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> BYE}<script>: S= END_CALL_STATUS - processing BYE, bye_200_time set to 1783082382.437886 - $= var(cached_ack_time)=3D0;<br> Jul =C2=A03 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: {178308= 2382.438694 857991 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> BYE}<script>: E= V_MAKE_KEY - building event key for CALL_FINISH with hint BYE|-1<br> Jul =C2=A03 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: {178308= 2382.438924 857991 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> BYE}<script>: E= V_GUARD_ONCE - first time (CALL_FINISH) key=3D[48c1e14ce80dbdd6beacacda1aa8= f79c@*.*.12.209|CALL_FINISH] -> SEND<br> Jul =C2=A03 12:39:42 bl1650 /usr/local/sbin/kamailio[857999]: INFO: {178308= 2382.438964 857991 2 <a href=3D"mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_b= lank">48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a> BYE}<script>: S= END_CALL_STATUS - sending CALL_FINISH:{"call_id":"<a href=3D= "mailto:48c1e14ce80dbdd6beacacda1aa8f79c@*.*.12.209" target=3D"_blank">48c1= e14ce80dbdd6beacacda1aa8f79c@*.*.12.209</a>","from":"&l= t;<a>sip:+33100001209@*.*.12.209:5253;user=3Dphone</a>>;tag=3Dsip+2+b8f7= 0030+683bf4af","to":"+33000007 <<a>sip:+33000000012@*.*.12.107;user=3Dphone</a>>;tag=3D*.*.12.209+2= +32486fa4+25838f19","timestamp":"1783082382.438283"= ;,"tkg_eid":"101253","remote_ip_port":"*= .*.12.209:5242","local_ip_port":"*.*.17.147:5060",= "crankback_history":[],"finished_by":"CALLED"= ,"bye_time":"1783082382.429388","invite_ack_time&q= uot;:"1783082372.409075","bye_200_time":"178308238= 2.437886","type":"CALL_FINISH"}</span><u></u><u></= u></p> </div> <div> <p class=3D"MsoNormal">=C2=A0<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">My question is related with the lines above that I p= refixed with *** and to log lines marked with orange background and bold fo= nts: I understand the CRITICAL error on SIP 2 is due to the Finite State Machine (FSM) that does not expect a ACK/PRACK or 200 = OK at this point, but I wonder if this is an issue for processing calls?<u>= </u><u></u></p> </div> <div> <p class=3D"MsoNormal">=C2=A0<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">We have been testing at 2 CAPS and this issue happen= s quite often. We are aiming to 2000 CAPS minimum, so the issue will be exp= onential and we can't go live like this, at least without knowing if there are any effects on calls.<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">=C2=A0<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">Thanks in advance.<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">=C2=A0<u></u><u></u></p> </div> <div> <p class=3D"MsoNormal">=C2=A0<u></u><u></u></p> </div> <div> <div> <div> <div> <div> <div> <div> <p style=3D"margin:0cm;background:rgb(253,253,253)"><span style=3D"font-fam= ily:Arial,sans-serif;color:black">Atenciosamente / Kind Regards / Cordialem= ent / Un saludo,</span><u></u><u></u></p> <p style=3D"margin:0cm;background:rgb(253,253,253)"><span style=3D"font-fam= ily:Calibri,sans-serif;color:black">=C2=A0</span><u></u><u></u></p> <p style=3D"margin:0cm;background:rgb(253,253,253)"><b><span style=3D"font-= family:Arial,sans-serif;color:black">S=C3=A9rgio Charrua</span></b><u></u><= u></u></p> <div> <div> <p style=3D"margin:0cm;background:rgb(253,253,253)"><b><span style=3D"font-= size:9pt;font-family:Arial,sans-serif;color:rgb(51,102,255)"><a href=3D"htt= p://www.kahea.ai" target=3D"_blank">www.kahea.ai</a> /=C2=A0<a href=3D"http= ://www.voip.pt" target=3D"_blank">www.voip.pt</a></span></b><u></u><u></u><= /p> <p style=3D"margin:0cm;background:rgb(253,253,253)"><b><span style=3D"font-= size:9pt;font-family:Arial,sans-serif;color:black">OpenTelecom</span></b><s= pan style=3D"font-size:9pt;font-family:Arial,sans-serif;color:black"> - Con= sulting for Telecoms, Lda<br> </span><span style=3D"font-size:10pt;font-family:Arial,sans-serif;color:bla= ck">Tel.:=C2=A0</span><span style=3D"font-size:10pt;font-family:Arial,sans-= serif;color:rgb(51,102,153)"><a href=3D"callto:+351+91+104+12+66" target=3D= "_blank"><span style=3D"color:rgb(51,102,153);text-decoration:none">+351=C2= =A0</span></a>91 631 11 44</span><u></u><u></u></p> <p style=3D"margin:0cm;background:rgb(253,253,253)"><span style=3D"font-siz= e:10pt;font-family:Arial,sans-serif;color:gray">Email :=C2=A0<strong><span = style=3D"font-family:Arial,sans-serif"><a href=3D"mailto:sergio.charrua@voi= p.pt" target=3D"_blank"><span style=3D"color:rgb(17,85,204)">sergio.charrua= @voip.pt</span></a></span></strong></span><u></u><u></u></p> <table border=3D"0" cellspacing=3D"0" cellpadding=3D"0" width=3D"650" style= =3D"width:487.5pt"> <tbody> <tr> <td style=3D"padding:0cm"> <p class=3D"MsoNormal"><span lang=3D"EN-US" style=3D"font-family:"Voda= fone Rg",serif;color:rgb(204,204,204)">This message and any files or d= ocuments attached are strictly confidential or otherwise legally protected.= =C2=A0</span><u></u><u></u></p> <p class=3D"MsoNormal"><span lang=3D"EN-US" style=3D"font-family:"Voda= fone Rg",serif;color:rgb(204,204,204)">It is intended only for the ind= ividual or entity named. If you are not the named addressee or have receive= d this email in error, please inform the sender immediately, delete it from = your system and do not copy or disclose it or its contents or use it for an= y purpose. Please also note that transmission cannot be guaranteed to be se= cure or error-free. </span><u></u><u></u></p> </td> </tr> </tbody> </table> <p class=3D"MsoNormal"><span lang=3D"EN-US">=C2=A0</span><u></u><u></u></p> <p style=3D"margin:0cm;background:rgb(253,253,253)"><span style=3D"font-fam= ily:Calibri,sans-serif;color:black">=C2=A0</span><u></u><u></u></p> </div> </div> <div> <p class=3D"MsoNormal" style=3D"margin-bottom:12pt">=C2=A0<u></u><u></u></p= > </div> </div> </div> </div> </div> </div> </div> </div> </div> </div> </div> </div> </div> </blockquote> </div> </div> </div> </div> </div></blockquote></div> </blockquote></div> --000000000000dd12ef0656292c26-- --===============0188057266== Content-Type: text/plain; charset="us-ascii" MIME-Version: 1.0 Content-Transfer-Encoding: 7bit Content-Disposition: inline __________________________________________________________ Kamailio - Users Mailing List - Non Commercial Discussions -- [email protected] To unsubscribe send an email to [email protected] Important: keep the mailing list in the recipients, do not reply only to the sender! --===============0188057266==--