Hello,

I have a problem with the following configuration.

I want to make calls from Asterisk to a browser using RTPEngine as relay.

Everything works fine, if Kamailio is not natted (See
kamailio_without_nat.log).

If it's address is translated, then 200 OK responses from the browser don't
seem to be received by kamailio.

I have configured Kamailio (4.2) and RTPEngine (3.3) both with
advertisement of the public IP.

Asterisk has public IP: 146.148.113.245
Kamilio has public IP: 104.155.11.255
Browser has public IP: 79.241.195.106

The INVITE after SDP Rewrite looks like this:

INVITE sip:eih66yyxjlwnvncukw...@whtest3.24dial.com SIP/2.0
Record-Route: <sip:104.155.11.255;lr=on;nat=yes>
Via: SIP/2.0/UDP 104.155.11.255:5060
;branch=z9hG4bK683.5e75aa8b7f88561a91033a9b611fc0aa.0
Via: SIP/2.0/UDP 10.240.215.73:5060
;rport=5060;received=146.148.113.245;branch=z9hG4bK5a79a7cf
Max-Forwards: 69
From: "Anonymous" <sip:anonymous@anonymous.invalid>;tag=as53a7de72
To: <sip:eih66yyxjlwnvncukw...@whtest3.24dial.com>
Contact: <sip:anonymous@10.240.215.73:5060;alias=146.148.113.245~5060~1>
Call-ID: 523c5fda707c565c51b78c586247818e@10.240.215.73:5060
CSeq: 102 INVITE
User-Agent: Asterisk PBX 12.5.0
Date: Thu, 23 Oct 2014 15:29:17 GMT
Allow: INVITE, ACK, CANCEL, OPTIONS, BYE, REFER, SUBSCRIBE, NOTIFY, INFO,
PUBLISH, MESSAGE
Supported: replaces, timer
Content-Type: application/sdp
Content-Length: 738
P-hint: outbound

v=0
o=root 985629145 985629145 IN IP4 104.155.11.255
s=Asterisk PBX 12.5.0
c=IN IP4 104.155.11.255
t=0 0
a=ice-lite
m=audio 31630 RTP/SAVPF 3 0 8 101
a=rtpmap:3 GSM/8000
a=rtpmap:0 PCMU/8000
a=rtpmap:8 PCMA/8000
a=rtpmap:101 telephone-event/8000
a=fmtp:101 0-16
a=ptime:20
a=maxptime:150
a=sendrecv
a=rtcp:31631
a=rtcp-mux
a=crypto:1 AES_CM_128_HMAC_SHA1_80
inline:H9uLHKvstgjd58cZKa0LeRaxvf5XNJhaHgxDut7L
a=setup:actpass
a=fingerprint:sha-1
D9:26:45:E1:D6:E7:01:A4:04:90:F2:15:AF:A3:AD:01:3C:39:9B:7D
a=ice-ufrag:YoTvWbLM
a=ice-pwd:eifInSr3Oh8ZvMXjlE89mh8kF1OC
a=tDndidate:krhMgLYHbAxWidfK 1 UDP 2130706431 104.155.11.255 31630 typ host
a=candidate:krhMgLYHbAxWidfK 2 UDP 2130706430 104.155.11.255 31631 typ host


The 200 OK like this:

SIP/2.0 200 OK
Via: SIP/2.0/UDP 104.155.11.255:5060
;branch=z9hG4bK683.5e75aa8b7f88561a91033a9b611fc0aa.0;rport=5060;received=104.155.11.255
 , SIP/2.0/UDP 10.240.215.73:5060
;rport=5060;received=146.148.113.245;branch=z9hG4bK5a79a7cf
From: "Anonymous" <sip:anonymous@anonymous.invalid>;tag=as53a7de72
To:  <sip:eih66yyxjlwnvncukw...@whtest3.24dial.com
>;tag=6QTSN6N2SBW2FW49TMGJQJYZMGHQZ7LCUMQT
Contact:  <sip:eih66yyxjlwnvncukw...@whtest3.24dial.com
>;tag=6QTSN6N2SBW2FW49TMGJQJYZMGHQZ7LCUMQT
Call-ID: 523c5fda707c565c51b78c586247818e@10.240.215.73:5060
CSeq: 102 INVITE
Content-Type: application/sdp
Content-Length: 938

v=0
o=- 1907956949290984340 2 IN IP4 127.0.0.1
s=-
t=0 0
m=audio 43590 UDP/TLS/RTP/SAVPF 0 8 101
c=IN IP4 79.241.195.106
a=rtcp:1 IN IP4 0.0.0.0
a=candidate:290309024 1 udp 2122260223 192.168.35.78 43590 typ host
generation 0
a=candidate:2416297236 1 udp 1686052607 79.241.195.106 43590 typ srflx
raddr 192.168.35.78 rport 43590 generation 0
a=candidate:1607352144 1 tcp 1518280447 192.168.35.78 0 typ host tcptype
active generation 0
a=candidate:2416297236 1 udp 1686052607 79.241.195.106 43590 typ srflx
raddr 192.168.35.78 rport 43590 generation 0
a=ice-ufrag:ZtbtZieUG9l22iCb
a=ice-pwd:kRkmd0XuFdj+CKXVpInmK3yV
a=fingerprint:sha-256
ED:DB:B8:D5:4D:38:1F:81:DC:94:9F:EB:6D:07:56:75:57:45:F4:F7:57:4D:C6:89:70:CC:13:6D:35:C0:8B:45
a=setup:active
a=mid:audio
a=sendrecv
a=rtcp-mux
a=rtpmap:0 PCMU/8000
a=rtpmap:8 PCMA/8000
a=rtpmap:101 telephone-event/8000
a=msid-semantic: WMS mPbtogqqqsv8DygpyOmxrTkjgW9aGzkbP3Vk


Unfortunately Kamailio log does not tell me, that the response get's
processed. (See kamailio_behind_nat.log). I traced with TShark and can see
that the SIP/200 OK arrive at kamailio host.

Any Idea, what might be missing in my routing script?

I would be very grateful for any help.

Regards,
Marko

Attachment: kamailio.cfg
Description: Binary data

Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [parser/msg_parser.c:623]: parse_msg(): SIP Request:
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [parser/msg_parser.c:625]: parse_msg():  method:  <INVITE>
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [parser/msg_parser.c:627]: parse_msg():  uri:     <sip:eih66yyxjlwnvncukw...@whtest3.24dial.com>
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [parser/msg_parser.c:629]: parse_msg():  version: <SIP/2.0>
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [parser/parse_via.c:1284]: parse_via_param(): Found param type 232, <branch> = <z9hG4bK380f90bf>; state=16
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [parser/parse_via.c:2672]: parse_via(): end of header reached, state=5
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [parser/msg_parser.c:513]: parse_headers(): parse_headers: Via found, flags=2
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [parser/msg_parser.c:515]: parse_headers(): parse_headers: this is the first via
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [receive.c:154]: receive_msg(): After parse_msg...
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [receive.c:197]: receive_msg(): preparing to run routing scripts...
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=10 a=5 n=route
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[REQINIT] c=[/usr/local/etc/kamailio/routing.cfg] l=116 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[REQINIT] c=[/usr/local/etc/kamailio/routing.cfg] l=111 a=25 n=mf_process_maxfwd_header
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: maxfwd [mf_funcs.c:85]: is_maxfwd_present(): value = 70 
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[REQINIT] c=[/usr/local/etc/kamailio/routing.cfg] l=121 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[REQINIT] c=[/usr/local/etc/kamailio/routing.cfg] l=116 a=25 n=is_method
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[REQINIT] c=[/usr/local/etc/kamailio/routing.cfg] l=125 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[REQINIT] c=[/usr/local/etc/kamailio/routing.cfg] l=121 a=26 n=sanity_check
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [parser/parse_addr_spec.c:898]: parse_addr_spec(): end of header reached, state=10
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [parser/msg_parser.c:190]: get_hdr_field(): DEBUG: get_hdr_field: <To> [48]; uri=[sip:eih66yyxjlwnvncukw...@whtest3.24dial.com] 
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [parser/msg_parser.c:192]: get_hdr_field(): DEBUG: to body [<sip:eih66yyxjlwnvncukw...@whtest3.24dial.com>#015#012]
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [parser/msg_parser.c:170]: get_hdr_field(): get_hdr_field: cseq <CSeq>: <102> <INVITE>
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [parser/msg_parser.c:204]: get_hdr_field(): DEBUG: get_hdr_body : content_length=300
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [parser/msg_parser.c:106]: get_hdr_field(): found end of header
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [parser/parse_addr_spec.c:176]: parse_to_param(): DEBUG: add_param: tag=as4632fbdf
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [parser/parse_addr_spec.c:898]: parse_addr_spec(): end of header reached, state=29
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: sanity [mod_sanity.c:255]: w_sanity_check(): sanity checks result: 1
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=13 a=5 n=route
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/routing.cfg] l=243 a=55 n=force_rport
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/routing.cfg] l=254 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/routing.cfg] l=244 a=25 n=nat_uac_test
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [msg_translator.c:205]: check_via_address(): check_via_address(146.148.113.245, 10.240.215.73, 0)
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/routing.cfg] l=250 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/routing.cfg] l=245 a=25 n=is_method
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/routing.cfg] l=250 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/routing.cfg] l=248 a=24 n=is_first_hop
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: siputils [sipops.c:161]: w_is_first_hop(): no 2nd via found - first hop
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/routing.cfg] l=249 a=24 n=set_contact_alias
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [dset.c:769]: uri_add_rcv_alias(): encoded <sip:anonymous@10.240.215.73:5060> => [sip:anonymous@10.240.215.73:5060;alias=146.148.113.245~5060~1]
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/routing.cfg] l=251 a=39 n=setflag
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/routing.cfg] l=254 a=2 n=return
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=24 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=16 a=25 n=is_method
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=24 a=5 n=route
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[WITHINDLG] c=[/usr/local/etc/kamailio/routing.cfg] l=133 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[WITHINDLG] c=[/usr/local/etc/kamailio/routing.cfg] l=129 a=24 n=has_totag
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: siputils [checks.c:103]: has_totag(): no totag
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[WITHINDLG] c=[/usr/local/etc/kamailio/routing.cfg] l=129 a=2 n=return
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=33 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=29 a=24 n=t_precheck_trans
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=33 a=24 n=t_check_trans
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: tm [t_lookup.c:1072]: t_check_msg(): DEBUG: t_check_msg: msg id=1 global id=0 T start=0xffffffffffffffff
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: tm [t_lookup.c:527]: t_lookup_request(): t_lookup_request: start searching: hash=5508, isACK=0
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: tm [t_lookup.c:485]: matching_3261(): DEBUG: RFC3261 transaction matching failed
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: tm [t_lookup.c:709]: t_lookup_request(): DEBUG: t_lookup_request: no transaction found
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: tm [t_lookup.c:1141]: t_check_msg(): DEBUG: t_check_msg: msg id=1 global id=1 T end=(nil)
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=36 a=5 n=route
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[AUTH] c=[/usr/local/etc/kamailio/routing.cfg] l=237 a=2 n=return
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=40 a=25 n=remove_hf
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=45 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=41 a=25 n=is_method
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=42 a=24 n=record_route
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=50 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=45 a=25 n=is_method
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=46 a=39 n=setflag
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=50 a=5 n=route
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[SIPOUT] c=[/usr/local/etc/kamailio/routing.cfg] l=305 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [socket_info.c:583]: grep_sock_info(): grep_sock_info - checking if host==us: 18==7 && [whtest3.24dial.com] == [0.0.0.0]
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [socket_info.c:587]: grep_sock_info(): grep_sock_info - checking if port 5060 (advertise 5060) matches port 5060
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [socket_info.c:603]: grep_sock_info(): grep_sock_info - checking advertise if host==us: 18==14 && [whtest3.24dial.com] == [104.155.11.255]
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [forward.c:448]: check_self(): check_self: host != me
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[SIPOUT] c=[/usr/local/etc/kamailio/routing.cfg] l=305 a=25 n=append_hf
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[SIPOUT] c=[/usr/local/etc/kamailio/routing.cfg] l=306 a=5 n=route
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=74 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=71 a=25 n=is_method
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=73 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=72 a=25 n=t_is_set
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=72 a=25 n=t_on_branch
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=77 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=74 a=25 n=is_method
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=76 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=75 a=25 n=t_is_set
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=75 a=25 n=t_on_reply
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=81 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=77 a=25 n=is_method
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=79 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=78 a=25 n=t_is_set
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=78 a=25 n=t_on_failure
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=84 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=81 a=24 n=t_relay
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: tm [t_lookup.c:1373]: t_newtran(): DEBUG: t_newtran: msg id=1 , global msg id=1 , T on entrance=(nil)
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: tm [t_lookup.c:527]: t_lookup_request(): t_lookup_request: start searching: hash=5508, isACK=0
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: tm [t_lookup.c:485]: matching_3261(): DEBUG: RFC3261 transaction matching failed
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: tm [t_lookup.c:709]: t_lookup_request(): DEBUG: t_lookup_request: no transaction found
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: tm [t_hooks.c:374]: run_reqin_callbacks_internal(): DBG: trans=0x7f3781373bf8, callback type 1, id 0 entered
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [md5utils.c:67]: MD5StringArray(): DEBUG: MD5 calculated: 58df385779a50bab293d2b680c8d0ca8
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: tm [t_funcs.c:347]: t_relay_to(): SER: new INVITE
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [msg_translator.c:205]: check_via_address(): check_via_address(146.148.113.245, 10.240.215.73, 0)
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [mem/shm_mem.c:111]: _shm_resize(): WARNING:vqm_resize: resize(0) called
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: tm [t_reply.c:728]: _reply_light(): DEBUG: reply sent out. buf=0x7f378973de48: SIP/2.0 100 trying -..., shmem=0x7f37813765b0: SIP/2.0 100 trying -
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: tm [t_reply.c:738]: _reply_light(): DEBUG: _reply_light: finished
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:branch_route=[MANAGE_BRANCH] c=[/usr/local/etc/kamailio/routing.cfg] l=312 a=25 n=xdbg
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <script>: new branch [0] to sip:eih66yyxjlwnvncukw...@whtest3.24dial.com
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:branch_route=[MANAGE_BRANCH] c=[/usr/local/etc/kamailio/routing.cfg] l=313 a=5 n=route
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=267 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=260 a=24 n=is_request
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=266 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=261 a=24 n=has_totag
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: siputils [checks.c:103]: has_totag(): no totag
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=270 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=267 a=41 n=isflagset
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=270 a=26 n=xlog
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <script>: KAMAILIO >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>> WEBRTC
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=272 a=25 n=rtpengine_manage
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [parser/sdp/sdp_helpr_funcs.c:505]: extract_mediaip(): located IP address [10.240.215.73] in `o=' field
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [parser/sdp/sdp_helpr_funcs.c:505]: extract_mediaip(): located IP address [10.240.215.73] in `c=' field
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [parser/sdp/sdp.c:574]: parse_sdp_session(): ignoring unknown type in a= line: `a=maxptime:150#015#012a=sendrecv#015#012'
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: rtpengine [rtpengine_funcs.c:148]: check_content_type(): type <application/sdp> found valid
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: rtpengine [rtpengine.c:1448]: rtpp_function_call(): proxy reply: d3:sdp740:v=0#015#012o=root 1797759624 1797759624 IN IP4 104.155.11.255#015#012s=Asterisk PBX 12.5.0#015#012c=IN IP4 104.155.11.255#015#012t=0 0#015#012a=ice-lite#015#012m=audio 31658 RTP/SAVPF 3 0 8 101#015#012a=rtpmap:3 GSM/8000#015#012a=rtpmap:0 PCMU/8000#015#012a=rtpmap:8 PCMA/8000#015#012a=rtpmap:101 telephone-event/8000#015#012a=fmtp:101 0-16#015#012a=ptime:20#015#012a=maxptime:150#015#012a=sendrecv#015#012a=rtcp:31659#015#012a=rtcp-mux#015#012a=crypto:1 AES_CM_128_HMAC_SHA1_80 inline:S3lwAZob4WfRO0s5Ui35nacSBi5vKpOXi/VltXGF#015#012a=setup:actpass#015#012a=fingerprint:sha-1 D9:26:45:E1:D6:E7:01:A4:04:90:F2:15:AF:A3:AD:01:3C:39:9B:7D#015#012a=ice-ufrag:Jvdz4jKt#015#012a=ice-pwd:OZFAmQPsUlUD0sIT96qOhzE02Qx4#015#012a=candidate:krhMgLYHbAxWidfK 1 UDP 2130706431 104.155.11.255 31658 typ host#015#012a=candidate:krhMgLYHbAxWidfK 2 UDP 2130706430 104.155.11.255 31659 typ host#015#0126:result2:oke
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=273 a=25 n=t_on_reply
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=282 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=275 a=24 n=is_request
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=281 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=276 a=24 n=has_totag
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: siputils [checks.c:103]: has_totag(): no totag
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=280 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=277 a=24 n=t_is_branch_route
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=278 a=25 n=add_rr_param
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=288 a=16 n=if
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=282 a=24 n=is_reply
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=288 a=2 n=return
Oct 23 15:38:30 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [dns_cache.c:566]: _dns_hash_find(): dns_hash_find(_sip._udp.whtest3.24dial.com(28), 33), h=536
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [resolve.c:967]: get_record(): get_record: skipping 1 NS (p=0x9e5b1b, end=0x9e5b4d)
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [resolve.c:983]: get_record(): get_record: parsing 0 ARs (p=0x9e5b4d, end=0x9e5b4d)
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [dns_cache.c:1772]: dns_get_related(): dns_get_related(0x7f3781376de8 (_sip._udp.whtest3.24dial.com, 5), 33, *0x7f3789736a30) (0)
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [dns_cache.c:1939]: dns_cache_do_request(): dns_cache_do_request: cname detected: ghs.l.google.com (16)
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [dns_cache.c:869]: dns_cache_add_unsafe(): dns_cache_add: adding _sip._udp.whtest3.24dial.com(28) 5 (flags=0) at 536
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [dns_cache.c:869]: dns_cache_add_unsafe(): dns_cache_add: adding ghs.google.com(14) 5 (flags=0) at 66
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [dns_cache.c:2003]: dns_cache_do_request(): dns_cache_do_request: dns_get_entry(cname: ghs.l.google.com (16))
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [dns_cache.c:566]: _dns_hash_find(): dns_hash_find(ghs.l.google.com(16), 33), h=702
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [resolve.c:770]: get_record(): get_record: lookup(ghs.l.google.com, 33) failed
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [dns_cache.c:894]: dns_cache_mk_bad_entry(): dns_cache_mk_bad_entry(ghs.l.google.com, 33, 60, 1)
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [dns_cache.c:827]: dns_cache_add(): dns_cache_add: adding ghs.l.google.com(16) 33 (flags=1) at 702
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [dns_cache.c:566]: _dns_hash_find(): dns_hash_find(whtest3.24dial.com(18), 1), h=452
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [resolve.c:967]: get_record(): get_record: skipping 0 NS (p=0x9e5af4, end=0x9e5af4)
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [resolve.c:983]: get_record(): get_record: parsing 0 ARs (p=0x9e5af4, end=0x9e5af4)
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [dns_cache.c:1772]: dns_get_related(): dns_get_related(0x7f3781376fe8 (whtest3.24dial.com, 1), 1, *(nil)) (0)
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [dns_cache.c:869]: dns_cache_add_unsafe(): dns_cache_add: adding whtest3.24dial.com(18) 1 (flags=0) at 452
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [msg_translator.c:458]: clen_builder(): clen_builder: content-length: 740 (740)
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [msg_translator.c:205]: check_via_address(): check_via_address(146.148.113.245, 10.240.215.73, 0)
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: tm [t_funcs.c:394]: t_relay_to(): SER: new transaction fwd'ed
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=84 a=2 n=exit
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [usr_avp.c:643]: destroy_avp_list(): DEBUG:destroy_avp_list: destroying list (nil)
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [usr_avp.c:643]: destroy_avp_list(): DEBUG:destroy_avp_list: destroying list (nil)
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [usr_avp.c:643]: destroy_avp_list(): DEBUG:destroy_avp_list: destroying list (nil)
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [usr_avp.c:643]: destroy_avp_list(): DEBUG:destroy_avp_list: destroying list (nil)
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [usr_avp.c:643]: destroy_avp_list(): DEBUG:destroy_avp_list: destroying list (nil)
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [usr_avp.c:643]: destroy_avp_list(): DEBUG:destroy_avp_list: destroying list (nil)
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [xavp.c:448]: xavp_destroy_list(): destroying xavp list (nil)
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [receive.c:298]: receive_msg(): receive_msg: cleaning up
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [parser/sdp/sdp.c:793]: free_sdp(): _sdp = 0x7f3789751388
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [parser/sdp/sdp.c:795]: free_sdp(): sdp = 0x7f3789737dc0
Oct 23 15:38:31 kamailio-test /usr/local/sbin/kamailio[8064]: DEBUG: <core> [parser/sdp/sdp.c:797]: free_sdp(): session = 0x7f3789737e38
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [parser/msg_parser.c:623]: parse_msg(): SIP Request:
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [parser/msg_parser.c:625]: parse_msg():  method:  <INVITE>
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [parser/msg_parser.c:627]: parse_msg():  uri:     <sip:eih66yyxjlwnvncukw...@whtest3.24dial.com>
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [parser/msg_parser.c:629]: parse_msg():  version: <SIP/2.0>
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [parser/parse_via.c:1284]: parse_via_param(): Found param type 232, <branch> = <z9hG4bK7401abed>; state=16
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [parser/parse_via.c:2672]: parse_via(): end of header reached, state=5
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [parser/msg_parser.c:513]: parse_headers(): parse_headers: Via found, flags=2
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [parser/msg_parser.c:515]: parse_headers(): parse_headers: this is the first via
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [receive.c:154]: receive_msg(): After parse_msg...
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [receive.c:197]: receive_msg(): preparing to run routing scripts...
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=10 a=5 n=route
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[REQINIT] c=[/usr/local/etc/kamailio/routing.cfg] l=116 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[REQINIT] c=[/usr/local/etc/kamailio/routing.cfg] l=111 a=25 n=mf_process_maxfwd_header
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: maxfwd [mf_funcs.c:85]: is_maxfwd_present(): value = 70 
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[REQINIT] c=[/usr/local/etc/kamailio/routing.cfg] l=121 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[REQINIT] c=[/usr/local/etc/kamailio/routing.cfg] l=116 a=25 n=is_method
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[REQINIT] c=[/usr/local/etc/kamailio/routing.cfg] l=125 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[REQINIT] c=[/usr/local/etc/kamailio/routing.cfg] l=121 a=26 n=sanity_check
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [parser/parse_addr_spec.c:898]: parse_addr_spec(): end of header reached, state=10
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [parser/msg_parser.c:190]: get_hdr_field(): DEBUG: get_hdr_field: <To> [48]; uri=[sip:eih66yyxjlwnvncukw...@whtest3.24dial.com] 
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [parser/msg_parser.c:192]: get_hdr_field(): DEBUG: to body [<sip:eih66yyxjlwnvncukw...@whtest3.24dial.com>#015#012]
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [parser/msg_parser.c:170]: get_hdr_field(): get_hdr_field: cseq <CSeq>: <102> <INVITE>
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [parser/msg_parser.c:204]: get_hdr_field(): DEBUG: get_hdr_body : content_length=298
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [parser/msg_parser.c:106]: get_hdr_field(): found end of header
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [parser/parse_addr_spec.c:176]: parse_to_param(): DEBUG: add_param: tag=as256208c2
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [parser/parse_addr_spec.c:898]: parse_addr_spec(): end of header reached, state=29
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: sanity [mod_sanity.c:255]: w_sanity_check(): sanity checks result: 1
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=13 a=5 n=route
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/routing.cfg] l=243 a=55 n=force_rport
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/routing.cfg] l=254 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/routing.cfg] l=244 a=25 n=nat_uac_test
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [msg_translator.c:205]: check_via_address(): check_via_address(146.148.113.245, 10.240.215.73, 0)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/routing.cfg] l=250 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/routing.cfg] l=245 a=25 n=is_method
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/routing.cfg] l=250 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/routing.cfg] l=248 a=24 n=is_first_hop
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: siputils [sipops.c:161]: w_is_first_hop(): no 2nd via found - first hop
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/routing.cfg] l=249 a=24 n=set_contact_alias
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [dset.c:769]: uri_add_rcv_alias(): encoded <sip:anonymous@10.240.215.73:5060> => [sip:anonymous@10.240.215.73:5060;alias=146.148.113.245~5060~1]
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/routing.cfg] l=251 a=39 n=setflag
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/routing.cfg] l=254 a=2 n=return
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=24 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=16 a=25 n=is_method
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=24 a=5 n=route
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[WITHINDLG] c=[/usr/local/etc/kamailio/routing.cfg] l=133 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[WITHINDLG] c=[/usr/local/etc/kamailio/routing.cfg] l=129 a=24 n=has_totag
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: siputils [checks.c:103]: has_totag(): no totag
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[WITHINDLG] c=[/usr/local/etc/kamailio/routing.cfg] l=129 a=2 n=return
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=33 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=29 a=24 n=t_precheck_trans
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=33 a=24 n=t_check_trans
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: tm [t_lookup.c:1072]: t_check_msg(): DEBUG: t_check_msg: msg id=1 global id=0 T start=0xffffffffffffffff
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: tm [t_lookup.c:527]: t_lookup_request(): t_lookup_request: start searching: hash=12233, isACK=0
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: tm [t_lookup.c:485]: matching_3261(): DEBUG: RFC3261 transaction matching failed
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: tm [t_lookup.c:709]: t_lookup_request(): DEBUG: t_lookup_request: no transaction found
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: tm [t_lookup.c:1141]: t_check_msg(): DEBUG: t_check_msg: msg id=1 global id=1 T end=(nil)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=36 a=5 n=route
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[AUTH] c=[/usr/local/etc/kamailio/routing.cfg] l=237 a=2 n=return
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=40 a=25 n=remove_hf
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=45 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=41 a=25 n=is_method
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=42 a=24 n=record_route
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=50 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=45 a=25 n=is_method
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=46 a=39 n=setflag
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/routing.cfg] l=50 a=5 n=route
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[SIPOUT] c=[/usr/local/etc/kamailio/routing.cfg] l=305 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [socket_info.c:583]: grep_sock_info(): grep_sock_info - checking if host==us: 18==9 && [whtest3.24dial.com] == [127.0.0.1]
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [socket_info.c:587]: grep_sock_info(): grep_sock_info - checking if port 5062 (advertise 0) matches port 5060
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [socket_info.c:583]: grep_sock_info(): grep_sock_info - checking if host==us: 18==14 && [whtest3.24dial.com] == [85.214.131.158]
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [socket_info.c:587]: grep_sock_info(): grep_sock_info - checking if port 5062 (advertise 0) matches port 5060
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [socket_info.c:583]: grep_sock_info(): grep_sock_info - checking if host==us: 18==9 && [whtest3.24dial.com] == [127.0.0.1]
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [socket_info.c:587]: grep_sock_info(): grep_sock_info - checking if port 5062 (advertise 0) matches port 5060
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [socket_info.c:583]: grep_sock_info(): grep_sock_info - checking if host==us: 18==14 && [whtest3.24dial.com] == [85.214.131.158]
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [socket_info.c:587]: grep_sock_info(): grep_sock_info - checking if port 5062 (advertise 0) matches port 5060
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [forward.c:448]: check_self(): check_self: host != me
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[SIPOUT] c=[/usr/local/etc/kamailio/routing.cfg] l=305 a=25 n=append_hf
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[SIPOUT] c=[/usr/local/etc/kamailio/routing.cfg] l=306 a=5 n=route
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=74 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=71 a=25 n=is_method
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=73 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=72 a=25 n=t_is_set
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=72 a=25 n=t_on_branch
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=77 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=74 a=25 n=is_method
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=76 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=75 a=25 n=t_is_set
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=75 a=25 n=t_on_reply
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=81 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=77 a=25 n=is_method
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=79 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=78 a=25 n=t_is_set
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=78 a=25 n=t_on_failure
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=84 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=81 a=24 n=t_relay
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: tm [t_lookup.c:1373]: t_newtran(): DEBUG: t_newtran: msg id=1 , global msg id=1 , T on entrance=(nil)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: tm [t_lookup.c:527]: t_lookup_request(): t_lookup_request: start searching: hash=12233, isACK=0
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: tm [t_lookup.c:485]: matching_3261(): DEBUG: RFC3261 transaction matching failed
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: tm [t_lookup.c:709]: t_lookup_request(): DEBUG: t_lookup_request: no transaction found
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: tm [t_hooks.c:374]: run_reqin_callbacks_internal(): DBG: trans=0x7f9ff7f895d8, callback type 1, id 0 entered
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [md5utils.c:67]: MD5StringArray(): DEBUG: MD5 calculated: 9f33644c6ad65e5dbc7e264d90e8c30e
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: tm [t_funcs.c:347]: t_relay_to(): SER: new INVITE
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [msg_translator.c:205]: check_via_address(): check_via_address(146.148.113.245, 10.240.215.73, 0)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [mem/shm_mem.c:111]: _shm_resize(): WARNING:vqm_resize: resize(0) called
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: tm [t_reply.c:728]: _reply_light(): DEBUG: reply sent out. buf=0x7fa00034fab0: SIP/2.0 100 trying -..., shmem=0x7f9ff7f8bf88: SIP/2.0 100 trying -
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: tm [t_reply.c:738]: _reply_light(): DEBUG: _reply_light: finished
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:branch_route=[MANAGE_BRANCH] c=[/usr/local/etc/kamailio/routing.cfg] l=312 a=25 n=xdbg
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <script>: new branch [0] to sip:eih66yyxjlwnvncukw...@whtest3.24dial.com
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:branch_route=[MANAGE_BRANCH] c=[/usr/local/etc/kamailio/routing.cfg] l=313 a=5 n=route
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=267 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=260 a=24 n=is_request
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=266 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=261 a=24 n=has_totag
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: siputils [checks.c:103]: has_totag(): no totag
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=270 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=267 a=41 n=isflagset
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=270 a=26 n=xlog
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <script>: KAMAILIO >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>> WEBRTC
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=272 a=25 n=rtpengine_manage
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [parser/sdp/sdp_helpr_funcs.c:505]: extract_mediaip(): located IP address [10.240.215.73] in `o=' field
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [parser/sdp/sdp_helpr_funcs.c:505]: extract_mediaip(): located IP address [10.240.215.73] in `c=' field
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [parser/sdp/sdp.c:574]: parse_sdp_session(): ignoring unknown type in a= line: `a=maxptime:150#015#012a=sendrecv#015#012'
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: rtpengine [rtpengine_funcs.c:148]: check_content_type(): type <application/sdp> found valid
Oct 23 17:40:43 h2296799 rtpengine[31909]: Got valid command from 127.0.0.1:33274: offer - { "sdp": "v=0#015#012o=root 772505573 772505573 IN IP4 10.240.215.73#015#012s=Asterisk PBX 12.5.0#015#012c=IN IP4 10.240.215.73#015#012t=0 0#015#012m=audio 13244 RTP/AVP 3 0 8 101#015#012a=rtpmap:3 GSM/8000#015#012a=rtpmap:0 PCMU/8000#015#012a=rtpmap:8 PCMA/8000#015#012a=rtpmap:101 telephone-event/8000#015#012a=fmtp:101 0-16#015#012a=ptime:20#015#012a=maxptime:150#015#012a=sendrecv#015#012", "ICE": "force", "flags": [ "trust-address" ], "replace": [ "origin", "session-connection" ], "transport-protocol": "RTP/SAVPF", "rtcp-mux": [ ...
Oct 23 17:40:43 h2296799 rtpengine[31909]: ...  "offer" ], "call-id": "196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060", "received-from": [ "IP4", "146.148.113.245" ], "from-tag": "as256208c2", "command": "offer" }
Oct 23 17:40:43 h2296799 rtpengine[31909]: [196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060] Creating new call
Oct 23 17:40:43 h2296799 rtpengine[31909]: [196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060] Opened ports 31486..31487 for media relay
Oct 23 17:40:43 h2296799 rtpengine[31909]: [196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060] Opened ports 31506..31507 for media relay
Oct 23 17:40:43 h2296799 rtpengine[31909]: [196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060] Returning to SIP proxy: d3:sdp738:v=0#015#012o=root 772505573 772505573 IN IP4 85.214.131.158#015#012s=Asterisk PBX 12.5.0#015#012c=IN IP4 85.214.131.158#015#012t=0 0#015#012a=ice-lite#015#012m=audio 31486 RTP/SAVPF 3 0 8 101#015#012a=rtpmap:3 GSM/8000#015#012a=rtpmap:0 PCMU/8000#015#012a=rtpmap:8 PCMA/8000#015#012a=rtpmap:101 telephone-event/8000#015#012a=fmtp:101 0-16#015#012a=ptime:20#015#012a=maxptime:150#015#012a=sendrecv#015#012a=rtcp:31487#015#012a=rtcp-mux#015#012a=crypto:1 AES_CM_128_HMAC_SHA1_80 inline:i06jsahYXPkky/LeLC0A1/enVXqCpO9nG4AVcPja#015#012a=setup:actpass#015#012a=fingerprint:sha-1 E1:76 ...
Oct 23 17:40:43 h2296799 rtpengine[31909]: [196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060] ... :3E:2E:82:18:1E:DD:91:4F:7F:0F:96:B0:F1:65:8F:12:63:A2#015#012a=ice-ufrag:ihWoWuE8#015#012a=ice-pwd:Ty3EHLv9gih2r8peBex3aXiqdeN9#015#012a=candidate:3vGfmhXSfMBPekEx 1 UDP 2130706431 85.214.131.158 31486 typ host#015#012a=candidate:3vGfmhXSfMBPekEx 2 UDP 2130706430 85.214.131.158 31487 typ host#015#0126:result2:oke
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: rtpengine [rtpengine.c:1448]: rtpp_function_call(): proxy reply: d3:sdp738:v=0#015#012o=root 772505573 772505573 IN IP4 85.214.131.158#015#012s=Asterisk PBX 12.5.0#015#012c=IN IP4 85.214.131.158#015#012t=0 0#015#012a=ice-lite#015#012m=audio 31486 RTP/SAVPF 3 0 8 101#015#012a=rtpmap:3 GSM/8000#015#012a=rtpmap:0 PCMU/8000#015#012a=rtpmap:8 PCMA/8000#015#012a=rtpmap:101 telephone-event/8000#015#012a=fmtp:101 0-16#015#012a=ptime:20#015#012a=maxptime:150#015#012a=sendrecv#015#012a=rtcp:31487#015#012a=rtcp-mux#015#012a=crypto:1 AES_CM_128_HMAC_SHA1_80 inline:i06jsahYXPkky/LeLC0A1/enVXqCpO9nG4AVcPja#015#012a=setup:actpass#015#012a=fingerprint:sha-1 E1:76:3E:2E:82:18:1E:DD:91:4F:7F:0F:96:B0:F1:65:8F:12:63:A2#015#012a=ice-ufrag:ihWoWuE8#015#012a=ice-pwd:Ty3EHLv9gih2r8peBex3aXiqdeN9#015#012a=candidate:3vGfmhXSfMBPekEx 1 UDP 2130706431 85.214.131.158 31486 typ host#015#012a=candidate:3vGfmhXSfMBPekEx 2 UDP 2130706430 85.214.131.158 31487 typ host#015#0126:result2:oke
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=273 a=25 n=t_on_reply
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=282 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=275 a=24 n=is_request
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=281 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=276 a=24 n=has_totag
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: siputils [checks.c:103]: has_totag(): no totag
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=280 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=277 a=24 n=t_is_branch_route
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=278 a=25 n=add_rr_param
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=288 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=282 a=24 n=is_reply
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:branch_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=288 a=2 n=return
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [dns_cache.c:566]: _dns_hash_find(): dns_hash_find(_sip._udp.whtest3.24dial.com(28), 33), h=536
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [resolve.c:967]: get_record(): get_record: skipping 1 NS (p=0x9e5b1b, end=0x9e5b4d)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [resolve.c:983]: get_record(): get_record: parsing 0 ARs (p=0x9e5b4d, end=0x9e5b4d)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [dns_cache.c:1772]: dns_get_related(): dns_get_related(0x7f9ff7f8c7c0 (_sip._udp.whtest3.24dial.com, 5), 33, *0x7fa000348698) (0)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [dns_cache.c:1939]: dns_cache_do_request(): dns_cache_do_request: cname detected: ghs.l.google.com (16)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [dns_cache.c:869]: dns_cache_add_unsafe(): dns_cache_add: adding _sip._udp.whtest3.24dial.com(28) 5 (flags=0) at 536
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [dns_cache.c:869]: dns_cache_add_unsafe(): dns_cache_add: adding ghs.google.com(14) 5 (flags=0) at 66
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [dns_cache.c:2003]: dns_cache_do_request(): dns_cache_do_request: dns_get_entry(cname: ghs.l.google.com (16))
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [dns_cache.c:566]: _dns_hash_find(): dns_hash_find(ghs.l.google.com(16), 33), h=702
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [resolve.c:770]: get_record(): get_record: lookup(ghs.l.google.com, 33) failed
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [dns_cache.c:894]: dns_cache_mk_bad_entry(): dns_cache_mk_bad_entry(ghs.l.google.com, 33, 60, 1)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [dns_cache.c:827]: dns_cache_add(): dns_cache_add: adding ghs.l.google.com(16) 33 (flags=1) at 702
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [dns_cache.c:566]: _dns_hash_find(): dns_hash_find(whtest3.24dial.com(18), 1), h=452
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [resolve.c:967]: get_record(): get_record: skipping 0 NS (p=0x9e5af4, end=0x9e5af4)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [resolve.c:983]: get_record(): get_record: parsing 0 ARs (p=0x9e5af4, end=0x9e5af4)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [dns_cache.c:1772]: dns_get_related(): dns_get_related(0x7f9ff7f8c9c0 (whtest3.24dial.com, 1), 1, *(nil)) (0)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [dns_cache.c:869]: dns_cache_add_unsafe(): dns_cache_add: adding whtest3.24dial.com(18) 1 (flags=0) at 452
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [msg_translator.c:458]: clen_builder(): clen_builder: content-length: 738 (738)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [msg_translator.c:205]: check_via_address(): check_via_address(146.148.113.245, 10.240.215.73, 0)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: tm [t_funcs.c:394]: t_relay_to(): SER: new transaction fwd'ed
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: exec: *** cfgtrace:request_route=[RELAY] c=[/usr/local/etc/kamailio/routing.cfg] l=84 a=2 n=exit
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [usr_avp.c:643]: destroy_avp_list(): DEBUG:destroy_avp_list: destroying list (nil)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [usr_avp.c:643]: destroy_avp_list(): DEBUG:destroy_avp_list: destroying list (nil)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [usr_avp.c:643]: destroy_avp_list(): DEBUG:destroy_avp_list: destroying list (nil)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [usr_avp.c:643]: destroy_avp_list(): DEBUG:destroy_avp_list: destroying list (nil)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [usr_avp.c:643]: destroy_avp_list(): DEBUG:destroy_avp_list: destroying list (nil)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [usr_avp.c:643]: destroy_avp_list(): DEBUG:destroy_avp_list: destroying list (nil)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [xavp.c:448]: xavp_destroy_list(): destroying xavp list (nil)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [receive.c:298]: receive_msg(): receive_msg: cleaning up
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [parser/sdp/sdp.c:793]: free_sdp(): _sdp = 0x7fa000363cc8
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [parser/sdp/sdp.c:795]: free_sdp(): sdp = 0x7fa000349a28
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32471]: DEBUG: <core> [parser/sdp/sdp.c:797]: free_sdp(): session = 0x7fa000349aa0
Oct 23 17:40:43 h2296799 rtpengine[31909]: [196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060 port 31486] Successful STUN binding request from 79.241.195.106:42803
Oct 23 17:40:43 h2296799 rtpengine[31909]: [196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060 port 31486] Successful STUN binding request from 79.241.195.106:42803
Oct 23 17:40:43 h2296799 rtpengine[31909]: [196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060 port 31486] STUN: using this candidate
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/msg_parser.c:633]: parse_msg(): SIP Reply  (status):
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/msg_parser.c:635]: parse_msg():  version: <SIP/2.0>
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/msg_parser.c:637]: parse_msg():  status:  <200>
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/msg_parser.c:639]: parse_msg():  reason:  <OK>
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/parse_via.c:1284]: parse_via_param(): Found param type 232, <branch> = <z9hG4bK9cf2.9f33644c6ad65e5dbc7e264d90e8c30e.0>; state=6
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/parse_via.c:1284]: parse_via_param(): Found param type 235, <rport> = <5060>; state=6
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/parse_via.c:1284]: parse_via_param(): Found param type 234, <received> = <104.155.11.255>; state=16
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/parse_via.c:2715]: parse_via(): parse_via: next_via
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/parse_via.c:1284]: parse_via_param(): Found param type 235, <rport> = <5060>; state=6
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/parse_via.c:1284]: parse_via_param(): Found param type 234, <received> = <146.148.113.245>; state=6
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/parse_via.c:1284]: parse_via_param(): Found param type 232, <branch> = <z9hG4bK7401abed>; state=16
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/parse_via.c:2672]: parse_via(): end of header reached, state=5
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/msg_parser.c:513]: parse_headers(): parse_headers: Via found, flags=2
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/msg_parser.c:515]: parse_headers(): parse_headers: this is the first via
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [receive.c:154]: receive_msg(): After parse_msg...
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: tm [t_lookup.c:1072]: t_check_msg(): DEBUG: t_check_msg: msg id=1 global id=0 T start=0xffffffffffffffff
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/parse_addr_spec.c:176]: parse_to_param(): DEBUG: add_param: tag=SDVRFERBW34HCYPMNKL83KN3C37E2AAEQAY9
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/parse_addr_spec.c:898]: parse_addr_spec(): end of header reached, state=29
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/msg_parser.c:190]: get_hdr_field(): DEBUG: get_hdr_field: <To> [89]; uri=[sip:eih66yyxjlwnvncukw...@whtest3.24dial.com] 
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/msg_parser.c:192]: get_hdr_field(): DEBUG: to body [<sip:eih66yyxjlwnvncukw...@whtest3.24dial.com>]
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/msg_parser.c:170]: get_hdr_field(): get_hdr_field: cseq <CSeq>: <102> <INVITE>
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: tm [t_lookup.c:949]: t_reply_matching(): DEBUG: t_reply_matching: hash 12233 label 0 branch 0
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: tm [t_lookup.c:1004]: t_reply_matching(): DEBUG: t_reply_matching: reply matched (T=0x7f9ff7f895d8)!
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: tm [t_hooks.c:288]: run_trans_callbacks_internal(): DBG: trans=0x7f9ff7f895d8, callback type 2, id 0 entered
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: acc [acc_logic.c:644]: tmcb_func(): acc callback called for t(0x7f9ff7f895d8) event type 2, reply code 200
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: tm [t_lookup.c:1141]: t_check_msg(): DEBUG: t_check_msg: msg id=1 global id=1 T end=0x7f9ff7f895d8
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: tm [t_reply.c:2210]: reply_received(): DEBUG: reply_received: org. status uas=100, uac[0]=0 local=0 is_invite=1)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: exec: *** cfgtrace:onreply_route=[REPLY_FROM_WEBRTC] c=[/usr/local/etc/kamailio/routing.cfg] l=335 a=26 n=xlog
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <script>: WEBRTC >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>> KAMAILIO
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: exec: *** cfgtrace:onreply_route=[REPLY_FROM_WEBRTC] c=[/usr/local/etc/kamailio/routing.cfg] l=341 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: exec: *** cfgtrace:onreply_route=[REPLY_FROM_WEBRTC] c=[/usr/local/etc/kamailio/routing.cfg] l=338 a=25 n=rtpengine_manage
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/msg_parser.c:204]: get_hdr_field(): DEBUG: get_hdr_body : content_length=727
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/msg_parser.c:106]: get_hdr_field(): found end of header
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/sdp/sdp_helpr_funcs.c:505]: extract_mediaip(): located IP address [127.0.0.1] in `o=' field
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/sdp/sdp_helpr_funcs.c:505]: extract_mediaip(): located IP address [79.241.195.106] in `c=' field
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/sdp/sdp.c:574]: parse_sdp_session(): ignoring unknown type in a= line: `a=ice-ufrag:+Z44C1VkL2rZQ5wK#015#012a=ice-pwd:DauTWlWLe+Yybpuh7JdFGQcD#015#012a=fingerprint:sha-256 ED:DB:B8:D5:4D:38:1F:81:DC:94:9F:EB:6D:07:56:75:57:45:F4:F7:57:4D:C6:89:70:CC:13:6D:35:C0:8B:45#015#012a=setup:active#015#012a=mid:audio#015#012a=sendrecv#015#012a=rtcp-mux#015#012a=rtpmap:0 PCMU/8000#015#012a=rtpmap:8 PCMA/8000#015#012a=rtpmap:101 telephone-event/8000#015#012a=msid-semantic: WMS kQRwOjS74zsaoS2HV2t5vrQ4M3I2n9vOhO6A#015#012'
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/sdp/sdp.c:574]: parse_sdp_session(): ignoring unknown type in a= line: `a=ice-pwd:DauTWlWLe+Yybpuh7JdFGQcD#015#012a=fingerprint:sha-256 ED:DB:B8:D5:4D:38:1F:81:DC:94:9F:EB:6D:07:56:75:57:45:F4:F7:57:4D:C6:89:70:CC:13:6D:35:C0:8B:45#015#012a=setup:active#015#012a=mid:audio#015#012a=sendrecv#015#012a=rtcp-mux#015#012a=rtpmap:0 PCMU/8000#015#012a=rtpmap:8 PCMA/8000#015#012a=rtpmap:101 telephone-event/8000#015#012a=msid-semantic: WMS kQRwOjS74zsaoS2HV2t5vrQ4M3I2n9vOhO6A#015#012'
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/sdp/sdp.c:574]: parse_sdp_session(): ignoring unknown type in a= line: `a=fingerprint:sha-256 ED:DB:B8:D5:4D:38:1F:81:DC:94:9F:EB:6D:07:56:75:57:45:F4:F7:57:4D:C6:89:70:CC:13:6D:35:C0:8B:45#015#012a=setup:active#015#012a=mid:audio#015#012a=sendrecv#015#012a=rtcp-mux#015#012a=rtpmap:0 PCMU/8000#015#012a=rtpmap:8 PCMA/8000#015#012a=rtpmap:101 telephone-event/8000#015#012a=msid-semantic: WMS kQRwOjS74zsaoS2HV2t5vrQ4M3I2n9vOhO6A#015#012'
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/sdp/sdp.c:574]: parse_sdp_session(): ignoring unknown type in a= line: `a=setup:active#015#012a=mid:audio#015#012a=sendrecv#015#012a=rtcp-mux#015#012a=rtpmap:0 PCMU/8000#015#012a=rtpmap:8 PCMA/8000#015#012a=rtpmap:101 telephone-event/8000#015#012a=msid-semantic: WMS kQRwOjS74zsaoS2HV2t5vrQ4M3I2n9vOhO6A#015#012'
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/sdp/sdp.c:574]: parse_sdp_session(): ignoring unknown type in a= line: `a=mid:audio#015#012a=sendrecv#015#012a=rtcp-mux#015#012a=rtpmap:0 PCMU/8000#015#012a=rtpmap:8 PCMA/8000#015#012a=rtpmap:101 telephone-event/8000#015#012a=msid-semantic: WMS kQRwOjS74zsaoS2HV2t5vrQ4M3I2n9vOhO6A#015#012'
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/sdp/sdp.c:574]: parse_sdp_session(): ignoring unknown type in a= line: `a=rtcp-mux#015#012a=rtpmap:0 PCMU/8000#015#012a=rtpmap:8 PCMA/8000#015#012a=rtpmap:101 telephone-event/8000#015#012a=msid-semantic: WMS kQRwOjS74zsaoS2HV2t5vrQ4M3I2n9vOhO6A#015#012'
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/sdp/sdp.c:574]: parse_sdp_session(): ignoring unknown type in a= line: `a=msid-semantic: WMS kQRwOjS74zsaoS2HV2t5vrQ4M3I2n9vOhO6A#015#012'
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/parse_addr_spec.c:176]: parse_to_param(): DEBUG: add_param: tag=as256208c2
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/parse_addr_spec.c:898]: parse_addr_spec(): end of header reached, state=29
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: rtpengine [rtpengine_funcs.c:148]: check_content_type(): type <application/sdp> found valid
Oct 23 17:40:43 h2296799 rtpengine[31909]: Got valid command from 127.0.0.1:40602: answer - { "sdp": "v=0#015#012o=- 4634492076804967012 2 IN IP4 127.0.0.1#015#012s=-#015#012t=0 0#015#012m=audio 42803 UDP/TLS/RTP/SAVPF 0 8 101#015#012c=IN IP4 79.241.195.106#015#012a=rtcp:1 IN IP4 0.0.0.0#015#012a=candidate:290309024 1 udp 2122260223 192.168.35.78 42803 typ host generation 0#015#012a=candidate:2416297236 1 udp 1686052607 79.241.195.106 42803 typ srflx raddr 192.168.35.78 rport 42803 generation 0#015#012a=ice-ufrag:+Z44C1VkL2rZQ5wK#015#012a=ice-pwd:DauTWlWLe+Yybpuh7JdFGQcD#015#012a=fingerprint:sha-256 ED ...
Oct 23 17:40:43 h2296799 rtpengine[31909]: ... :DB:B8:D5:4D:38:1F:81:DC:94:9F:EB:6D:07:56:75:57:45:F4:F7:57:4D:C6:89:70:CC:13:6D:35:C0:8B:45#015#012a=setup:active#015#012a=mid:audio#015#012a=sendrecv#015#012a=rtcp-mux#015#012a=rtpmap:0 PCMU/8000#015#012a=rtpmap:8 PCMA/8000#015#012a=rtpmap:101 telephone-event/8000#015#012a=msid-semantic: WMS kQRwOjS74zsaoS2HV2t5vrQ4M3I2n9vOhO6A#015#012", "ICE": "remove", "flags": [ "force", "trust-address" ], "replace": [ "origin", "session-connection" ], "transport-protocol": "RTP/AVP", "call-id": "196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060", "received ...
Oct 23 17:40:43 h2296799 rtpengine[31909]: ... -from": [ "IP4", "104.155.12.183" ], "from-tag": "as256208c2", "to-tag": "SDVRFERBW34HCYPMNKL83KN3C37E2AAEQAY9", "command": "answer" }
Oct 23 17:40:43 h2296799 rtpengine[31909]: Unknown flag encountered: 'force'
Oct 23 17:40:43 h2296799 rtpengine[31909]: [196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060] Returning to SIP proxy: d3:sdp299:v=0#015#012o=- 4634492076804967012 2 IN IP4 85.214.131.158#015#012s=-#015#012t=0 0#015#012m=audio 31506 RTP/AVP 0 8 101#015#012c=IN IP4 85.214.131.158#015#012a=mid:audio#015#012a=rtpmap:0 PCMU/8000#015#012a=rtpmap:8 PCMA/8000#015#012a=rtpmap:101 telephone-event/8000#015#012a=msid-semantic: WMS kQRwOjS74zsaoS2HV2t5vrQ4M3I2n9vOhO6A#015#012a=sendrecv#015#012a=rtcp:31507#015#0126:result2:oke
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: rtpengine [rtpengine.c:1448]: rtpp_function_call(): proxy reply: d3:sdp299:v=0#015#012o=- 4634492076804967012 2 IN IP4 85.214.131.158#015#012s=-#015#012t=0 0#015#012m=audio 31506 RTP/AVP 0 8 101#015#012c=IN IP4 85.214.131.158#015#012a=mid:audio#015#012a=rtpmap:0 PCMU/8000#015#012a=rtpmap:8 PCMA/8000#015#012a=rtpmap:101 telephone-event/8000#015#012a=msid-semantic: WMS kQRwOjS74zsaoS2HV2t5vrQ4M3I2n9vOhO6A#015#012a=sendrecv#015#012a=rtcp:31507#015#0126:result2:oke
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: exec: *** cfgtrace:onreply_route=[REPLY_FROM_WEBRTC] c=[/usr/local/etc/kamailio/routing.cfg] l=339 a=5 n=route
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: exec: *** cfgtrace:onreply_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=267 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: exec: *** cfgtrace:onreply_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=260 a=24 n=is_request
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: exec: *** cfgtrace:onreply_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=270 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: exec: *** cfgtrace:onreply_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=267 a=41 n=isflagset
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: exec: *** cfgtrace:onreply_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=270 a=26 n=xlog
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <script>: KAMAILIO >>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>>> WEBRTC
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: exec: *** cfgtrace:onreply_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=272 a=25 n=rtpengine_manage
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: rtpengine [rtpengine_funcs.c:148]: check_content_type(): type <application/sdp> found valid
Oct 23 17:40:43 h2296799 rtpengine[31909]: Got valid command from 127.0.0.1:40602: answer - { "sdp": "v=0#015#012o=- 4634492076804967012 2 IN IP4 127.0.0.1#015#012s=-#015#012t=0 0#015#012m=audio 42803 UDP/TLS/RTP/SAVPF 0 8 101#015#012c=IN IP4 79.241.195.106#015#012a=rtcp:1 IN IP4 0.0.0.0#015#012a=candidate:290309024 1 udp 2122260223 192.168.35.78 42803 typ host generation 0#015#012a=candidate:2416297236 1 udp 1686052607 79.241.195.106 42803 typ srflx raddr 192.168.35.78 rport 42803 generation 0#015#012a=ice-ufrag:+Z44C1VkL2rZQ5wK#015#012a=ice-pwd:DauTWlWLe+Yybpuh7JdFGQcD#015#012a=fingerprint:sha-256 ED ...
Oct 23 17:40:43 h2296799 rtpengine[31909]: ... :DB:B8:D5:4D:38:1F:81:DC:94:9F:EB:6D:07:56:75:57:45:F4:F7:57:4D:C6:89:70:CC:13:6D:35:C0:8B:45#015#012a=setup:active#015#012a=mid:audio#015#012a=sendrecv#015#012a=rtcp-mux#015#012a=rtpmap:0 PCMU/8000#015#012a=rtpmap:8 PCMA/8000#015#012a=rtpmap:101 telephone-event/8000#015#012a=msid-semantic: WMS kQRwOjS74zsaoS2HV2t5vrQ4M3I2n9vOhO6A#015#012", "ICE": "force", "flags": [ "trust-address" ], "replace": [ "origin", "session-connection" ], "transport-protocol": "RTP/SAVPF", "rtcp-mux": [ "offer" ], "call-id": "196ed5472ca6caba3885f80b28b16794@10.240.215.73 ...
Oct 23 17:40:43 h2296799 rtpengine[31909]: ... :5060", "received-from": [ "IP4", "104.155.12.183" ], "from-tag": "as256208c2", "to-tag": "SDVRFERBW34HCYPMNKL83KN3C37E2AAEQAY9", "command": "answer" }
Oct 23 17:40:43 h2296799 rtpengine[31909]: [196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060] Returning to SIP proxy: d3:sdp529:v=0#015#012o=- 4634492076804967012 2 IN IP4 85.214.131.158#015#012s=-#015#012t=0 0#015#012a=ice-lite#015#012m=audio 31506 RTP/SAVPF 0 8 101#015#012c=IN IP4 85.214.131.158#015#012a=mid:audio#015#012a=rtpmap:0 PCMU/8000#015#012a=rtpmap:8 PCMA/8000#015#012a=rtpmap:101 telephone-event/8000#015#012a=msid-semantic: WMS kQRwOjS74zsaoS2HV2t5vrQ4M3I2n9vOhO6A#015#012a=sendrecv#015#012a=rtcp:31507#015#012a=ice-ufrag:nXEDxzTJ#015#012a=ice-pwd:bToZ8mZqK84jQVpBXtEnHTy3PaGk#015#012a=candidate:3vGfmhXSfMBPekEx 1 UDP 2130706431 85.214.131.158 31506 typ host#015#012a=candidate:3v ...
Oct 23 17:40:43 h2296799 rtpengine[31909]: [196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060] ... GfmhXSfMBPekEx 2 UDP 2130706430 85.214.131.158 31507 typ host#015#0126:result2:oke
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: rtpengine [rtpengine.c:1448]: rtpp_function_call(): proxy reply: d3:sdp529:v=0#015#012o=- 4634492076804967012 2 IN IP4 85.214.131.158#015#012s=-#015#012t=0 0#015#012a=ice-lite#015#012m=audio 31506 RTP/SAVPF 0 8 101#015#012c=IN IP4 85.214.131.158#015#012a=mid:audio#015#012a=rtpmap:0 PCMU/8000#015#012a=rtpmap:8 PCMA/8000#015#012a=rtpmap:101 telephone-event/8000#015#012a=msid-semantic: WMS kQRwOjS74zsaoS2HV2t5vrQ4M3I2n9vOhO6A#015#012a=sendrecv#015#012a=rtcp:31507#015#012a=ice-ufrag:nXEDxzTJ#015#012a=ice-pwd:bToZ8mZqK84jQVpBXtEnHTy3PaGk#015#012a=candidate:3vGfmhXSfMBPekEx 1 UDP 2130706431 85.214.131.158 31506 typ host#015#012a=candidate:3vGfmhXSfMBPekEx 2 UDP 2130706430 85.214.131.158 31507 typ host#015#0126:result2:oke
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: exec: *** cfgtrace:onreply_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=273 a=25 n=t_on_reply
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: exec: *** cfgtrace:onreply_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=282 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: exec: *** cfgtrace:onreply_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=275 a=24 n=is_request
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: exec: *** cfgtrace:onreply_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=288 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: exec: *** cfgtrace:onreply_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=282 a=24 n=is_reply
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: exec: *** cfgtrace:onreply_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=286 a=16 n=if
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: exec: *** cfgtrace:onreply_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=283 a=25 n=isbflagset
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: exec: *** cfgtrace:onreply_route=[NATMANAGE] c=[/usr/local/etc/kamailio/routing.cfg] l=288 a=2 n=return
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: tm [t_reply.c:1304]: t_should_relay_response(): ->>>>>>>>> T_code=100, new_code=200
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: tm [t_reply.c:1822]: relay_reply(): DEBUG: relay_reply: branch=0, save=0, relay=0 icode=0
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [msg_translator.c:458]: clen_builder(): clen_builder: content-length: 828 (828)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [msg_translator.c:2266]: generate_res_buf_from_sip_res():  old size: 1359, new size: 1335
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [msg_translator.c:2284]: generate_res_buf_from_sip_res(): copied size: orig:1359, new: 1335, rest: 0 msg=#012SIP/2.0 200 OK#015#012Via: SIP/2.0/UDP 10.240.215.73:5060;rport=5060;received=146.148.113.245;branch=z9hG4bK7401abed#015#012From: "Anonymous" <sip:anonymous@anonymous.invalid>;tag=as256208c2#015#012To:  <sip:eih66yyxjlwnvncukw...@whtest3.24dial.com>;tag=SDVRFERBW34HCYPMNKL83KN3C37E2AAEQAY9#015#012Contact:  <sip:eih66yyxjlwnvncukw...@whtest3.24dial.com>;tag=SDVRFERBW34HCYPMNKL83KN3C37E2AAEQAY9#015#012Call-ID: 196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060#015#012CSeq: 102 INVITE#015#012Content-Type: application/sdp#015#012Content-Length: 828#015#012#015#012v=0#015#012o=- 4634492076804967012 2 IN IP4 85.214.131.158#015#012s=-#015#012t=0 0#015#012m=audio 31506 RTP/AVP 0 8 101#015#012c=IN IP4 85.214.131.158#015#012a=mid:audio#015#012a=rtpmap:0 PCMU/8000#015#012a=rtpmap:8 PCMA/8000#015#012a=rtpmap:101 telephone-event/8000#015#012a=msid-semantic: WMS kQRwOjS74zsaoS2HV2t5vrQ4M3I2n9vOhO6A#015#012a=sendrecv#015#012a=rtcp:31507#015#012v=0#015#012o=- 4634492076804967012 2 IN IP4 85.214.131.158#015#012s=-#015#012t=0 0#015#012a=ice-lite#015#012m=audio 31506 RTP/SAVPF 0 8 101#015#012c=IN IP4 85.214.131.158#015#012a=mid:audio#015#012a=rtpmap:0 PCMU/8000#015#012a=rtpmap:8 PCMA/8000#015#012a=rtpmap:101 telephone-event/8000#015#012a=msid-semantic: WMS kQRwOjS74zsaoS2HV2t5vrQ4M3I2n9vOhO6A#015#012a=sendrecv#015#012a=rtcp:31507#015#012a=ice-ufrag:nXEDxzTJ#015#012a=ice-pwd:bToZ8mZqK84jQVpBXtEnHTy3PaGk#015#012a=candidate:3vGfmhXSfMBPekEx 1 UDP 2130706431 85.214.131.158 31506 typ host#015#012a=candidate:3vGfmhXSfMBPekEx 2 UDP 2130706430 85.214.131.158 31507 typ host#015#012
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: tm [t_reply.c:416]: update_totag_set(): DEBUG: update_totag_set: new totag 
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: tm [t_hooks.c:288]: run_trans_callbacks_internal(): DBG: trans=0x7f9ff7f895d8, callback type 512, id 0 entered
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: acc [acc_logic.c:644]: tmcb_func(): acc callback called for t(0x7f9ff7f895d8) event type 512, reply code 200
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: NOTICE: acc [acc.c:318]: acc_log_request(): ACC: transaction answered: timestamp=1414078843;method=INVITE;from_tag=as256208c2;to_tag=SDVRFERBW34HCYPMNKL83KN3C37E2AAEQAY9;call_id=196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060;code=200;reason=OK;src_user=anonymous;src_domain=anonymous.invalid;src_ip=146.148.113.245;dst_ouser=eIh66yyxjlWNvNcuKWskH;dst_user=eIh66yyxjlWNvNcuKWskH;dst_domain=whtest3.24dial.com
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: acc [acc_extra.h:81]: free_strar_mem(): Freeing memory, type is 2, message_index 6, index i 0
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: acc [acc_extra.h:81]: free_strar_mem(): Freeing memory, type is 2, message_index 6, index i 1
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: acc [acc_extra.h:81]: free_strar_mem(): Freeing memory, type is 2, message_index 6, index i 2
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: acc [acc_extra.h:81]: free_strar_mem(): Freeing memory, type is 2, message_index 6, index i 3
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: acc [acc_extra.h:81]: free_strar_mem(): Freeing memory, type is 2, message_index 6, index i 4
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: acc [acc_extra.h:81]: free_strar_mem(): Freeing memory, type is 2, message_index 6, index i 5
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: tm [t_reply.c:1663]: cleanup_uac_timers(): DEBUG: cleanup_uac_timers: RETR/FR timers reset
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [usr_avp.c:643]: destroy_avp_list(): DEBUG:destroy_avp_list: destroying list (nil)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [usr_avp.c:643]: destroy_avp_list(): DEBUG:destroy_avp_list: destroying list (nil)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [usr_avp.c:643]: destroy_avp_list(): DEBUG:destroy_avp_list: destroying list (nil)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [usr_avp.c:643]: destroy_avp_list(): DEBUG:destroy_avp_list: destroying list (nil)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [usr_avp.c:643]: destroy_avp_list(): DEBUG:destroy_avp_list: destroying list (nil)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [usr_avp.c:643]: destroy_avp_list(): DEBUG:destroy_avp_list: destroying list (nil)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [xavp.c:448]: xavp_destroy_list(): destroying xavp list (nil)
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [receive.c:298]: receive_msg(): receive_msg: cleaning up
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/sdp/sdp.c:793]: free_sdp(): _sdp = 0x7fa000363cc8
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/sdp/sdp.c:795]: free_sdp(): sdp = 0x7fa000358608
Oct 23 17:40:43 h2296799 /usr/local/sbin/kamailio[32473]: DEBUG: <core> [parser/sdp/sdp.c:797]: free_sdp(): session = 0x7fa000356920
Oct 23 17:40:43 h2296799 rtpengine[31909]: [196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060 port 31506] SRTP output wanted, but no crypto suite was negotiated
Oct 23 17:40:44 h2296799 rtpengine[31909]: [196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060 port 31486] Successful STUN binding request from 79.241.195.106:42803
Oct 23 17:40:44 h2296799 rtpengine[31909]: [196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060 port 31486] STUN: using this candidate
Oct 23 17:40:44 h2296799 rtpengine[31909]: [196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060 port 31486] Successful STUN binding request from 79.241.195.106:42803
Oct 23 17:40:44 h2296799 rtpengine[31909]: [196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060 port 31486] STUN: using this candidate
Oct 23 17:40:44 h2296799 rtpengine[31909]: [196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060 port 31486] DTLS: Peer certificate accepted
Oct 23 17:40:44 h2296799 rtpengine[31909]: [196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060 port 31486] DTLS handshake successful
Oct 23 17:40:44 h2296799 rtpengine[31909]: [196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060 port 31486] DTLS-SRTP successfully negotiated
Oct 23 17:40:44 h2296799 rtpengine[31909]: [196ed5472ca6caba3885f80b28b16794@10.240.215.73:5060 port 31486] DTLS-SRTP successfully negotiated
_______________________________________________
SIP Express Router (SER) and Kamailio (OpenSER) - sr-users mailing list
sr-users@lists.sip-router.org
http://lists.sip-router.org/cgi-bin/mailman/listinfo/sr-users

Reply via email to