[SR-Users] Dialog keep alive options are with error parsing headers

Wed Oct 7 18:23:09 CEST 2015

Hello Daniel,

Do you have any suggestion how to resolve this issue?

Best Regards
José Seabra

2015-09-25 9:37 GMT+01:00 José Seabra <joseseabra4 at gmail.com>:

> Hello Daniel,
>
> Once again thank you for your support.
>
> Please check below the kamailio logs with your patch:
>
> 34(22654) DEBUG: <core> [parser/msg_parser.c:606]: parse_msg(): SIP
> Request:
> 34(22654) DEBUG: <core> [parser/msg_parser.c:608]: parse_msg():  method:
>  <OPTIONS>
> 34(22654) DEBUG: <core> [parser/msg_parser.c:610]: parse_msg():  uri:
> <sip:unknown at XX.XX.XX.25:5060>
> 34(22654) DEBUG: <core> [parser/msg_parser.c:612]: parse_msg():  version:
> <SIP/2.0>
> 34(22654) DEBUG: <core> [parser/parse_via.c:1254]: parse_via_param():
> Found param type 232, <branch> =
> <z9hG4bKa135.f3b51855000000000000000000000000.0>; state=16
> 34(22654) DEBUG: <core> [parser/parse_via.c:2642]: parse_via(): end of
> header reached, state=5
> 34(22654) DEBUG: <core> [parser/msg_parser.c:496]: parse_headers():
> parse_headers: Via found, flags=2
> 34(22654) DEBUG: <core> [parser/msg_parser.c:498]: parse_headers():
> parse_headers: this is the first via
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:172]: parse_to_param():
> DEBUG: add_param: tag=ee01f902aad54d95a6ebe96869cb8c99
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:894]: parse_addr_spec():
> end of header reached, state=29
> 34(22654) DEBUG: <core> [parser/msg_parser.c:173]: get_hdr_field(): DEBUG:
> get_hdr_field: <To> [64]; uri=[sip:unknown at XX.XX.XX.6]
> 34(22654) DEBUG: <core> [parser/msg_parser.c:175]: get_hdr_field(): DEBUG:
> to body [<sip:unknown at XX.XX.XX.6>]
> 34(22654) DEBUG: <core> [parser/msg_parser.c:153]: get_hdr_field():
> get_hdr_field: cseq <CSeq>: <0> <OPTIONS>
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:172]: parse_to_param():
> DEBUG: add_param: tag=af3be7f0ca0e408fac220f5febc9e509
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:894]: parse_addr_spec():
> end of header reached, state=29
> 34(22654) DEBUG: dialog [dlg_cseq.c:215]: dlg_cseq_msg_sent(): traking
> cseq updates
> 34(22654) DEBUG: dialog [dlg_hash.c:671]: internal_get_dlg(): ref dlg
> 0x7fc69f8f0f28 with 1 -> 2
> 34(22654) DEBUG: dialog [dlg_hash.c:674]: internal_get_dlg(): dialog
> callid='3178f921d05c4a05a03b77ffecf17e96' found on entry 740, dir=2
> 34(22654) DEBUG: dialog [dlg_cseq.c:233]: dlg_cseq_msg_sent(): request not
> going downstream (2)
> 34(22654) DEBUG: dialog [dlg_hash.c:846]: dlg_unref(): unref dlg
> 0x7fc69f8f0f28 with 1 -> 1
> 34(22654) DEBUG: <core> [parser/msg_parser.c:606]: parse_msg(): SIP
> Request:
> 34(22654) DEBUG: <core> [parser/msg_parser.c:608]: parse_msg():  method:
>  <OPTIONS>
> 34(22654) DEBUG: <core> [parser/msg_parser.c:610]: parse_msg():  uri:
> <sip:10.92.30.20:5060>
> 34(22654) DEBUG: <core> [parser/msg_parser.c:612]: parse_msg():  version:
> <SIP/2.0>
> 34(22654) DEBUG: <core> [parser/parse_via.c:1254]: parse_via_param():
> Found param type 232, <branch> =
> <z9hG4bK475c.719b3903000000000000000000000000.0>; state=16
> 34(22654) DEBUG: <core> [parser/parse_via.c:2642]: parse_via(): end of
> header reached, state=5
> 34(22654) DEBUG: <core> [parser/msg_parser.c:496]: parse_headers():
> parse_headers: Via found, flags=2
> 34(22654) DEBUG: <core> [parser/msg_parser.c:498]: parse_headers():
> parse_headers: this is the first via
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:172]: parse_to_param():
> DEBUG: add_param: tag=af3be7f0ca0e408fac220f5febc9e509
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:894]: parse_addr_spec():
> end of header reached, state=29
> 34(22654) DEBUG: <core> [parser/msg_parser.c:173]: get_hdr_field(): DEBUG:
> get_hdr_field: <To> [70]; uri=[sip:0035912832114 at XX.XX.XX.6]
> 34(22654) DEBUG: <core> [parser/msg_parser.c:175]: get_hdr_field(): DEBUG:
> to body [<sip:0035912832114 at XX.XX.XX.6>]
> 34(22654) DEBUG: <core> [parser/msg_parser.c:153]: get_hdr_field():
> get_hdr_field: cseq <CSeq>: <28937> <OPTIONS>
> 34(22654) DEBUG: <core> [parser/msg_parser.c:187]: get_hdr_field(): DEBUG:
> get_hdr_body : content_length=0
> 34(22654) DEBUG: <core> [parser/msg_parser.c:89]: get_hdr_field(): found
> end of header
> 34(22654) DEBUG: topoh [topoh_mod.c:241]: th_prepare_msg(): no second via
> in this message
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:172]: parse_to_param():
> DEBUG: add_param: tag=ee01f902aad54d95a6ebe96869cb8c99
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:894]: parse_addr_spec():
> end of header reached, state=29
> 34(22654) DEBUG: topoh [topoh_mod.c:398]: th_msg_sent(): the COOKIE is
> [xxx]
> 34(22654) DEBUG: <core> [parser/msg_parser.c:606]: parse_msg(): SIP
> Request:
> 34(22654) DEBUG: <core> [parser/msg_parser.c:608]: parse_msg():  method:
>  <OPTIONS>
> 34(22654) DEBUG: <core> [parser/msg_parser.c:610]: parse_msg():  uri:
> <sip:10.92.30.20:5060>
> 34(22654) DEBUG: <core> [parser/msg_parser.c:612]: parse_msg():  version:
> <SIP/2.0>
> 34(22654) DEBUG: <core> [parser/parse_via.c:1254]: parse_via_param():
> Found param type 232, <branch> =
> <z9hG4bK475c.719b3903000000000000000000000000.0>; state=16
> 34(22654) DEBUG: <core> [parser/parse_via.c:2642]: parse_via(): end of
> header reached, state=5
> 34(22654) DEBUG: <core> [parser/msg_parser.c:496]: parse_headers():
> parse_headers: Via found, flags=2
> 34(22654) DEBUG: <core> [parser/msg_parser.c:498]: parse_headers():
> parse_headers: this is the first via
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:172]: parse_to_param():
> DEBUG: add_param: tag=af3be7f0ca0e408fac220f5febc9e509
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:894]: parse_addr_spec():
> end of header reached, state=29
> 34(22654) DEBUG: <core> [parser/msg_parser.c:173]: get_hdr_field(): DEBUG:
> get_hdr_field: <To> [70]; uri=[sip:0035912832114 at XX.XX.XX.6]
> 34(22654) DEBUG: <core> [parser/msg_parser.c:175]: get_hdr_field(): DEBUG:
> to body [<sip:0035912832114 at XX.XX.XX.6>]
> 34(22654) DEBUG: <core> [parser/msg_parser.c:153]: get_hdr_field():
> get_hdr_field: cseq <CSeq>: <28937> <OPTIONS>
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:172]: parse_to_param():
> DEBUG: add_param: tag=ee01f902aad54d95a6ebe96869cb8c99
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:894]: parse_addr_spec():
> end of header reached, state=29
> 34(22654) DEBUG: dialog [dlg_cseq.c:215]: dlg_cseq_msg_sent(): traking
> cseq updates
> 34(22654) DEBUG: dialog [dlg_hash.c:671]: internal_get_dlg(): ref dlg
> 0x7fc69f8f0f28 with 1 -> 2
> 34(22654) DEBUG: dialog [dlg_hash.c:674]: internal_get_dlg(): dialog
> callid='3178f921d05c4a05a03b77ffecf17e96' found on entry 740, dir=1
> 34(22654) DEBUG: dialog [dlg_cseq.c:241]: dlg_cseq_msg_sent(): no
> transaction for request
> 34(22654) DEBUG: dialog [dlg_hash.c:846]: dlg_unref(): unref dlg
> 0x7fc69f8f0f28 with 1 -> 1
> 34(22654) DEBUG: <core> [parser/msg_parser.c:606]: parse_msg(): SIP
> Request:
> 34(22654) DEBUG: <core> [parser/msg_parser.c:608]: parse_msg():  method:
>  <BYE>
> 34(22654) DEBUG: <core> [parser/msg_parser.c:610]: parse_msg():  uri:
> <sip:unknown at XX.XX.XX.25:5060>
> 34(22654) DEBUG: <core> [parser/msg_parser.c:612]: parse_msg():  version:
> <SIP/2.0>
> 34(22654) DEBUG: <core> [parser/parse_via.c:1254]: parse_via_param():
> Found param type 232, <branch> =
> <z9hG4bKb135.7d842b44000000000000000000000000.0>; state=16
> 34(22654) DEBUG: <core> [parser/parse_via.c:2642]: parse_via(): end of
> header reached, state=5
> 34(22654) DEBUG: <core> [parser/msg_parser.c:496]: parse_headers():
> parse_headers: Via found, flags=2
> 34(22654) DEBUG: <core> [parser/msg_parser.c:498]: parse_headers():
> parse_headers: this is the first via
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:172]: parse_to_param():
> DEBUG: add_param: tag=ee01f902aad54d95a6ebe96869cb8c99
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:894]: parse_addr_spec():
> end of header reached, state=29
> 34(22654) DEBUG: <core> [parser/msg_parser.c:173]: get_hdr_field(): DEBUG:
> get_hdr_field: <To> [64]; uri=[sip:unknown at XX.XX.XX.6]
> 34(22654) DEBUG: <core> [parser/msg_parser.c:175]: get_hdr_field(): DEBUG:
> to body [<sip:unknown at XX.XX.XX.6>]
> 34(22654) DEBUG: <core> [parser/msg_parser.c:153]: get_hdr_field():
> get_hdr_field: cseq <CSeq>: <1> <BYE>
> 34(22654) DEBUG: <core> [parser/msg_parser.c:187]: get_hdr_field(): DEBUG:
> get_hdr_body : content_length=0
> 34(22654) DEBUG: <core> [parser/msg_parser.c:89]: get_hdr_field(): found
> end of header
> 34(22654) DEBUG: topoh [topoh_mod.c:241]: th_prepare_msg(): no second via
> in this message
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:172]: parse_to_param():
> DEBUG: add_param: tag=af3be7f0ca0e408fac220f5febc9e509
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:894]: parse_addr_spec():
> end of header reached, state=29
> 34(22654) DEBUG: topoh [topoh_mod.c:398]: th_msg_sent(): the COOKIE is
> [xxx]
> 34(22654) DEBUG: <core> [parser/msg_parser.c:606]: parse_msg(): SIP
> Request:
> 34(22654) DEBUG: <core> [parser/msg_parser.c:608]: parse_msg():  method:
>  <BYE>
> 34(22654) DEBUG: <core> [parser/msg_parser.c:610]: parse_msg():  uri:
> <sip:unknown at XX.XX.XX.25:5060>
> 34(22654) DEBUG: <core> [parser/msg_parser.c:612]: parse_msg():  version:
> <SIP/2.0>
> 34(22654) DEBUG: <core> [parser/parse_via.c:1254]: parse_via_param():
> Found param type 232, <branch> =
> <z9hG4bKb135.7d842b44000000000000000000000000.0>; state=16
> 34(22654) DEBUG: <core> [parser/parse_via.c:2642]: parse_via(): end of
> header reached, state=5
> 34(22654) DEBUG: <core> [parser/msg_parser.c:496]: parse_headers():
> parse_headers: Via found, flags=2
> 34(22654) DEBUG: <core> [parser/msg_parser.c:498]: parse_headers():
> parse_headers: this is the first via
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:172]: parse_to_param():
> DEBUG: add_param: tag=ee01f902aad54d95a6ebe96869cb8c99
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:894]: parse_addr_spec():
> end of header reached, state=29
> 34(22654) DEBUG: <core> [parser/msg_parser.c:173]: get_hdr_field(): DEBUG:
> get_hdr_field: <To> [64]; uri=[sip:unknown at XX.XX.XX.6]
> 34(22654) DEBUG: <core> [parser/msg_parser.c:175]: get_hdr_field(): DEBUG:
> to body [<sip:unknown at XX.XX.XX.6>]
> 34(22654) DEBUG: <core> [parser/msg_parser.c:153]: get_hdr_field():
> get_hdr_field: cseq <CSeq>: <1> <BYE>
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:172]: parse_to_param():
> DEBUG: add_param: tag=af3be7f0ca0e408fac220f5febc9e509
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:894]: parse_addr_spec():
> end of header reached, state=29
> 34(22654) DEBUG: dialog [dlg_cseq.c:215]: dlg_cseq_msg_sent(): traking
> cseq updates
> 34(22654) DEBUG: dialog [dlg_hash.c:671]: internal_get_dlg(): ref dlg
> 0x7fc69f8f0f28 with 1 -> 2
> 34(22654) DEBUG: dialog [dlg_hash.c:674]: internal_get_dlg(): dialog
> callid='3178f921d05c4a05a03b77ffecf17e96' found on entry 740, dir=2
> 34(22654) DEBUG: dialog [dlg_cseq.c:233]: dlg_cseq_msg_sent(): request not
> going downstream (2)
> 34(22654) DEBUG: dialog [dlg_hash.c:846]: dlg_unref(): unref dlg
> 0x7fc69f8f0f28 with 1 -> 1
> 34(22654) DEBUG: <core> [parser/msg_parser.c:606]: parse_msg(): SIP
> Request:
> 34(22654) DEBUG: <core> [parser/msg_parser.c:608]: parse_msg():  method:
>  <BYE>
> 34(22654) DEBUG: <core> [parser/msg_parser.c:610]: parse_msg():  uri:
> <sip:10.92.30.20:5060>
> 34(22654) DEBUG: <core> [parser/msg_parser.c:612]: parse_msg():  version:
> <SIP/2.0>
> 34(22654) DEBUG: <core> [parser/parse_via.c:1254]: parse_via_param():
> Found param type 232, <branch> =
> <z9hG4bK185c.846af8c0000000000000000000000000.0>; state=16
> 34(22654) DEBUG: <core> [parser/parse_via.c:2642]: parse_via(): end of
> header reached, state=5
> 34(22654) DEBUG: <core> [parser/msg_parser.c:496]: parse_headers():
> parse_headers: Via found, flags=2
> 34(22654) DEBUG: <core> [parser/msg_parser.c:498]: parse_headers():
> parse_headers: this is the first via
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:172]: parse_to_param():
> DEBUG: add_param: tag=af3be7f0ca0e408fac220f5febc9e509
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:894]: parse_addr_spec():
> end of header reached, state=29
> 34(22654) DEBUG: <core> [parser/msg_parser.c:173]: get_hdr_field(): DEBUG:
> get_hdr_field: <To> [70]; uri=[sip:0035912832114 at XX.XX.XX.6]
> 34(22654) DEBUG: <core> [parser/msg_parser.c:175]: get_hdr_field(): DEBUG:
> to body [<sip:0035912832114 at XX.XX.XX.6>]
> 34(22654) DEBUG: <core> [parser/msg_parser.c:153]: get_hdr_field():
> get_hdr_field: cseq <CSeq>: <28939> <BYE>
> 34(22654) DEBUG: <core> [parser/msg_parser.c:187]: get_hdr_field(): DEBUG:
> get_hdr_body : content_length=0
> 34(22654) DEBUG: <core> [parser/msg_parser.c:89]: get_hdr_field(): found
> end of header
> 34(22654) DEBUG: topoh [topoh_mod.c:241]: th_prepare_msg(): no second via
> in this message
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:172]: parse_to_param():
> DEBUG: add_param: tag=ee01f902aad54d95a6ebe96869cb8c99
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:894]: parse_addr_spec():
> end of header reached, state=29
> 34(22654) DEBUG: topoh [topoh_mod.c:398]: th_msg_sent(): the COOKIE is
> [dlh]
> 34(22654) DEBUG: <core> [parser/msg_parser.c:606]: parse_msg(): SIP
> Request:
> 34(22654) DEBUG: <core> [parser/msg_parser.c:608]: parse_msg():  method:
>  <BYE>
> 34(22654) DEBUG: <core> [parser/msg_parser.c:610]: parse_msg():  uri:
> <sip:10.92.30.20:5060>
> 34(22654) DEBUG: <core> [parser/msg_parser.c:612]: parse_msg():  version:
> <SIP/2.0>
> 34(22654) DEBUG: <core> [parser/parse_via.c:1254]: parse_via_param():
> Found param type 232, <branch> =
> <z9hG4bK185c.846af8c0000000000000000000000000.0>; state=16
> 34(22654) DEBUG: <core> [parser/parse_via.c:2642]: parse_via(): end of
> header reached, state=5
> 34(22654) DEBUG: <core> [parser/msg_parser.c:496]: parse_headers():
> parse_headers: Via found, flags=2
> 34(22654) DEBUG: <core> [parser/msg_parser.c:498]: parse_headers():
> parse_headers: this is the first via
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:172]: parse_to_param():
> DEBUG: add_param: tag=af3be7f0ca0e408fac220f5febc9e509
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:894]: parse_addr_spec():
> end of header reached, state=29
> 34(22654) DEBUG: <core> [parser/msg_parser.c:173]: get_hdr_field(): DEBUG:
> get_hdr_field: <To> [70]; uri=[sip:0035912832114 at XX.XX.XX.6]
> 34(22654) DEBUG: <core> [parser/msg_parser.c:175]: get_hdr_field(): DEBUG:
> to body [<sip:0035912832114 at XX.XX.XX.6>]
> 34(22654) DEBUG: <core> [parser/msg_parser.c:153]: get_hdr_field():
> get_hdr_field: cseq <CSeq>: <28939> <BYE>
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:172]: parse_to_param():
> DEBUG: add_param: tag=ee01f902aad54d95a6ebe96869cb8c99
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:894]: parse_addr_spec():
> end of header reached, state=29
> 34(22654) DEBUG: dialog [dlg_cseq.c:215]: dlg_cseq_msg_sent(): traking
> cseq updates
> 34(22654) DEBUG: dialog [dlg_hash.c:680]: internal_get_dlg(): no dialog
> callid='!!:NIxmJglQN-vTNDR-Hgx5HPx5N42mH4spsPHpNAreJAl*' found
> 34(22654) DEBUG: dialog [dlg_hash.c:711]: get_dlg(): no dialog
> callid='!!:NIxmJglQN-vTNDR-Hgx5HPx5N42mH4spsPHpNAreJAl*' found
> 34(22654) DEBUG: dialog [dlg_handlers.c:1085]: dlg_lookup_msg_dialog():
> dlg with callid '!!:NIxmJglQN-vTNDR-Hgx5HPx5N42mH4spsPHpNAreJAl*' not found
> 34(22654) DEBUG: dialog [dlg_cseq.c:227]: dlg_cseq_msg_sent(): no dialog
> for this request
> 34(22654) DEBUG: <core> [parser/msg_parser.c:606]: parse_msg(): SIP
> Request:
> 34(22654) DEBUG: <core> [parser/msg_parser.c:608]: parse_msg():  method:
>  <OPTIONS>
> 34(22654) DEBUG: <core> [parser/msg_parser.c:610]: parse_msg():  uri:
> <sip:unknown at XX.XX.XX.25:5060>
> 34(22654) DEBUG: <core> [parser/msg_parser.c:612]: parse_msg():  version:
> <SIP/2.0>
> 34(22654) DEBUG: <core> [parser/parse_via.c:1254]: parse_via_param():
> Found param type 232, <branch> =
> <z9hG4bKa135.f3b51855000000000000000000000000.0>; state=16
> 34(22654) DEBUG: <core> [parser/parse_via.c:2642]: parse_via(): end of
> header reached, state=5
> 34(22654) DEBUG: <core> [parser/msg_parser.c:496]: parse_headers():
> parse_headers: Via found, flags=2
> 34(22654) DEBUG: <core> [parser/msg_parser.c:498]: parse_headers():
> parse_headers: this is the first via
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:172]: parse_to_param():
> DEBUG: add_param: tag=ee01f902aad54d95a6ebe96869cb8c99
> 34(22654) DEBUG: <core> [parser/parse_addr_spec.c:894]: parse_addr_spec():
> end of header reached, state=29
> 34(22654) DEBUG: <core> [parser/msg_parser.c:173]: get_hdr_field(): DEBUG:
> get_hdr_field: <To> [64]; uri=[sip:unknown at XX.XX.XX.6]
> 34(22654) DEBUG: <core> [parser/msg_parser.c:175]: get_hdr_field(): DEBUG:
> to body [<sip:unknown at XX.XX.XX.6>]
> 34(22654) DEBUG: <core> [parser/msg_parser.c:153]: get_hdr_field():
> get_hdr_field: cseq <CSeq>: <0> <OPTIONS>
> 34(22654) DEBUG: <core> [parser/msg_parser.c:187]: get_hdr_field(): DEBUG:
> get_hdr_body : content_length=0
> 34(22654) ERROR: <core> [parser/msg_parser.c:96]: get_hdr_field(): ERROR:
> get_hdr_field: bad header
> 34(22654) DEBUG: <core> [parser/msg_parser.c:280]: get_hdr_field():
> get_hdr_field: error exit
> 34(22654) INFO: <core> [parser/msg_parser.c:338]: parse_headers(): ERROR:
> bad header field [Voicis
>
> ]
> 34(22654) DEBUG: topoh [topoh_mod.c:233]: th_prepare_msg(): parsing
> headers failed [[OPTIONS sip:unknown at XX.XX.XX.25:5060 SIP/2.0
> Via: SIP/2.0/UDP
> XX.XX.XX.6;branch=z9hG4bKa135.f3b51855000000000000000000000000.0
> To: <sip:unknown at XX.XX.XX.6>;tag=ee01f902aad54d95a6ebe96869cb8c99
> From: <sip:0035912832114 at XX.XX.XX.6>;tag=af3be7f0ca0e408fac220f5febc9e509
> CSeq: 0 OPTIONS
> Call-ID: 3178f921d05c4a05a03b77ffecf17e96
> Max-Forwards: 70
> Content-Length: 0
> Voicis
>
> ]]
>
> Best Regads
> José Seabra
>
> 2015-09-24 20:49 GMT+01:00 Daniel-Constantin Mierla <miconda at gmail.com>:
>
>> Hello,
>>
>> the patch from next commit:
>>
>>
>> https://github.com/kamailio/kamailio/commit/551a562eb799c903cda09599ff5d47366abf42c9
>>
>> and compile in your version to see the full message content.
>>
>> Cheers,
>> Daniel
>>
>>
>> On 24/09/15 20:47, José Seabra wrote:
>>
>> Adding more information to my issue, these errors only happens when I'm
>> using topoh module, seems that dialog keep alive options is not working
>> with topoh module, maybe its something related with topoh callid
>> encription.
>>
>> Best regards
>> José Seabra
>>
>>
>>
>> 2015-09-24 15:24 GMT+01:00 José Seabra <joseseabra4 at gmail.com>:
>>
>>> Hello there,
>>>
>>> I'm using dialog module to send keep alive options to callee and caller
>>> in order to detect if dialog still up, but when kamailio generates the
>>> OPTION and parse it,  gives the following errors:
>>>
>>> [root at c4-compute02-srv1 kamailio]# 37(1587) DEBUG: dialog
>>> [dlg_hash.c:614]: dlg_lookup(): ref dlg 0x7f89134c1d40 with 1 -> 3
>>> 37(1587) DEBUG: dialog [dlg_hash.c:616]: dlg_lookup(): dialog id=2210
>>> found on entry 2350
>>> 37(1587) DEBUG: dialog [dlg_req_within.c:427]: dlg_send_ka(): sending
>>> OPTIONS to caller
>>> 37(1587) DEBUG: tm [uac.c:249]: t_uac_prepare(): DEBUG:tm:t_uac:
>>> next_hop=<sip:unknown at 62.28.197.25:5060>
>>> 37(1587) DEBUG: <core> [dns_cache.c:3293]: dns_srv_sip_resolve():
>>> (62.28.197.25, 0, 0), ip, ret=0
>>> 37(1587) DEBUG: tm [uac.c:150]: dlg2hash(): DEBUG: dlg2hash: 14692
>>> 37(1587) DEBUG: <core> [parser/msg_parser.c:606]: parse_msg(): SIP
>>> Request:
>>> 37(1587) DEBUG: <core> [parser/msg_parser.c:608]: parse_msg():  method:
>>>  <OPTIONS>
>>> 37(1587) DEBUG: <core> [parser/msg_parser.c:610]: parse_msg():  uri:
>>> < <http://sip:unknown@62.28.197.25:5060>sip:unknown at 62.28.197.25:5060>
>>> 37(1587) DEBUG: <core> [parser/msg_parser.c:612]: parse_msg():  version:
>>> <SIP/2.0>
>>> 37(1587) DEBUG: <core> [parser/parse_via.c:1254]: parse_via_param():
>>> Found param type 232, <branch> =
>>> <z9hG4bK4693.2af96e95000000000000000000000000.0>; state=16
>>> 37(1587) DEBUG: <core> [parser/parse_via.c:2642]: parse_via(): end of
>>> header reached, state=5
>>> 37(1587) DEBUG: <core> [parser/msg_parser.c:496]: parse_headers():
>>> parse_headers: Via found, flags=2
>>> 37(1587) DEBUG: <core> [parser/msg_parser.c:498]: parse_headers():
>>> parse_headers: this is the first via
>>> 37(1587) DEBUG: <core> [parser/parse_addr_spec.c:172]: parse_to_param():
>>> DEBUG: add_param: tag=90d40279ee5745d8851aa989e6fadfc2
>>> 37(1587) DEBUG: <core> [parser/parse_addr_spec.c:894]:
>>> parse_addr_spec(): end of header reached, state=29
>>> 37(1587) DEBUG: <core> [parser/msg_parser.c:173]: get_hdr_field():
>>> DEBUG: get_hdr_field: <To> [64]; uri=[ <sip%3Aunknown at 62.28.197.6>
>>> sip:unknown at 62.28.197.6]
>>> 37(1587) DEBUG: <core> [parser/msg_parser.c:175]: get_hdr_field():
>>> DEBUG: to body [<sip:unknown at 62.28.197.6>]
>>> 37(1587) DEBUG: <core> [parser/msg_parser.c:153]: get_hdr_field():
>>> get_hdr_field: cseq <CSeq>: <0> <OPTIONS>
>>> 37(1587) DEBUG: <core> [parser/msg_parser.c:187]: get_hdr_field():
>>> DEBUG: get_hdr_body : content_length=0
>>> *37(1587) ERROR: <core> [parser/msg_parser.c:96]: get_hdr_field():
>>> ERROR: get_hdr_field: bad header*
>>> 37(1587) DEBUG: <core> [parser/msg_parser.c:280]: get_hdr_field():
>>> get_hdr_field: error exit
>>> *37(1587) INFO: <core> [parser/msg_parser.c:338]: parse_headers():
>>> ERROR: bad header field [VC*
>>>
>>> *]*
>>> 37(1587) DEBUG: topoh [topoh_mod.c:232]: th_prepare_msg(): parsing
>>> headers failed37(1587) DEBUG: <core> [parser/msg_parser.c:606]:
>>> parse_msg(): SIP Request:
>>> 37(1587) DEBUG: <core> [parser/msg_parser.c:608]: parse_msg():  method:
>>>  <OPTIONS>
>>> 37(1587) DEBUG: <core> [parser/msg_parser.c:610]: parse_msg():  uri:
>>> < <http://sip:unknown@62.28.197.25:5060>sip:unknown at 62.28.197.25:5060>
>>> 37(1587) DEBUG: <core> [parser/msg_parser.c:612]: parse_msg():  version:
>>> <SIP/2.0>
>>> 37(1587) DEBUG: <core> [parser/parse_via.c:1254]: parse_via_param():
>>> Found param type 232, <branch> =
>>> <z9hG4bK4693.2af96e95000000000000000000000000.0>; state=16
>>> 37(1587) DEBUG: <core> [parser/parse_via.c:2642]: parse_via(): end of
>>> header reached, state=5
>>> 37(1587) DEBUG: <core> [parser/msg_parser.c:496]: parse_headers():
>>> parse_headers: Via found, flags=2
>>> 37(1587) DEBUG: <core> [parser/msg_parser.c:498]: parse_headers():
>>> parse_headers: this is the first via
>>> 37(1587) DEBUG: <core> [parser/parse_addr_spec.c:172]: parse_to_param():
>>> DEBUG: add_param: tag=90d40279ee5745d8851aa989e6fadfc2
>>> 37(1587) DEBUG: <core> [parser/parse_addr_spec.c:894]:
>>> parse_addr_spec(): end of header reached, state=29
>>> 37(1587) DEBUG: <core> [parser/msg_parser.c:173]: get_hdr_field():
>>> DEBUG: get_hdr_field: <To> [64]; uri=[ <sip%3Aunknown at 62.28.197.6>
>>> sip:unknown at 62.28.197.6]
>>> 37(1587) DEBUG: <core> [parser/msg_parser.c:175]: get_hdr_field():
>>> DEBUG: to body [<sip:unknown at 62.28.197.6>]
>>> 37(1587) DEBUG: <core> [parser/msg_parser.c:153]: get_hdr_field():
>>> get_hdr_field: cseq <CSeq>: <0> <OPTIONS>
>>> 37(1587) DEBUG: <core> [parser/parse_addr_spec.c:172]: parse_to_param():
>>> DEBUG: add_param: tag=e34d43e164ad4b7392dc9c6e1058a983
>>> 37(1587) DEBUG: <core> [parser/parse_addr_spec.c:894]:
>>> parse_addr_spec(): end of header reached, state=29
>>> 37(1587) DEBUG: dialog [dlg_cseq.c:215]: dlg_cseq_msg_sent(): traking
>>> cseq updates
>>> 37(1587) DEBUG: dialog [dlg_hash.c:671]: internal_get_dlg(): ref dlg
>>> 0x7f89134c1d40 with 1 -> 4
>>> 37(1587) DEBUG: dialog [dlg_hash.c:674]: internal_get_dlg(): dialog
>>> callid='13208317017c42128fbf00e1685ee1b3' found on entry 2350, dir=2
>>> 37(1587) DEBUG: dialog [dlg_cseq.c:233]: dlg_cseq_msg_sent(): request
>>> not going downstream (2)
>>> 37(1587) DEBUG: dialog [dlg_hash.c:846]: dlg_unref(): unref dlg
>>> 0x7f89134c1d40 with 1 -> 3
>>> 37(1587) DEBUG: dialog [dlg_req_within.c:452]: dlg_send_ka(): keep-alive
>>> sent to caller
>>> 37(1587) DEBUG: dialog [dlg_req_within.c:427]: dlg_send_ka(): sending
>>> OPTIONS to callee
>>>
>>> I'm using the following dialog configuration:
>>>
>>> modparam("dialog","db_url", DBURL)
>>> modparam("dialog","db_mode", 0)
>>> modparam("dialog","enable_stats", 1)
>>> modparam("dialog","dlg_flag", DLG_FLAG)
>>> modparam("dialog","profiles_with_value","concurrentcalls")
>>> modparam("dialog", "detect_spirals", 1)
>>> modparam("dialog","dlg_match_mode", 2)
>>> modparam("dialog", "initial_cbs_inscript", 0)
>>> modparam("dialog", "default_timeout", 3600)
>>> modparam("dialog", "send_bye", 1)
>>> modparam("dialog", "timeout_avp", "$avp(s:timeout_dlg)")
>>> modparam("dialog", "track_cseq_updates", 1)
>>> modparam("dialog", "ka_timer", 10)
>>> modparam("dialog", "ka_interval", 30)
>>>
>>>
>>> I'm  also using topoh module.
>>>
>>> Anyone can help me to identify if I'm doing the proper configuration?
>>>
>>> Thank you for your support
>>>
>>> Best Regards
>>>
>>> José Seabra
>>>
>>
>>
>>
>> --
>> Cumprimentos
>> José Seabra
>>
>>
>> _______________________________________________
>> SIP Express Router (SER) and Kamailio (OpenSER) - sr-users mailing listsr-users at lists.sip-router.orghttp://lists.sip-router.org/cgi-bin/mailman/listinfo/sr-users
>>
>>
>> --
>> Daniel-Constantin Mierlahttp://twitter.com/#!/miconda - http://www.linkedin.com/in/miconda
>> Book: SIP Routing With Kamailio - http://www.asipto.com
>> Kamailio Advanced Training, Sep 28-30, 2015, in Berlin - http://asipto.com/u/kat
>>
>>
>> _______________________________________________
>> SIP Express Router (SER) and Kamailio (OpenSER) - sr-users mailing list
>> sr-users at lists.sip-router.org
>> http://lists.sip-router.org/cgi-bin/mailman/listinfo/sr-users
>>
>>
>
>
> --
> Cumprimentos
> José Seabra
>

-- 
Cumprimentos
José Seabra
-------------- next part --------------
An HTML attachment was scrubbed...
URL: <http://lists.sip-router.org/pipermail/sr-users/attachments/20151007/feae53b8/attachment.html>