23 Jan
2012
23 Jan
'12
12:13 p.m.
Hi,
i use the dialog module.
i create the dialog using dlg_manage() right after the invite is recieved.
in a case where the final destination rejects the call (486 busy), i get
the following error:
" WARNING: dialog [dlg_handlers.c:1054]: unable to find dialog for ACK with
route param....."
i guess the dialog module deletes the dialog on the 486 reply and gives me
this erro when an ACK for the 486 is recieved from the caller...
no a bug issue, but, is there a way to overcome it?
thanks,
Uri
23 Jan
23 Jan
9:24 p.m.
Hey,
Am 23.01.2012 um 11:13 schrieb Uri Shacked:
i use the dialog module.
i create the dialog using dlg_manage() right after the invite is recieved.
in a case where the final destination rejects the call (486 busy), i get the following
error:
" WARNING: dialog [dlg_handlers.c:1054]: unable to find dialog for ACK with route
param....."
i guess the dialog module deletes the dialog on the 486 reply and gives me this erro when
an ACK for the 486 is recieved from the caller...
No, the module shouldn't behave like that. IIRC, a terminating dialog is tied to its
underlying transaction and should stay alive until the transaction times out.
Does each ACK message include a proper dialog ID (i.e., To-tag, From-tag, and Call-ID
corresponding to the 486 message)? Is the ACK routed statefully at all?
Cheers,
--Timo
24 Jan
24 Jan
8:44 a.m.
Hi,
here is the trace of the end of the call. 486 is recieved from the
destination, kamailio sends ACK to it. then kamailio sends the 486 to the
origination and recieves an ACK for it. (the scenario is behind the
companies gateway....)
*No. Time Source Destination Protocol
Length Info
19 5.199372 172.16.10.2 172.16.60.161 SIP
533 Status: 486 Busy Here*
*Frame 19: 533 bytes on wire (4264 bits), 533 bytes captured (4264 bits)
Arrival Time: Jan 23, 2012 11:49:29.701743000 Jerusalem Standard Time
Epoch Time: 1327312169.701743000 seconds
[Time delta from previous captured frame: 1.208615000 seconds]
[Time delta from previous displayed frame: 1.208615000 seconds]
[Time since reference or first frame: 5.199372000 seconds]
Frame Number: 19
Frame Length: 533 bytes (4264 bits)
Capture Length: 533 bytes (4264 bits)
[Frame is marked: False]
[Frame is ignored: False]
[Protocols in frame: eth:ip:udp:sip]
[Coloring Rule Name: UDP]
[Coloring Rule String: udp]
Ethernet II, Src: Cisco_2e:84:80 (00:11:5c:2e:84:80), Dst: Silicom_05:b5:f5
(00:e0:ed:05:b5:f5)
Destination: Silicom_05:b5:f5 (00:e0:ed:05:b5:f5)
Address: Silicom_05:b5:f5 (00:e0:ed:05:b5:f5)
.... ...0 .... .... .... .... = IG bit: Individual address (unicast)
.... ..0. .... .... .... .... = LG bit: Globally unique address
(factory default)
Source: Cisco_2e:84:80 (00:11:5c:2e:84:80)
Address: Cisco_2e:84:80 (00:11:5c:2e:84:80)
.... ...0 .... .... .... .... = IG bit: Individual address (unicast)
.... ..0. .... .... .... .... = LG bit: Globally unique address
(factory default)
Type: IP (0x0800)
Internet Protocol Version 4, Src: 172.16.10.2 (172.16.10.2), Dst:
172.16.60.161 (172.16.60.161)
Version: 4
Header length: 20 bytes
Differentiated Services Field: 0x00 (DSCP 0x00: Default; ECN: 0x00:
Not-ECT (Not ECN-Capable Transport))
0000 00.. = Differentiated Services Codepoint: Default (0x00)
.... ..00 = Explicit Congestion Notification: Not-ECT (Not
ECN-Capable Transport) (0x00)
Total Length: 519
Identification: 0x3289 (12937)
Flags: 0x02 (Don't Fragment)
0... .... = Reserved bit: Not set
.1.. .... = Don't fragment: Set
..0. .... = More fragments: Not set
Fragment offset: 0
Time to live: 253
Protocol: UDP (17)
Header checksum: 0xaa98 [correct]
[Good: True]
[Bad: False]
Source: 172.16.10.2 (172.16.10.2)
Destination: 172.16.60.161 (172.16.60.161)
User Datagram Protocol, Src Port: sip (5060), Dst Port: sip (5060)
Source port: sip (5060)
Destination port: sip (5060)
Length: 499
Checksum: 0x2e26 [validation disabled]
[Good Checksum: False]
[Bad Checksum: False]
Session Initiation Protocol
Status-Line: SIP/2.0 486 Busy Here
Status-Code: 486
[Resent Packet: False]
Message Header
Call-ID: 6998600418003572708-1327312311-1053
From: <sip:506775651;ss7-cpc=10;cpc=ordinary@172.16.10.2
;user=phone>;tag=6998600418003572708
SIP from address: sip:506775651;ss7-cpc=10;cpc=
ordinary(a)172.16.10.2;user=phone
SIP from address User Part:
506775651;ss7-cpc=10;cpc=ordinary
SIP from address Host Part: 172.16.10.2
SIP tag: 6998600418003572708
To: <sip:39955011@172.16.60.161;user=phone>;tag=9304443427217266661
SIP to address: sip:39955011@172.16.60.161;user=phone
SIP to address User Part: 39955011
SIP to address Host Part: 172.16.60.161
SIP tag: 9304443427217266661
CSeq: 1 INVITE
Sequence Number: 1
Method: INVITE
Via: SIP/2.0/UDP
172.16.60.161;received=172.16.60.161;branch=z9hG4bKba0a.ac0fb354.2,SIP/2.0/UDP
172.16.10.2:5060;branch=z9hG4bK-612006000000d7e4-ac100a02-1
Transport: UDP
Sent-by Address: 172.16.60.161
Received: 172.16.60.161
Branch: z9hG4bKba0a.ac0fb354.2
Transport: UDP
Sent-by Address: 172.16.10.2
Sent-by port: 5060
Branch: z9hG4bK-612006000000d7e4-ac100a02-1
Supported: timer,100rel
Reason: Q.850;cause=17;text="UserBusy"
Reason Protocols: Q.850
Cause: 17(0x11)[User busy]
Content-Length: 0*
*No. Time Source Destination Protocol
Length Info
20 5.199640 172.16.60.161 172.16.10.2 SIP
416 Request: ACK sip:0504014041@172.16.10.2;user=phone*
*Frame 20: 416 bytes on wire (3328 bits), 416 bytes captured (3328 bits)
Arrival Time: Jan 23, 2012 11:49:29.702011000 Jerusalem Standard Time
Epoch Time: 1327312169.702011000 seconds
[Time delta from previous captured frame: 0.000268000 seconds]
[Time delta from previous displayed frame: 0.000268000 seconds]
[Time since reference or first frame: 5.199640000 seconds]
Frame Number: 20
Frame Length: 416 bytes (3328 bits)
Capture Length: 416 bytes (3328 bits)
[Frame is marked: False]
[Frame is ignored: False]
[Protocols in frame: eth:ip:udp:sip]
[Coloring Rule Name: UDP]
[Coloring Rule String: udp]
Ethernet II, Src: Silicom_05:b5:f5 (00:e0:ed:05:b5:f5), Dst: Cisco_2e:84:80
(00:11:5c:2e:84:80)
Destination: Cisco_2e:84:80 (00:11:5c:2e:84:80)
Address: Cisco_2e:84:80 (00:11:5c:2e:84:80)
.... ...0 .... .... .... .... = IG bit: Individual address (unicast)
.... ..0. .... .... .... .... = LG bit: Globally unique address
(factory default)
Source: Silicom_05:b5:f5 (00:e0:ed:05:b5:f5)
Address: Silicom_05:b5:f5 (00:e0:ed:05:b5:f5)
.... ...0 .... .... .... .... = IG bit: Individual address (unicast)
.... ..0. .... .... .... .... = LG bit: Globally unique address
(factory default)
Type: IP (0x0800)
Internet Protocol Version 4, Src: 172.16.60.161 (172.16.60.161), Dst:
172.16.10.2 (172.16.10.2)
Version: 4
Header length: 20 bytes
Differentiated Services Field: 0x10 (DSCP 0x04: Unknown DSCP; ECN:
0x00: Not-ECT (Not ECN-Capable Transport))
0001 00.. = Differentiated Services Codepoint: Unknown (0x04)
.... ..00 = Explicit Congestion Notification: Not-ECT (Not
ECN-Capable Transport) (0x00)
Total Length: 402
Identification: 0x0f78 (3960)
Flags: 0x00
0... .... = Reserved bit: Not set
.0.. .... = Don't fragment: Not set
..0. .... = More fragments: Not set
Fragment offset: 0
Time to live: 64
Protocol: UDP (17)
Header checksum: 0xcb0f [correct]
[Good: True]
[Bad: False]
Source: 172.16.60.161 (172.16.60.161)
Destination: 172.16.10.2 (172.16.10.2)
User Datagram Protocol, Src Port: sip (5060), Dst Port: sip (5060)
Source port: sip (5060)
Destination port: sip (5060)
Length: 382
Checksum: 0x5975 [validation disabled]
[Good Checksum: False]
[Bad Checksum: False]
Session Initiation Protocol
Request-Line: ACK sip:0504014041@172.16.10.2;user=phone SIP/2.0
Method: ACK
Request-URI: sip:0504014041@172.16.10.2;user=phone
Request-URI User Part: 0504014041
Request-URI Host Part: 172.16.10.2
[Resent Packet: False]
[Request Frame: 18]
[Response Time (ms): 1238]
Message Header
Call-ID: 6998600418003572708-1327312311-1053
From: <sip:506775651;ss7-cpc=10;cpc=ordinary@172.16.10.2
;user=phone>;tag=6998600418003572708
SIP from address: sip:506775651;ss7-cpc=10;cpc=
ordinary(a)172.16.10.2;user=phone
SIP from address User Part:
506775651;ss7-cpc=10;cpc=ordinary
SIP from address Host Part: 172.16.10.2
SIP tag: 6998600418003572708
To: <sip:39955011@172.16.60.161;user=phone>;tag=9304443427217266661
SIP to address: sip:39955011@172.16.60.161;user=phone
SIP to address User Part: 39955011
SIP to address Host Part: 172.16.60.161
SIP tag: 9304443427217266661
CSeq: 1 ACK
Sequence Number: 1
Method: ACK
Via: SIP/2.0/UDP 172.16.60.161;branch=z9hG4bKba0a.ac0fb354.2
Transport: UDP
Sent-by Address: 172.16.60.161
Branch: z9hG4bKba0a.ac0fb354.2
Max-Forwards: 69
Content-Length: 0*
*No. Time Source Destination Protocol
Length Info
21 5.199772 172.16.60.161 172.16.10.2 SIP
454 Status: 486 Busy Here*
*Frame 21: 454 bytes on wire (3632 bits), 454 bytes captured (3632 bits)
Arrival Time: Jan 23, 2012 11:49:29.702143000 Jerusalem Standard Time
Epoch Time: 1327312169.702143000 seconds
[Time delta from previous captured frame: 0.000132000 seconds]
[Time delta from previous displayed frame: 0.000132000 seconds]
[Time since reference or first frame: 5.199772000 seconds]
Frame Number: 21
Frame Length: 454 bytes (3632 bits)
Capture Length: 454 bytes (3632 bits)
[Frame is marked: False]
[Frame is ignored: False]
[Protocols in frame: eth:ip:udp:sip]
[Coloring Rule Name: UDP]
[Coloring Rule String: udp]
Ethernet II, Src: Silicom_05:b5:f5 (00:e0:ed:05:b5:f5), Dst: Cisco_2e:84:80
(00:11:5c:2e:84:80)
Destination: Cisco_2e:84:80 (00:11:5c:2e:84:80)
Address: Cisco_2e:84:80 (00:11:5c:2e:84:80)
.... ...0 .... .... .... .... = IG bit: Individual address (unicast)
.... ..0. .... .... .... .... = LG bit: Globally unique address
(factory default)
Source: Silicom_05:b5:f5 (00:e0:ed:05:b5:f5)
Address: Silicom_05:b5:f5 (00:e0:ed:05:b5:f5)
.... ...0 .... .... .... .... = IG bit: Individual address (unicast)
.... ..0. .... .... .... .... = LG bit: Globally unique address
(factory default)
Type: IP (0x0800)
Internet Protocol Version 4, Src: 172.16.60.161 (172.16.60.161), Dst:
172.16.10.2 (172.16.10.2)
Version: 4
Header length: 20 bytes
Differentiated Services Field: 0x10 (DSCP 0x04: Unknown DSCP; ECN:
0x00: Not-ECT (Not ECN-Capable Transport))
0001 00.. = Differentiated Services Codepoint: Unknown (0x04)
.... ..00 = Explicit Congestion Notification: Not-ECT (Not
ECN-Capable Transport) (0x00)
Total Length: 440
Identification: 0x0f79 (3961)
Flags: 0x00
0... .... = Reserved bit: Not set
.0.. .... = Don't fragment: Not set
..0. .... = More fragments: Not set
Fragment offset: 0
Time to live: 64
Protocol: UDP (17)
Header checksum: 0xcae8 [correct]
[Good: True]
[Bad: False]
Source: 172.16.60.161 (172.16.60.161)
Destination: 172.16.10.2 (172.16.10.2)
User Datagram Protocol, Src Port: sip (5060), Dst Port: sip (5060)
Source port: sip (5060)
Destination port: sip (5060)
Length: 420
Checksum: 0x91b9 [validation disabled]
[Good Checksum: False]
[Bad Checksum: False]
Session Initiation Protocol
Status-Line: SIP/2.0 486 Busy Here
Status-Code: 486
[Resent Packet: False]
Message Header
Call-ID: 6998600418003572708-1327312311-1053
From: <sip:506775651;ss7-cpc=10;cpc=ordinary@172.16.10.2
;user=phone>;tag=6998600418003572708
SIP from address: sip:506775651;ss7-cpc=10;cpc=
ordinary(a)172.16.10.2;user=phone
SIP from address User Part:
506775651;ss7-cpc=10;cpc=ordinary
SIP from address Host Part: 172.16.10.2
SIP tag: 6998600418003572708
To: <sip:39955011@172.16.60.161;user=phone>;tag=9304443427217266661
SIP to address: sip:39955011@172.16.60.161;user=phone
SIP to address User Part: 39955011
SIP to address Host Part: 172.16.60.161
SIP tag: 9304443427217266661
CSeq: 1 INVITE
Sequence Number: 1
Method: INVITE
Via: SIP/2.0/UDP 172.16.10.2:5060
;branch=z9hG4bK-612006000000d7e4-ac100a02-1
Transport: UDP
Sent-by Address: 172.16.10.2
Sent-by port: 5060
Branch: z9hG4bK-612006000000d7e4-ac100a02-1
Supported: timer,100rel
Reason: Q.850;cause=17;text="UserBusy"
Reason Protocols: Q.850
Cause: 17(0x11)[User busy]
Content-Length: 0*
*No. Time Source Destination Protocol
Length Info
22 5.210511 172.16.10.2 172.16.60.161 SIP
520 Request: ACK sip:172.16.10.2:5060*
*Frame 22: 520 bytes on wire (4160 bits), 520 bytes captured (4160 bits)
Arrival Time: Jan 23, 2012 11:49:29.712882000 Jerusalem Standard Time
Epoch Time: 1327312169.712882000 seconds
[Time delta from previous captured frame: 0.010739000 seconds]
[Time delta from previous displayed frame: 0.010739000 seconds]
[Time since reference or first frame: 5.210511000 seconds]
Frame Number: 22
Frame Length: 520 bytes (4160 bits)
Capture Length: 520 bytes (4160 bits)
[Frame is marked: False]
[Frame is ignored: False]
[Protocols in frame: eth:ip:udp:sip]
[Coloring Rule Name: UDP]
[Coloring Rule String: udp]
Ethernet II, Src: Cisco_2e:84:80 (00:11:5c:2e:84:80), Dst: Silicom_05:b5:f5
(00:e0:ed:05:b5:f5)
Destination: Silicom_05:b5:f5 (00:e0:ed:05:b5:f5)
Address: Silicom_05:b5:f5 (00:e0:ed:05:b5:f5)
.... ...0 .... .... .... .... = IG bit: Individual address (unicast)
.... ..0. .... .... .... .... = LG bit: Globally unique address
(factory default)
Source: Cisco_2e:84:80 (00:11:5c:2e:84:80)
Address: Cisco_2e:84:80 (00:11:5c:2e:84:80)
.... ...0 .... .... .... .... = IG bit: Individual address (unicast)
.... ..0. .... .... .... .... = LG bit: Globally unique address
(factory default)
Type: IP (0x0800)
Internet Protocol Version 4, Src: 172.16.10.2 (172.16.10.2), Dst:
172.16.60.161 (172.16.60.161)
Version: 4
Header length: 20 bytes
Differentiated Services Field: 0x00 (DSCP 0x00: Default; ECN: 0x00:
Not-ECT (Not ECN-Capable Transport))
0000 00.. = Differentiated Services Codepoint: Default (0x00)
.... ..00 = Explicit Congestion Notification: Not-ECT (Not
ECN-Capable Transport) (0x00)
Total Length: 506
Identification: 0x328a (12938)
Flags: 0x02 (Don't Fragment)
0... .... = Reserved bit: Not set
.1.. .... = Don't fragment: Set
..0. .... = More fragments: Not set
Fragment offset: 0
Time to live: 253
Protocol: UDP (17)
Header checksum: 0xaaa4 [correct]
[Good: True]
[Bad: False]
Source: 172.16.10.2 (172.16.10.2)
Destination: 172.16.60.161 (172.16.60.161)
User Datagram Protocol, Src Port: sip (5060), Dst Port: sip (5060)
Source port: sip (5060)
Destination port: sip (5060)
Length: 486
Checksum: 0xec7a [validation disabled]
[Good Checksum: False]
[Bad Checksum: False]
Session Initiation Protocol
Request-Line: ACK sip:172.16.10.2:5060 SIP/2.0
Method: ACK
Request-URI: sip:172.16.10.2:5060
Request-URI Host Part: 172.16.10.2
Request-URI Host Port: 5060
[Resent Packet: False]
[Request Frame: 19]
[Response Time (ms): 1249]
Message Header
Call-ID: 6998600418003572708-1327312311-1053
From: <sip:506775651;ss7-cpc=10;cpc=ordinary@172.16.10.2
;user=phone>;tag=6998600418003572708
SIP from address: sip:506775651;ss7-cpc=10;cpc=
ordinary(a)172.16.10.2;user=phone
SIP from address User Part:
506775651;ss7-cpc=10;cpc=ordinary
SIP from address Host Part: 172.16.10.2
SIP tag: 6998600418003572708
To: <sip:39955011@172.16.60.161;user=phone>;tag=9304443427217266661
SIP to address: sip:39955011@172.16.60.161;user=phone
SIP to address User Part: 39955011
SIP to address Host Part: 172.16.60.161
SIP tag: 9304443427217266661
CSeq: 1 ACK
Sequence Number: 1
Method: ACK
Via: SIP/2.0/UDP 172.16.10.2:5060
;branch=z9hG4bK-612006000000d7e4-ac100a02-1
Transport: UDP
Sent-by Address: 172.16.10.2
Sent-by port: 5060
Branch: z9hG4bK-612006000000d7e4-ac100a02-1
Route:
<sip:172.16.60.161;lr=on;ftag=6998600418003572708;did=47.c7f00ed6>
Max-Forwards: 70
User-Agent: VCS 5.8.2.51-04
Content-Length: 0
*
On Mon, Jan 23, 2012 at 9:24 PM, Timo Reimann <sr(a)foo-lounge.de> wrote:
Hey,
Am 23.01.2012 um 11:13 schrieb Uri Shacked:
i use the dialog module.
i create the dialog using dlg_manage() right after the invite is
recieved.
in a case where the final destination rejects the
call (486 busy), i get
the following error:
" WARNING: dialog [dlg_handlers.c:1054]:
unable to find dialog for ACK
with route param....."
i guess the dialog module deletes the dialog on
the 486 reply and gives
me this erro when an ACK for the 486 is recieved from the
caller...
No, the module shouldn't behave like that. IIRC, a terminating dialog is
tied to its underlying transaction and should stay alive until the
transaction times out.
Does each ACK message include a proper dialog ID (i.e., To-tag, From-tag,
and Call-ID corresponding to the 486 message)? Is the ACK routed statefully
at all?
Cheers,
--Timo
4686
days inactive
4687
days old
2 comments
2 participants
participants (2)
-
Timo Reimann -
Uri Shacked