I am an web developer and want to create a WEBRTC application. My knowledge level in SIP is beginner. I want my application to talk to kamailio and in process of setting up kamailio by following the below articles.
http://nil.uniza.sk/sip/kamailio/configuring-kamailio-4x-websocket http://kamailio.org/docs/modules/4.3.x/modules/websocket.html
I was able to connect (using try.jssp.net) to kamailio as multiple clients for initial setup and successfully able to get voice and video working.
But I'm unable to send messages between clients and receive "408 Request Timeout" error. I have the presence and presence_xml modules loaded and have the # ----- mi_fifo params ----- modparam("mi_fifo", "fifo_name", "/var/run/kamailio/kamailio_fifo")
# ----- ctl params ----- modparam("ctl", "binrpc", "unix:/var/run/kamailio/kamailio_ctl")
Below is the log. Any help is appreciated.
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: websocket [ws_conn.c:382]: wsconn_put(): wsconn_put start for [0x7f06a2a76298] refcnt [2]
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: websocket [ws_conn.c:415]: wsconn_put(): wsconn_put end for [0x7f06a2a76298] refcnt [1]
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[AUTH] c=[/usr/local/etc/kamailio/kamailio.cfg] l=825 a=2 n=exit
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [usr_avp.c:631]: destroy_avp_list(): destroying list (nil)
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [usr_avp.c:631]: destroy_avp_list(): destroying list (nil)
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [usr_avp.c:631]: destroy_avp_list(): destroying list (nil)
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [usr_avp.c:631]: destroy_avp_list(): destroying list (nil)
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [usr_avp.c:631]: destroy_avp_list(): destroying list (nil)
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [usr_avp.c:631]: destroy_avp_list(): destroying list (nil)
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [xavp.c:446]: xavp_destroy_list(): destroying xavp list (nil)
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [receive.c:278]: receive_msg(): cleaning up
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [tcp_read.c:1153]: ws_process_msg(): WebSocket Message: [[>>>#012??#002?E?<<<]]
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: websocket [ws_conn.c:429]: wsconn_get(): wsconn_get for id [2]
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: websocket [ws_conn.c:437]: wsconn_get(): wsconn_get returns wsc [0x7f06a2a76298] refcnt [2]
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: websocket [ws_frame.c:415]: decode_and_validate_ws_frame(): decoding WebSocket frame
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: websocket [ws_frame.c:456]: decode_and_validate_ws_frame(): supported non-control frame: 0x1
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: websocket [ws_frame.c:555]: decode_and_validate_ws_frame(): Rx (decoded): MESSAGE sip:abc123@ip-205-64-10.dqa.capitalone.com SIP/2.0#015#012Via: SIP/2.0/WS kjh0uotuqma6.invalid;branch=z9hG4bK9552000#015#012Max-Forwards: 69#015#012To: sip:abc123@ip-205-64-10.dqa.capitalone.com#015#012From: "xyz987" sip:xyz987@ip-205-64-10.test.com:8088;tag=c1joq54vne#015#012Call-ID: orel8as144p4ebuuf96n#015#012CSeq: 1977 MESSAGE#015#012Proxy-Authorization: Digest algorithm=MD5, username="xyz987", realm="ip-205-64-10.test.com", nonce="Vee3iFXntlzqK/kDTxUAIxwI55RzH/ll", uri=" sip:abc123@ip-205-64-10.test.com", response="0d513943ed7a0234b7016c5f4546b0b7"#015#012Content-Type: text/plain#015#012Allow: INVITE,ACK,CANCEL,BYE,UPDATE,MESSAGE,OPTIONS,REFER#015#012Supported: outbound#015#012User-Agent: JsSIP 0.7.4#015#012Content-Length: 13#015#012#015#012samplemsgwork
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: websocket [ws_frame.c:659]: ws_frame_receive(): Rx SIP message:#012MESSAGE sip:abc123@ip-10-255-54-20.test.com SIP/2.0#015#012Via: SIP/2.0/WS kjh0uotuqma6.invalid;branch=z9hG4bK9552000#015#012Max-Forwards: 69#015#012To: sip:abc123@ip-10-255-54-20.test.com#015#012From: "xyz987" < sip:xyz987@ip-10-255-54-20.test.com:8088>;tag=c1joq54vne#015#012Call-ID: orel8as144p4ebuuf96n#015#012CSeq: 1977 MESSAGE#015#012Proxy-Authorization: Digest algorithm=MD5, username="xyz987", realm="ip-10-255-54-20.test.com", nonce="Vee3iFXntlzqK/kDTxUAIxwI55RzH/ll", uri=" sip:abc123@ip-10-255-54-20.test.com", response="0d513943ed7a0234b7016c5f4546b0b7"#015#012Content-Type: text/plain#015#012Allow: INVITE,ACK,CANCEL,BYE,UPDATE,MESSAGE,OPTIONS,REFER#015#012Supported: outbound#015#012User-Agent: JsSIP 0.7.4#015#012Content-Length: 13#015#012#015#012samplemsgwork
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: websocket [ws_conn.c:382]: wsconn_put(): wsconn_put start for [0x7f06a2a76298] refcnt [2]
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: websocket [ws_conn.c:415]: wsconn_put(): wsconn_put end for [0x7f06a2a76298] refcnt [1]
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [parser/msg_parser.c:606]: parse_msg(): SIP Request:
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [parser/msg_parser.c:608]: parse_msg(): method: <MESSAGE>
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [parser/msg_parser.c:610]: parse_msg(): uri: < sip:abc123@ip-10-255-54-20.test.com>
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [parser/msg_parser.c:612]: parse_msg(): version: <SIP/2.0>
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [parser/parse_via.c:1254]: parse_via_param(): Found param type 232, <branch> = <z9hG4bK9552000>; state=16
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [parser/parse_via.c:2642]: parse_via(): end of header reached, state=5
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [parser/msg_parser.c:496]: parse_headers(): parse_headers: Via found, flags=2
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [parser/msg_parser.c:498]: parse_headers(): parse_headers: this is the first via
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [receive.c:134]: receive_msg(): After parse_msg...
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [receive.c:177]: receive_msg(): preparing to run routing scripts...
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/kamailio.cfg] l=506 a=5 n=route
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[REQINIT] c=[/usr/local/etc/kamailio/kamailio.cfg] l=639 a=16 n=if
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[REQINIT] c=[/usr/local/etc/kamailio/kamailio.cfg] l=634 a=25 n=mf_process_maxfwd_header
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: maxfwd [mf_funcs.c:85]: is_maxfwd_present(): value = 69
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[REQINIT] c=[/usr/local/etc/kamailio/kamailio.cfg] l=644 a=16 n=if
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[REQINIT] c=[/usr/local/etc/kamailio/kamailio.cfg] l=639 a=25 n=is_method
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[REQINIT] c=[/usr/local/etc/kamailio/kamailio.cfg] l=648 a=16 n=if
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[REQINIT] c=[/usr/local/etc/kamailio/kamailio.cfg] l=644 a=26 n=sanity_check
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [parser/parse_addr_spec.c:894]: parse_addr_spec(): end of header reached, state=10
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [parser/msg_parser.c:173]: get_hdr_field(): DEBUG: get_hdr_field: <To> [46]; uri=[sip:abc123@ip-10-255-54-20.test.com]
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [parser/msg_parser.c:175]: get_hdr_field(): DEBUG: to body [< sip:abc123@ip-10-255-54-20.test.com>#015#012]
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [parser/msg_parser.c:153]: get_hdr_field(): get_hdr_field: cseq <CSeq>: <1977> <MESSAGE>
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [parser/msg_parser.c:187]: get_hdr_field(): DEBUG: get_hdr_body : content_length=13
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [parser/msg_parser.c:89]: get_hdr_field(): found end of header
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [parser/parse_addr_spec.c:172]: parse_to_param(): DEBUG: add_param: tag=c1joq54vne
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [parser/parse_addr_spec.c:894]: parse_addr_spec(): end of header reached, state=29
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: sanity [mod_sanity.c:248]: w_sanity_check(): sanity checks result: 1
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/kamailio.cfg] l=529 a=16 n=if
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/kamailio.cfg] l=509 a=25 n=nat_uac_test
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/kamailio.cfg] l=514 a=55 n=force_rport
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/kamailio.cfg] l=524 a=16 n=if
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/kamailio.cfg] l=515 a=25 n=is_method
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/kamailio.cfg] l=524 a=16 n=if
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/kamailio.cfg] l=519 a=24 n=add_contact_alias
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: nathelper [nathelper.c:958]: add_contact_alias_0_f(): no contact header
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/kamailio.cfg] l=529 a=5 n=route
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/kamailio.cfg] l=846 a=55 n=force_rport
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/kamailio.cfg] l=857 a=16 n=if
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/kamailio.cfg] l=847 a=25 n=nat_uac_test
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/kamailio.cfg] l=853 a=16 n=if
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/kamailio.cfg] l=848 a=25 n=is_method
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/kamailio.cfg] l=853 a=16 n=if
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/kamailio.cfg] l=851 a=24 n=is_first_hop
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: siputils [sipops.c:159]: w_is_first_hop(): no 2nd via found - first hop
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/kamailio.cfg] l=852 a=24 n=set_contact_alias
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/kamailio.cfg] l=854 a=39 n=setflag
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[NATDETECT] c=[/usr/local/etc/kamailio/kamailio.cfg] l=857 a=2 n=return
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/kamailio.cfg] l=540 a=16 n=if
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/kamailio.cfg] l=532 a=25 n=is_method
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/kamailio.cfg] l=540 a=5 n=route
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[WITHINDLG] c=[/usr/local/etc/kamailio/kamailio.cfg] l=654 a=16 n=if
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[WITHINDLG] c=[/usr/local/etc/kamailio/kamailio.cfg] l=652 a=24 n=has_totag
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: siputils [checks.c:97]: has_totag(): no totag
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[WITHINDLG] c=[/usr/local/etc/kamailio/kamailio.cfg] l=652 a=2 n=return
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/kamailio.cfg] l=549 a=16 n=if
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/kamailio.cfg] l=545 a=24 n=t_precheck_trans
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/kamailio.cfg] l=549 a=24 n=t_check_trans
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: tm [t_lookup.c:1011]: t_check_msg(): DEBUG: t_check_msg: msg id=4 global id=3 T start=(nil)
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: tm [t_lookup.c:466]: t_lookup_request(): t_lookup_request: start searching: hash=65389, isACK=0
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: tm [t_lookup.c:424]: matching_3261(): DEBUG: RFC3261 transaction matching failed
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: tm [t_lookup.c:648]: t_lookup_request(): DEBUG: t_lookup_request: no transaction found
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: tm [t_lookup.c:1080]: t_check_msg(): DEBUG: t_check_msg: msg id=4 global id=4 T end=(nil)
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[DEFAULT_ROUTE] c=[/usr/local/etc/kamailio/kamailio.cfg] l=552 a=5 n=route
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[AUTH] c=[/usr/local/etc/kamailio/kamailio.cfg] l=833 a=16 n=if
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[AUTH] c=[/usr/local/etc/kamailio/kamailio.cfg] l=820 a=25 n=is_method
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [socket_info.c:563]: grep_sock_info(): checking if host==us: 31==12 && [ ip-10-255-54-20.test.com] == [10.205.64.10]
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [socket_info.c:566]: grep_sock_info(): checking if port 8088 (advertise 0) matches port 8088
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [socket_info.c:563]: grep_sock_info(): checking if host==us: 31==12 && [ ip-10-255-54-20.test.com] == [10.205.64.10]
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [socket_info.c:566]: grep_sock_info(): checking if port 8088 (advertise 0) matches port 8088
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [socket_info.c:563]: grep_sock_info(): checking if host==us: 31==12 && [ ip-10-255-54-20.test.com] == [10.205.64.10]
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [socket_info.c:566]: grep_sock_info(): checking if port 8080 (advertise 0) matches port 8088
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [socket_info.c:563]: grep_sock_info(): checking if host==us: 31==12 && [ ip-10-255-54-20.test.com] == [10.205.64.10]
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [socket_info.c:566]: grep_sock_info(): checking if port 5061 (advertise 0) matches port 8088
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [socket_info.c:563]: grep_sock_info(): checking if host==us: 31==12 && [ ip-10-255-54-20.test.com] == [10.205.64.10]
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [socket_info.c:566]: grep_sock_info(): checking if port 4443 (advertise 0) matches port 8088
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[AUTH] c=[/usr/local/etc/kamailio/kamailio.cfg] l=828 a=16 n=if
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10177]: exec: *** cfgtrace:request_route=[AUTH] c=[/usr/local/etc/kamailio/kamailio.cfg] l=823 a=27 n=auth_check
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:457]: wsconn_get_list(): wsconn_get_list
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:465]: wsconn_get_list(): counter wsc [0x7f06a2a775a8] prev => [(nil)] next => [0x7f06a2a76298]
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:465]: wsconn_get_list(): counter wsc [0x7f06a2a76298] prev => [0x7f06a2a775a8] next => [(nil)]
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:492]: wsconn_get_list(): wsc [0x7f06a2a775a8] id [1] ref++
Sep 2 22:54:20 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:492]: wsconn_get_list(): wsc [0x7f06a2a76298] id [2] ref++
Sep 2 22:54:25 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:501]: wsconn_get_list(): wsconn_get_list returns list [0x7f06ab4f8350] with [2] members
Sep 2 22:54:25 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:511]: wsconn_put_list(): wsconn_put_list [0x7f06ab4f8350]
Sep 2 22:54:25 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:382]: wsconn_put(): wsconn_put start for [0x7f06a2a775a8] refcnt [2]
Sep 2 22:54:25 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:415]: wsconn_put(): wsconn_put end for [0x7f06a2a775a8] refcnt [1]
Sep 2 22:54:25 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:382]: wsconn_put(): wsconn_put start for [0x7f06a2a76298] refcnt [2]
Sep 2 22:54:25 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:415]: wsconn_put(): wsconn_put end for [0x7f06a2a76298] refcnt [1]
Sep 2 22:54:26 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [io_wait.h:598]: io_watch_del(): DBG: io_watch_del (0xa40820, 9, -1, 0x10) fd_no=2 called
Sep 2 22:54:26 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [tcp_read.c:1450]: release_tcpconn(): releasing con 0x7f06a2a8c3b8, state 1, fd=9, id=2
Sep 2 22:54:26 ip-10-255-54-20 kamailio[10177]: DEBUG: <core> [tcp_read.c:1451]: release_tcpconn(): extra_data (nil)
Sep 2 22:54:26 ip-10-255-54-20 kamailio[10178]: DEBUG: <core> [tcp_main.c:3243]: handle_tcp_child(): reader response= 7f06a2a8c3b8, 1 from 3
Sep 2 22:54:26 ip-10-255-54-20 kamailio[10178]: DEBUG: <core> [io_wait.h:376]: io_watch_add(): DBG: io_watch_add(0x9fc580, 34, 2, 0x7f06a2a8c3b8), fd_no=23
Sep 2 22:54:26 ip-10-255-54-20 kamailio[10178]: DEBUG: <core> [tcp_main.c:3370]: handle_tcp_child(): CONN_RELEASE 0x7f06a2a8c3b8 refcnt= 1
Sep 2 22:54:26 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:457]: wsconn_get_list(): wsconn_get_list
Sep 2 22:54:26 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:465]: wsconn_get_list(): counter wsc [0x7f06a2a775a8] prev => [(nil)] next => [0x7f06a2a76298]
Sep 2 22:54:26 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:465]: wsconn_get_list(): counter wsc [0x7f06a2a76298] prev => [0x7f06a2a775a8] next => [(nil)]
Sep 2 22:54:26 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:492]: wsconn_get_list(): wsc [0x7f06a2a775a8] id [1] ref++
Sep 2 22:54:26 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:492]: wsconn_get_list(): wsc [0x7f06a2a76298] id [2] ref++
Sep 2 22:54:26 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:501]: wsconn_get_list(): wsconn_get_list returns list [0x7f06ab4f8350] with [2] members
Sep 2 22:54:26 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:511]: wsconn_put_list(): wsconn_put_list [0x7f06ab4f8350]
Sep 2 22:54:26 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:382]: wsconn_put(): wsconn_put start for [0x7f06a2a775a8] refcnt [2]
Sep 2 22:54:26 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:415]: wsconn_put(): wsconn_put end for [0x7f06a2a775a8] refcnt [1]
Sep 2 22:54:26 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:382]: wsconn_put(): wsconn_put start for [0x7f06a2a76298] refcnt [2]
Sep 2 22:54:26 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:415]: wsconn_put(): wsconn_put end for [0x7f06a2a76298] refcnt [1]
Sep 2 22:54:27 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:457]: wsconn_get_list(): wsconn_get_list
Sep 2 22:54:27 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:465]: wsconn_get_list(): counter wsc [0x7f06a2a775a8] prev => [(nil)] next => [0x7f06a2a76298]
Sep 2 22:54:27 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:465]: wsconn_get_list(): counter wsc [0x7f06a2a76298] prev => [0x7f06a2a775a8] next => [(nil)]
Sep 2 22:54:27 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:492]: wsconn_get_list(): wsc [0x7f06a2a775a8] id [1] ref++
Sep 2 22:54:27 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:492]: wsconn_get_list(): wsc [0x7f06a2a76298] id [2] ref++
Sep 2 22:54:27 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:501]: wsconn_get_list(): wsconn_get_list returns list [0x7f06ab4f8350] with [2] members
Sep 2 22:54:27 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:511]: wsconn_put_list(): wsconn_put_list [0x7f06ab4f8350]
Sep 2 22:54:27 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:382]: wsconn_put(): wsconn_put start for [0x7f06a2a775a8] refcnt [2]
Sep 2 22:54:27 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:415]: wsconn_put(): wsconn_put end for [0x7f06a2a775a8] refcnt [1]
Sep 2 22:54:27 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:382]: wsconn_put(): wsconn_put start for [0x7f06a2a76298] refcnt [2]
Sep 2 22:54:27 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:415]: wsconn_put(): wsconn_put end for [0x7f06a2a76298] refcnt [1]
Sep 2 22:54:28 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:457]: wsconn_get_list(): wsconn_get_list
Sep 2 22:54:28 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:465]: wsconn_get_list(): counter wsc [0x7f06a2a775a8] prev => [(nil)] next => [0x7f06a2a76298]
Sep 2 22:54:28 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:465]: wsconn_get_list(): counter wsc [0x7f06a2a76298] prev => [0x7f06a2a775a8] next => [(nil)]
Sep 2 22:54:28 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:492]: wsconn_get_list(): wsc [0x7f06a2a775a8] id [1] ref++
Sep 2 22:54:28 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:492]: wsconn_get_list(): wsc [0x7f06a2a76298] id [2] ref++
Sep 2 22:54:28 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:501]: wsconn_get_list(): wsconn_get_list returns list [0x7f06ab4f8350] with [2] members
Sep 2 22:54:28 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:511]: wsconn_put_list(): wsconn_put_list [0x7f06ab4f8350]
Sep 2 22:54:28 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:382]: wsconn_put(): wsconn_put start for [0x7f06a2a775a8] refcnt [2]
Sep 2 22:54:28 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:415]: wsconn_put(): wsconn_put end for [0x7f06a2a775a8] refcnt [1]
Sep 2 22:54:28 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:382]: wsconn_put(): wsconn_put start for [0x7f06a2a76298] refcnt [2]
Sep 2 22:54:28 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:415]: wsconn_put(): wsconn_put end for [0x7f06a2a76298] refcnt [1]
Sep 2 22:54:29 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:457]: wsconn_get_list(): wsconn_get_list
Sep 2 22:54:29 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:465]: wsconn_get_list(): counter wsc [0x7f06a2a775a8] prev => [(nil)] next => [0x7f06a2a76298]
Sep 2 22:54:29 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:465]: wsconn_get_list(): counter wsc [0x7f06a2a76298] prev => [0x7f06a2a775a8] next => [(nil)]
Sep 2 22:54:29 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:492]: wsconn_get_list(): wsc [0x7f06a2a775a8] id [1] ref++
Sep 2 22:54:29 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:492]: wsconn_get_list(): wsc [0x7f06a2a76298] id [2] ref++
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:501]: wsconn_get_list(): wsconn_get_list returns list [0x7f06ab4f8350] with [2] members
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:511]: wsconn_put_list(): wsconn_put_list [0x7f06ab4f8350]
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:382]: wsconn_put(): wsconn_put start for [0x7f06a2a775a8] refcnt [2]
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:415]: wsconn_put(): wsconn_put end for [0x7f06a2a775a8] refcnt [1]
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:382]: wsconn_put(): wsconn_put start for [0x7f06a2a76298] refcnt [2]
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:415]: wsconn_put(): wsconn_put end for [0x7f06a2a76298] refcnt [1]
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10164]: DEBUG: tm [t_reply.c:1230]: t_should_relay_response(): ->>>>>>>>> T_code=0, new_code=408
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10164]: DEBUG: tm [t_reply.c:1748]: relay_reply(): DEBUG: relay_reply: branch=0, save=0, relay=0 icode=0
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10164]: DEBUG: <core> [msg_translator.c:158]: check_via_address(): (172.18.116.115, kjh0uotuqma6.invalid, 0)
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10164]: DEBUG: <core> [mem/shm_mem.c:101]: _shm_resize(): WARNING:vqm_resize: resize(0) called
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10164]: DEBUG: websocket [ws_conn.c:429]: wsconn_get(): wsconn_get for id [2]
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10164]: DEBUG: websocket [ws_conn.c:437]: wsconn_get(): wsconn_get returns wsc [0x7f06a2a76298] refcnt [2]
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10164]: DEBUG: websocket [ws_frame.c:751]: ws_frame_transmit(): Tx message:#012SIP/2.0 408 Request Timeout#015#012Via: SIP/2.0/WS kjh0uotuqma6.invalid;branch=z9hG4bK2462101;rport=59540;received=172.18.116.115#015#012To: sip:abc123@ip-10-255-54-20.test.com;tag=b44d120c617c843b219e52eae8b5e9ff-3dde#015#012From: "xyz987" sip:xyz987@ip-10-255-54-20.test.com:8088;tag=5qg1sitf3i#015#012Call-ID: orel8dhn00r81cega00f#015#012CSeq: 862 MESSAGE#015#012Server: kamailio (4.4.0-dev2 (x86_64/linux))#015#012Content-Length: 0#015#012#015#012
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10164]: DEBUG: websocket [ws_frame.c:150]: encode_and_send_ws_frame(): encoding WebSocket frame
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10164]: DEBUG: websocket [ws_frame.c:181]: encode_and_send_ws_frame(): supported non-control frame: 0x1
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10164]: DEBUG: <core> [tcp_main.c:2211]: tcpconn_send_put(): tcp connection found (0x7f06a2a8c3b8), acquiring fd
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10164]: DEBUG: <core> [tcp_main.c:2221]: tcpconn_send_put(): c=0x7f06a2a8c3b8, n=16
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10178]: DEBUG: <core> [tcp_main.c:3476]: handle_ser_child(): read response= 7f06a2a8c3b8, 2, fd -1 from 5 (10164)
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10164]: DEBUG: <core> [tcp_main.c:2251]: tcpconn_send_put(): after receive_fd: c= 0x7f06a2a8c3b8 n=8 fd=8
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10164]: DEBUG: <core> [tcp_main.c:2430]: tcpconn_do_send(): sending...
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10164]: DEBUG: <core> [tcp_main.c:2464]: tcpconn_do_send(): after real write: c= 0x7f06a2a8c3b8 n=419 fd=8
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10164]: DEBUG: <core> [tcp_main.c:2465]: tcpconn_do_send(): buf=#012?~#001?SIP/2.0 408 Request Timeout#015#012Via: SIP/2.0/WS kjh0uotuqma6.invalid;branch=z9hG4bK2462101;rport=59540;received=172.18.116.115#015#012To: sip:abc123@ip-10-255-54-20.test.com;tag=b44d120c617c843b219e52eae8b5e9ff-3dde#015#012From: "xyz987" sip:xyz987@ip-10-255-54-20.test.com:8088;tag=5qg1sitf3i#015#012Call-ID: orel8dhn00r81cega00f#015#012CSeq: 862 MESSAGE#015#012Server: kamailio (4.4.0-dev2 (x86_64/linux))#015#012Content-Length: 0#015#012#015#012
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10164]: DEBUG: websocket [ws_conn.c:382]: wsconn_put(): wsconn_put start for [0x7f06a2a76298] refcnt [2]
Sep 2 22:54:31 ip-10-255-54-20 kamailio[10164]: DEBUG: websocket [ws_conn.c:415]: wsconn_put(): wsconn_put end for [0x7f06a2a76298] refcnt [1]
Sep 2 22:54:32 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:457]: wsconn_get_list(): wsconn_get_list
Sep 2 22:54:32 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:465]: wsconn_get_list(): counter wsc [0x7f06a2a775a8] prev => [(nil)] next => [0x7f06a2a76298]
Sep 2 22:54:32 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:465]: wsconn_get_list(): counter wsc [0x7f06a2a76298] prev => [0x7f06a2a775a8] next => [(nil)]
Sep 2 22:54:32 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:492]: wsconn_get_list(): wsc [0x7f06a2a775a8] id [1] ref++
Sep 2 22:54:32 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:492]: wsconn_get_list(): wsc [0x7f06a2a76298] id [2] ref++
Sep 2 22:54:32 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:501]: wsconn_get_list(): wsconn_get_list returns list [0x7f06ab4f8350] with [2] members
Sep 2 22:54:32 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:511]: wsconn_put_list(): wsconn_put_list [0x7f06ab4f8350]
Sep 2 22:54:32 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:382]: wsconn_put(): wsconn_put start for [0x7f06a2a775a8] refcnt [2]
Sep 2 22:54:32 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:415]: wsconn_put(): wsconn_put end for [0x7f06a2a775a8] refcnt [1]
Sep 2 22:54:32 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:382]: wsconn_put(): wsconn_put start for [0x7f06a2a76298] refcnt [2]
Sep 2 22:54:32 ip-10-255-54-20 kamailio[10173]: DEBUG: websocket [ws_conn.c:415]: wsconn_put(): wsconn_put end for [0x7f06a2a76298] refcnt [1]
Hello,
the log messages don't show that you change the r-uri of the MESSAGE -- e.g., no lookup("location").
By that I assume the request is not forwarded to the other user, but attempted to be forwarded back to the server, which is not possible via webscoket.
Be sure that you do location lookup for that request before forwarding.
Cheers, Daniel
On 03/09/15 05:15, vamsi wrote:
I am an web developer and want to create a WEBRTC application. My knowledge level in SIP is beginner. I want my application to talk to kamailio and in process of setting up kamailio by following the below articles.
http://nil.uniza.sk/sip/kamailio/configuring-kamailio-4x-websockethttp://kam...
I was able to connect (using try.jssp.net http://try.jssp.net) to kamailio as multiple clients for initial setup and successfully able to get voice and video working.
But I'm unable to send messages between clients and receive "408 Request Timeout" error. I have the presence and presence_xml modules loaded and have the # ----- mi_fifo params ----- modparam("mi_fifo", "fifo_name", "/var/run/kamailio/kamailio_fifo")
# ----- ctl params ----- modparam("ctl", "binrpc", "unix:/var/run/kamailio/kamailio_ctl")
Below is the log. Any help is appreciated.
...
Hi Daniel,
Thank you for the response. I'm not sure exactly where to add the check. Can you please tell me which section I should add the check. Attached is the config file that I am using
On Thu, Sep 3, 2015 at 3:27 AM, Daniel-Constantin Mierla miconda@gmail.com wrote:
Hello,
the log messages don't show that you change the r-uri of the MESSAGE -- e.g., no lookup("location").
By that I assume the request is not forwarded to the other user, but attempted to be forwarded back to the server, which is not possible via webscoket.
Be sure that you do location lookup for that request before forwarding.
Cheers, Daniel
On 03/09/15 05:15, vamsi wrote:
I am an web developer and want to create a WEBRTC application. My knowledge level in SIP is beginner. I want my application to talk to kamailio and in process of setting up kamailio by following the below articles.
http://nil.uniza.sk/sip/kamailio/configuring-kamailio-4x-websocket http://kamailio.org/docs/modules/4.3.x/modules/websocket.html
I was able to connect (using try.jssp.net) to kamailio as multiple clients for initial setup and successfully able to get voice and video working.
But I'm unable to send messages between clients and receive "408 Request Timeout" error. I have the presence and presence_xml modules loaded and have the # ----- mi_fifo params ----- modparam("mi_fifo", "fifo_name", "/var/run/kamailio/kamailio_fifo")
# ----- ctl params ----- modparam("ctl", "binrpc", "unix:/var/run/kamailio/kamailio_ctl")
Below is the log. Any help is appreciated.
...
-- Daniel-Constantin Mierlahttp://twitter.com/#!/miconda - http://www.linkedin.com/in/miconda Book: SIP Routing With Kamailio - http://www.asipto.com
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
-
Daniel-Constantin Mierla -
vamsi