Jump to content
Vodia PBX forum
Kurt Harnish

Call Pickup Error

Recommended Posts

Using 2011-4.2.1.4025 (Win64)

This is the log when we try to use Call Pickup

 

SIP/2.0 100 Trying

Via: SIP/2.0/UDP 192.168.1.83:2048;branch=z9hG4bK-s7vmz7xww33l;rport=43175;received=someipaddress

From: "889" <sip:889@someipaddress>;tag=1129uy0e3n

To: <sip:*87@someipaddress;user=phone>;tag=ea5a27f58a

Call-ID: 3c2672a2cbc1-zaevthd57h5d

CSeq: 2 INVITE

Content-Length: 0

 

[4] 2011/07/26 10:12:48: Ignoring directed pickup request for call leg because the difference of -882384765 is too short

[7] 2011/07/26 10:12:48: Undirected call pickup failed

[7] 2011/07/26 10:12:48: set_codecs: for 3c2672a2cbc1-zaevthd57h5d codecs "", codec_preference count 7

[7] 2011/07/26 10:12:48: Set packet length to 20

[0] 2011/07/26 10:12:48: SIP Tx udp:24.229.49.16:43175:

SIP/2.0 404 Not Found

Via: SIP/2.0/UDP 192.168.1.83:2048;branch=z9hG4bK-s7vmz7xww33l;rport=43175;received=24.229.49.16

From: "889" <sip:889@someipaddress>;tag=1129uy0e3n

To: <sip:*87@someipaddress;user=phone>;tag=ea5a27f58a

Call-ID: 3c2672a2cbc1-zaevthd57h5d

CSeq: 2 INVITE

Contact: <sip:889@10.1.255.1:5060>

Supported: 100rel, replaces, norefersub

Allow-Events: refer

Allow: INVITE, ACK, CANCEL, BYE, REFER, PRACK, INFO, UPDATE

Accept: application/sdp

User-Agent: pbxnsip-PBX/2011-4.2.1.4025

Content-Length: 0

Share this post


Link to post
Share on other sites

Not able to reproduce it here. Are you picking this up "too soon"?

 

At this moment I am not sure if this has to do with "Mailbox Direct Dial Prefix" and extension number both starting with 8. BTW, I am assuming here that you have not changed the mailbox prefix. Let's know otherwise.

Share this post


Link to post
Share on other sites

Hello everyone,

 

I have been encountering this error too on a multi-domain snomblue.

[4] 2011/08/25 16:37:26: Ignoring directed pickup request for call leg because the difference of -1266815360 is too short

 

This is the installation in general:

- Snom telephones are registered on the SnomBlue (which is not installed on the same network)

- There are three domains at the moment

- Telephones are configured manually, and not provisionned

- The phones have 3 digit extensions that begin with a 2 or a 3

- The call pickup failed with the same error when using *02 and *82 as a Call Pickup star code

- The SnomBlue is on the 3981 version, linux distribution

- Note that another client on the same SnomBlue is not having problems with Call Pickup (and using the default *87 starcode)

 

Kurt,

 

were you able to solve the issue? could you please provide feedback if so?

 

Thank you

Share this post


Link to post
Share on other sites

In this domain, if you set the code back to *87, does it work?

 

Also, if this happens all the time or when there is more than 1 call on that extension, or any other clues?

Share this post


Link to post
Share on other sites

In this domain, if you set the code back to *87, does it work?

 

Also, if this happens all the time or when there is more than 1 call on that extension, or any other clues?

 

Hello,

 

Thanks for your reply.

In fact i haven't had time to test with the client when using the default star code, i will test it and get back with the results as soon as possible.

 

During the tests, we tried to intercept when there was only one call on the extension

 

Regards

Share this post


Link to post
Share on other sites

Hi again,

 

The *87 was tested today, but i have the same problem as before (when using another star code)

 

Here is the Error:

Ignoring directed pickup request for call leg because the difference of -920966761 is too short

 

PS: The negative value changes form one call to another

 

Best Regards,

 

Karim Makki

Share this post


Link to post
Share on other sites

Hello,

 

After deactivation of one of the domain trunks on the Snom Blue (now there are three), we are able to intercept when using *87

A directed Call pickup (*87401) returns the same error as mentioned above.

 

We tried to replace the *87 with *02, and we have the same symptoms (blind call pickup successful, directed call pickup fails)

 

Here is the call log when using *87 then *87401:

[5] 2011/09/08 16:32:11: Identify trunk (IP address and DID match) 10

[7] 2011/09/08 16:32:11: Set packet length to 20

[6] 2011/09/08 16:32:11: Sending RTP for 30e0ad9e56cdfcc04f20c1661bac586f@87.98.200.138 to 87.98.200.138:14516, codec not set yet

[8] 2011/09/08 16:32:11: Call from a trunk 10

[8] 2011/09/08 16:32:11: Trunk Corea-MS@ipbx.corea.mystream.org has country code not set, area code not set

[8] 2011/09/08 16:32:11: To is <sip:401@109.70.19.42;user=phone>, user 0, domain 1

[5] 2011/09/08 16:32:11: Domain trunk Corea-MS@ipbx.corea.mystream.org sends call to 401 in domain ipbx.corea.mystream.org

[8] 2011/09/08 16:32:11: Set the To domain based on To user 401@ipbx.corea.mystream.org

[8] 2011/09/08 16:32:11: Call state for call object 2327: idle

[8] 2011/09/08 16:32:11: Call state for call object 2327: alerting

[8] 2011/09/08 16:32:11: Play audio_moh/noise.wav

[7] 2011/09/08 16:32:11: set_codecs: for 30e0ad9e56cdfcc04f20c1661bac586f@87.98.200.138 codecs "0 8", codec_preference count 3

[7] 2011/09/08 16:32:11: set_codecs: for e1d13890@pbx codecs "", codec_preference count 7

[7] 2011/09/08 16:32:11: Set packet length to 20

[8] 2011/09/08 16:32:12: Play audio_fr/ringback.wav

[6] 2011/09/08 16:32:12: Codec pcmu/8000 is chosen for call id 30e0ad9e56cdfcc04f20c1661bac586f@87.98.200.138

[7] 2011/09/08 16:32:12: Call e1d13890@pbx: Clear last request

[8] 2011/09/08 16:32:15: Could not find a trunk (5 trunks)

[8] 2011/09/08 16:32:15: Using outbound proxy sip:80.13.50.65:52845;transport=udp because UDP packet source did not match the via header

[8] 2011/09/08 16:32:15: Tagging request with existing tag

[7] 2011/09/08 16:32:15: Set packet length to 20

[6] 2011/09/08 16:32:15: Sending RTP for NDYwYzc4ODY4NDE0NGUwYThlNjNhMzA3NWE2YzM3MWQ. to 80.13.50.65:40030, codec not set yet

[8] 2011/09/08 16:32:15: Call from an user 402

[8] 2011/09/08 16:32:15: To is <sip:*87401@ipbx.corea.mystream.org:5060>, user 0, domain 6

[8] 2011/09/08 16:32:15: From user 402

[8] 2011/09/08 16:32:15: Set the To domain based on From user 402@ipbx.corea.mystream.org

[8] 2011/09/08 16:32:15: Call state for call object 2328: idle

[4] 2011/09/08 16:32:15: Ignoring directed pickup request for call leg because the difference of -57526214 is too short

[7] 2011/09/08 16:32:15: set_codecs: for NDYwYzc4ODY4NDE0NGUwYThlNjNhMzA3NWE2YzM3MWQ. codecs "", codec_preference count 7

[7] 2011/09/08 16:32:15: Set packet length to 20

[8] 2011/09/08 16:32:18: Could not find a trunk (5 trunks)

[8] 2011/09/08 16:32:18: Using outbound proxy sip:80.13.50.65:52845;transport=udp because UDP packet source did not match the via header

[8] 2011/09/08 16:32:19: Tagging request with existing tag

[7] 2011/09/08 16:32:19: Set packet length to 20

[6] 2011/09/08 16:32:19: Sending RTP for MjA4NDdlMzI4NjE4MjAwNjc1OTFjZTU5MWI2ZGMzZDM. to 80.13.50.65:40034, codec not set yet

[8] 2011/09/08 16:32:19: Call from an user 402

[8] 2011/09/08 16:32:19: To is <sip:*87@ipbx.corea.mystream.org:5060>, user 0, domain 6

[8] 2011/09/08 16:32:19: From user 402

[8] 2011/09/08 16:32:19: Set the To domain based on From user 402@ipbx.corea.mystream.org

[8] 2011/09/08 16:32:19: Call state for call object 2329: idle

[8] 2011/09/08 16:32:19: Call state for call object 2327: connected

[7] 2011/09/08 16:32:19: set_codecs: for MjA4NDdlMzI4NjE4MjAwNjc1OTFjZTU5MWI2ZGMzZDM. codecs "", codec_preference count 7

[7] 2011/09/08 16:32:19: Set packet length to 20

[6] 2011/09/08 16:32:19: Codec pcmu/8000 is chosen for call id MjA4NDdlMzI4NjE4MjAwNjc1OTFjZTU5MWI2ZGMzZDM.

[6] 2011/09/08 16:32:19: Last message repeated 2 times

[7] 2011/09/08 16:32:19: 30e0ad9e56cdfcc04f20c1661bac586f@87.98.200.138: RTP pass-through mode

[7] 2011/09/08 16:32:19: MjA4NDdlMzI4NjE4MjAwNjc1OTFjZTU5MWI2ZGMzZDM.: RTP pass-through mode

[7] 2011/09/08 16:32:19: Call e1d13890@pbx: Clear last request

[7] 2011/09/08 16:32:19: Call e1d13890@pbx: Clear last INVITE

[5] 2011/09/08 16:32:19: INVITE Response 487 Request Terminated: Terminate e1d13890@pbx

[6] 2011/09/08 16:32:19: Sending RTP for MjA4NDdlMzI4NjE4MjAwNjc1OTFjZTU5MWI2ZGMzZDM. to 80.13.50.65:2880, codec pcmu/8000

[8] 2011/09/08 16:32:25: Hangup: Call 347 not found

[7] 2011/09/08 16:32:25: MjA4NDdlMzI4NjE4MjAwNjc1OTFjZTU5MWI2ZGMzZDM.: Media-aware pass-through mode

[8] 2011/09/08 16:32:25: Hangup: Call 347 not found

[7] 2011/09/08 16:32:25: Call MjA4NDdlMzI4NjE4MjAwNjc1OTFjZTU5MWI2ZGMzZDM.: Clear last request

[5] 2011/09/08 16:32:25: BYE Response: Terminate MjA4NDdlMzI4NjE4MjAwNjc1OTFjZTU5MWI2ZGMzZDM.

 

Thanks in advance

Share this post


Link to post
Share on other sites

Only red flag is that first call says domain 1 and the second says domain 6.

 

[8] 2011/09/08 16:32:11:	To is <sip:401@109.70.19.42;user=phone>, user 0, domain 1

[8] 2011/09/08 16:32:15:	To is <sip:*87401@ipbx.corea.mystream.org:5060>, user 0, domain 6

 

Not sure that is causing this issue at this moment. Also, by looking at the log, it seems like an external call coming in and ringing an extension 401. Is that true or was it any different call flow? Any info (like special settings on the trunk/extension etc) would be helpful to reproduce it here.

 

We can add bit more logging and provide you with a new version for you to try. Let us know.

Share this post


Link to post
Share on other sites

Hello again,

 

The first call that you see on the domain 1 is the initial incoming call, and not the attempt to do a directed pickup call.

I don't know why the SnomBlue is receiving the call on Domain1; maybe all incoming calls are routed to domain1 by default, then the SnomBlue searches for the corresponding domain?

 

Concerning the incoming call ringing directly on extension 401, in fact we controle the server on which we have the registered trunk. so i routed a call a bit in a hurry directly to 401, since i haven't issigned a 10 digit number to that extension.

 

The customer facing this problem will have all it's incoming calls routed via our voip plateform next Thursday (15 September), so i appreciate if we could pass this issue to an urgent status :)

 

Thanks again

 

EDIT: Hello again, i did some call pickup tests with the "localhost" domain (successfully), and when i returned to test with the domain where the problem occurs, oddly i could intercept with no problem! i will send in another reply the call pickup log.

Share this post


Link to post
Share on other sites

Here is the logfile level 8 on both tries (*02 and *02401)

 

[8] 2011/09/09 14:54:44: Call from a trunk 10

[8] 2011/09/09 14:54:44: Trunk Corea-MS@ipbx.corea.mystream.org has country code not set, area code not set

[8] 2011/09/09 14:54:44: To is <sip:401@109.70.19.42;user=phone>, user 0, domain 1

[5] 2011/09/09 14:54:44: Domain trunk Corea-MS@ipbx.corea.mystream.org sends call to 401 in domain ipbx.corea.mystream.org

[8] 2011/09/09 14:54:44: Set the To domain based on To user 401@ipbx.corea.mystream.org

[8] 2011/09/09 14:54:44: Call state for call object 2490: idle

[8] 2011/09/09 14:54:44: Call state for call object 2490: alerting

[8] 2011/09/09 14:54:44: Play audio_moh/noise.wav

[7] 2011/09/09 14:54:44: set_codecs: for 76a9b0611d5f4b29629cea0c787e3a6b@87.98.200.138 codecs "0 8", codec_preference count 3

[7] 2011/09/09 14:54:44: set_codecs: for b76d0169@pbx codecs "", codec_preference count 7

[7] 2011/09/09 14:54:44: Set packet length to 20

[8] 2011/09/09 14:54:44: Play audio_fr/ringback.wav

[6] 2011/09/09 14:54:44: Codec pcmu/8000 is chosen for call id 76a9b0611d5f4b29629cea0c787e3a6b@87.98.200.138

[8] 2011/09/09 14:54:47: Could not find a trunk (5 trunks)

[8] 2011/09/09 14:54:47: Using outbound proxy sip:80.13.50.65:2048;transport=udp because UDP packet source did not match the via header

[8] 2011/09/09 14:54:48: Tagging request with existing tag

[7] 2011/09/09 14:54:48: Set packet length to 20

[6] 2011/09/09 14:54:48: Sending RTP for 3c27b09d044c-5bg96ovz7hqh to 10.8.1.78:58186, codec not set yet

[8] 2011/09/09 14:54:48: Call from an user 402

[8] 2011/09/09 14:54:48: To is <sip:*02@ipbx.corea.mystream.org;user=phone>, user 0, domain 6

[8] 2011/09/09 14:54:48: From user 402

[8] 2011/09/09 14:54:48: Set the To domain based on From user 402@ipbx.corea.mystream.org

[8] 2011/09/09 14:54:48: Call state for call object 2491: idle

[8] 2011/09/09 14:54:48: Call state for call object 2490: connected

[7] 2011/09/09 14:54:48: set_codecs: for 3c27b09d044c-5bg96ovz7hqh codecs "", codec_preference count 7

[7] 2011/09/09 14:54:48: Set packet length to 20

[6] 2011/09/09 14:54:48: Codec pcmu/8000 is chosen for call id 3c27b09d044c-5bg96ovz7hqh

[6] 2011/09/09 14:54:48: Last message repeated 2 times

[7] 2011/09/09 14:54:48: 76a9b0611d5f4b29629cea0c787e3a6b@87.98.200.138: RTP pass-through mode

[7] 2011/09/09 14:54:48: 3c27b09d044c-5bg96ovz7hqh: RTP pass-through mode

[7] 2011/09/09 14:54:48: Call 3c27b09d044c-5bg96ovz7hqh: Clear last request

[6] 2011/09/09 14:54:48: Sending RTP for 3c27b09d044c-5bg96ovz7hqh to 80.13.50.65:58186, codec pcmu/8000

[7] 2011/09/09 14:54:48: Call b76d0169@pbx: Clear last request

[7] 2011/09/09 14:54:48: Call b76d0169@pbx: Clear last INVITE

[5] 2011/09/09 14:54:48: INVITE Response 487 Request Terminated: Terminate b76d0169@pbx

[8] 2011/09/09 14:54:50: Hangup: Call 231 not found

[7] 2011/09/09 14:54:50: 3c27b09d044c-5bg96ovz7hqh: Media-aware pass-through mode

[8] 2011/09/09 14:54:50: Hangup: Call 231 not found

[7] 2011/09/09 14:54:50: Call 3c27b09d044c-5bg96ovz7hqh: Clear last request

[5] 2011/09/09 14:54:50: BYE Response: Terminate 3c27b09d044c-5bg96ovz7hqh

[5] 2011/09/09 14:54:58: Identify trunk (IP address and DID match) 10

[7] 2011/09/09 14:54:58: Set packet length to 20

[6] 2011/09/09 14:54:58: Sending RTP for 231b66cd00cc37a43ebcd871419765aa@87.98.200.138 to 87.98.200.138:19970, codec not set yet

[8] 2011/09/09 14:54:58: Call from a trunk 10

[8] 2011/09/09 14:54:58: Trunk Corea-MS@ipbx.corea.mystream.org has country code not set, area code not set

[8] 2011/09/09 14:54:58: To is <sip:401@109.70.19.42;user=phone>, user 0, domain 1

[5] 2011/09/09 14:54:58: Domain trunk Corea-MS@ipbx.corea.mystream.org sends call to 401 in domain ipbx.corea.mystream.org

[8] 2011/09/09 14:54:58: Set the To domain based on To user 401@ipbx.corea.mystream.org

[8] 2011/09/09 14:54:58: Call state for call object 2492: idle

[8] 2011/09/09 14:54:58: Call state for call object 2492: alerting

[8] 2011/09/09 14:54:58: Play audio_moh/noise.wav

[7] 2011/09/09 14:54:58: set_codecs: for 231b66cd00cc37a43ebcd871419765aa@87.98.200.138 codecs "0 8", codec_preference count 3

[7] 2011/09/09 14:54:58: set_codecs: for 1bcf3e62@pbx codecs "", codec_preference count 7

[7] 2011/09/09 14:54:58: Set packet length to 20

[8] 2011/09/09 14:54:58: Play audio_fr/ringback.wav

[6] 2011/09/09 14:54:58: Codec pcmu/8000 is chosen for call id 231b66cd00cc37a43ebcd871419765aa@87.98.200.138

[8] 2011/09/09 14:55:02: Could not find a trunk (5 trunks)

[8] 2011/09/09 14:55:02: Using outbound proxy sip:80.13.50.65:2048;transport=udp because UDP packet source did not match the via header

[8] 2011/09/09 14:55:02: Tagging request with existing tag

[7] 2011/09/09 14:55:02: Set packet length to 20

[6] 2011/09/09 14:55:02: Sending RTP for 3c27b0a9f33d-8ten0xrimcig to 10.8.1.78:62090, codec not set yet

[8] 2011/09/09 14:55:02: Call from an user 402

[8] 2011/09/09 14:55:02: To is <sip:*02401@ipbx.corea.mystream.org;user=phone>, user 0, domain 6

[8] 2011/09/09 14:55:02: From user 402

[8] 2011/09/09 14:55:02: Set the To domain based on From user 402@ipbx.corea.mystream.org

[8] 2011/09/09 14:55:02: Call state for call object 2493: idle

[8] 2011/09/09 14:55:02: Call state for call object 2492: connected

[7] 2011/09/09 14:55:02: set_codecs: for 3c27b0a9f33d-8ten0xrimcig codecs "", codec_preference count 7

[7] 2011/09/09 14:55:02: Set packet length to 20

[6] 2011/09/09 14:55:02: Codec pcmu/8000 is chosen for call id 3c27b0a9f33d-8ten0xrimcig

[6] 2011/09/09 14:55:02: Last message repeated 2 times

[7] 2011/09/09 14:55:02: 231b66cd00cc37a43ebcd871419765aa@87.98.200.138: RTP pass-through mode

[7] 2011/09/09 14:55:02: 3c27b0a9f33d-8ten0xrimcig: RTP pass-through mode

[7] 2011/09/09 14:55:02: Call 3c27b0a9f33d-8ten0xrimcig: Clear last request

[6] 2011/09/09 14:55:02: Sending RTP for 3c27b0a9f33d-8ten0xrimcig to 80.13.50.65:62090, codec pcmu/8000

[7] 2011/09/09 14:55:02: Call 1bcf3e62@pbx: Clear last request

[7] 2011/09/09 14:55:02: Call 1bcf3e62@pbx: Clear last INVITE

[5] 2011/09/09 14:55:02: INVITE Response 487 Request Terminated: Terminate 1bcf3e62@pbx

[8] 2011/09/09 14:55:06: Hangup: Call 241 not found

[7] 2011/09/09 14:55:06: 231b66cd00cc37a43ebcd871419765aa@87.98.200.138: Media-aware pass-through mode

[8] 2011/09/09 14:55:06: Hangup: Call 241 not found

[7] 2011/09/09 14:55:06: Call 231b66cd00cc37a43ebcd871419765aa@87.98.200.138: Clear last request

[5] 2011/09/09 14:55:06: BYE Response: Terminate 231b66cd00cc37a43ebcd871419765aa@87.98.200.138

 

Kind Regards

Share this post


Link to post
Share on other sites

The first call that you see on the domain 1 is the initial incoming call, and not the attempt to do a directed pickup call.

I don't know why the SnomBlue is receiving the call on Domain1; maybe all incoming calls are routed to domain1 by default, then the SnomBlue searches for the corresponding domain?

 

I understand that. The domain selection is based on the trunk where the call was received. BTW, the 1, 6 are all some internal indices.

 

We perform the call pickup without any issues here all the time, on a typical setup. Since you are seeing issues there, I wanted to know if you have any special setup there.

 

Anyways, let us know if you bump into the issue again(maybe with the SIP trace too along with the traces that you have sent).

Share this post


Link to post
Share on other sites

Join the conversation

You can post now and register later. If you have an account, sign in now to post with your account.

Guest
Reply to this topic...

×   Pasted as rich text.   Paste as plain text instead

  Only 75 emoji are allowed.

×   Your link has been automatically embedded.   Display as a link instead

×   Your previous content has been restored.   Clear editor

×   You cannot paste images directly. Upload or insert images from URL.

Loading...

×
×
  • Create New...