[Blink] Can't receive inbound phone calls.

Yamamura Hiroaki hiroak54 at gmail.com
Thu Aug 26 11:20:45 CEST 2010


For reference, I attach "telephone" 0.14.3 log data.
telephone 0.14.3 is work fine.
It can see "invite" message.


17:02:42.118 sip_endpoint.c  Module "mod-pjsua-log" registered
 17:02:42.119 sip_endpoint.c  Module "mod-tsx-layer" registered
 17:02:42.119 sip_endpoint.c  Module "mod-stateful-util" registered
 17:02:42.119 sip_endpoint.c  Module "mod-ua" registered
 17:02:42.119 sip_endpoint.c  Module "mod-100rel" registered
 17:02:42.119 sip_endpoint.c  Module "mod-pjsua" registered
 17:02:42.119 sip_endpoint.c  Module "mod-invite" registered
 17:02:42.124      pasound.c  PortAudio sound library initialized, status=0
 17:02:42.124      pasound.c  PortAudio host api count=1
 17:02:42.124      pasound.c  Sound device count=9
 17:02:42.124          pjlib  select() I/O Queue created (0x14013014)
 17:02:42.125 sip_endpoint.c  Module "mod-evsub" registered
 17:02:42.125 sip_endpoint.c  Module "mod-presence" registered
 17:02:42.125 sip_endpoint.c  Module "mod-refer" registered
 17:02:42.125 sip_endpoint.c  Module "mod-pjsua-pres" registered
 17:02:42.125 sip_endpoint.c  Module "mod-pjsua-im" registered
 17:02:42.125 sip_endpoint.c  Module "mod-pjsua-options" registered
 17:02:42.125   pjsua_core.c  1 SIP worker threads created
 17:02:42.125   pjsua_core.c  pjsua version 1.0.3 for i386-apple-darwin9.7.0 initialized
 17:02:42.128   pjsua_core.c  SIP UDP socket reachable at 192.168.11.20:54237
 17:02:42.128 sip_transport_  Error setting SO_RCVBUF: No buffer space available [120055]
 17:02:42.128 sip_transport_  Error setting SO_SNDBUF: No buffer space available [120055]
 17:02:42.128  udp0x14043a00  SIP UDP transport started, published address is 192.168.11.20:54237
 17:02:42.132   tcplis:54237  SIP TCP listener ready for incoming connections at 192.168.11.20:54237
 17:02:42.134  pjsua_media.c  RTP socket reachable at 192.168.11.20:4000
 17:02:42.134  pjsua_media.c  RTCP socket reachable at 192.168.11.20:4001
 17:02:42.135  pjsua_media.c  RTP socket reachable at 192.168.11.20:4002
 17:02:42.135  pjsua_media.c  RTCP socket reachable at 192.168.11.20:4003
 17:02:42.137  pjsua_media.c  RTP socket reachable at 192.168.11.20:4004
 17:02:42.137  pjsua_media.c  RTCP socket reachable at 192.168.11.20:4005
 17:02:42.141  pjsua_media.c  RTP socket reachable at 192.168.11.20:4006
 17:02:42.141  pjsua_media.c  RTCP socket reachable at 192.168.11.20:4007
 17:02:42.142  pjsua_media.c  RTP socket reachable at 192.168.11.20:4008
 17:02:42.142  pjsua_media.c  RTCP socket reachable at 192.168.11.20:4009
 17:02:42.143  pjsua_media.c  RTP socket reachable at 192.168.11.20:4010
 17:02:42.143  pjsua_media.c  RTCP socket reachable at 192.168.11.20:4011
 17:02:42.144  pjsua_media.c  RTP socket reachable at 192.168.11.20:4012
 17:02:42.144  pjsua_media.c  RTCP socket reachable at 192.168.11.20:4013
 17:02:42.146  pjsua_media.c  RTP socket reachable at 192.168.11.20:4014
 17:02:42.146  pjsua_media.c  RTCP socket reachable at 192.168.11.20:4015
 17:02:42.169    pjsua_acc.c  Account Yamamura Hiroaki <sip:user1003 at actmind.brastel.ne.jp> added with id 0
 17:02:42.170   pjsua_core.c  TX 550 bytes Request msg REGISTER/cseq=40649 (tdta0x1005c00) to UDP 202.173.5.153:5060:
REGISTER sip:actmind.brastel.ne.jp SIP/2.0
Via: SIP/2.0/UDP 192.168.11.20:54237;rport;branch=z9hG4bKPjqSNx0BvCWECWbwXleBzsmP4Qz8l4pqvG
Route: <sip:proxy04.brastel.ne.jp;lr>
Max-Forwards: 70
From: "Yamamura Hiroaki" <sip:user1003 at actmind.brastel.ne.jp>;tag=uQxzLc86Cm-daoJOrkuxLJUDLPy7KwKT
To: "Yamamura Hiroaki" <sip:user1003 at actmind.brastel.ne.jp>
Call-ID: Qg2zi0dINyNAA0VyRRZn6uJxJOgExfsE
CSeq: 40649 REGISTER
User-Agent: Telephone 0.14.3
Contact: "Yamamura Hiroaki" <sip:user1003 at 192.168.11.20:54237>
Expires: 300
Content-Length:  0


--end msg--
 17:02:42.170    pjsua_acc.c  Registration sent
 17:02:42.180   pjsua_core.c  RX 796 bytes Response msg 407/REGISTER/cseq=40649 (rdata0x14044c64) from UDP 202.173.5.153:5060:
SIP/2.0 407 Proxy Authentication Required
Via: SIP/2.0/UDP 192.168.11.20:54237;rport=54237;branch=z9hG4bKPjqSNx0BvCWECWbwXleBzsmP4Qz8l4pqvG;received=210.136.2.178
From: "Yamamura Hiroaki" <sip:user1003 at actmind.brastel.ne.jp>;tag=uQxzLc86Cm-daoJOrkuxLJUDLPy7KwKT
To: "Yamamura Hiroaki" <sip:user1003 at actmind.brastel.ne.jp>;tag=f97b1cfc7c50bb7a073f3f8c77e1a407.81d8
Call-ID: Qg2zi0dINyNAA0VyRRZn6uJxJOgExfsE
CSeq: 40649 REGISTER
Proxy-Authenticate: Digest realm="actmind.brastel.ne.jp", nonce="4c74cf4ecd2908ceb2625dda6075fa0901105fe3"
Server: OpenSer (1.1.0-notls (i386/linux))
Content-Length: 0
Warning: 392 202.173.5.153:5060 "Noisy feedback tells:  pid=21501 req_src_ip=210.136.2.178 req_src_port=54237 in_uri=sip:actmind.brastel.ne.jp out_uri=sip:actmind.brastel.ne.jp via_cnt==1"


--end msg--
 17:02:42.182   pjsua_core.c  TX 758 bytes Request msg REGISTER/cseq=40650 (tdta0x1005c00) to UDP 202.173.5.153:5060:
REGISTER sip:actmind.brastel.ne.jp SIP/2.0
Via: SIP/2.0/UDP 192.168.11.20:54237;rport;branch=z9hG4bKPjf6621NESgZisHozNNQLm.ehbMkw3dGkQ
Route: <sip:proxy04.brastel.ne.jp;lr>
Max-Forwards: 70
From: "Yamamura Hiroaki" <sip:user1003 at actmind.brastel.ne.jp>;tag=uQxzLc86Cm-daoJOrkuxLJUDLPy7KwKT
To: "Yamamura Hiroaki" <sip:user1003 at actmind.brastel.ne.jp>
Call-ID: Qg2zi0dINyNAA0VyRRZn6uJxJOgExfsE
CSeq: 40650 REGISTER
User-Agent: Telephone 0.14.3
Contact: "Yamamura Hiroaki" <sip:user1003 at 192.168.11.20:54237>
Expires: 300
Proxy-Authorization: Digest username="user1003", realm="actmind.brastel.ne.jp", nonce="4c74cf4ecd2908ceb2625dda6075fa0901105fe3", uri="sip:actmind.brastel.ne.jp", response="beb1b3419b7f1c28d3f76ee712a75451"
Content-Length:  0


--end msg--
 17:02:42.271   pjsua_core.c  RX 505 bytes Response msg 200/REGISTER/cseq=40650 (rdata0x14044c64) from UDP 202.173.5.153:5060:
SIP/2.0 200 OK
Via: SIP/2.0/UDP 192.168.11.20:54237;rport=54237;branch=z9hG4bKPjf6621NESgZisHozNNQLm.ehbMkw3dGkQ;received=210.136.2.178
From: "Yamamura Hiroaki" <sip:user1003 at actmind.brastel.ne.jp>;tag=uQxzLc86Cm-daoJOrkuxLJUDLPy7KwKT
To: "Yamamura Hiroaki" <sip:user1003 at actmind.brastel.ne.jp>;tag=user-RegistrarServer-4741
Call-ID: Qg2zi0dINyNAA0VyRRZn6uJxJOgExfsE
CSeq: 40650 REGISTER
Contact: "Yamamura Hiroaki" <sip:user1003 at 192.168.11.20:54237>;expires=100
Expires: 100
Content-Length: 0


--end msg--
 17:02:42.271    pjsua_acc.c  Yamamura Hiroaki <sip:user1003 at actmind.brastel.ne.jp>: registration success, status=200 (OK), will re-register in 100 seconds
 17:02:42.271    pjsua_acc.c  Keep-alive timer started for acc 0, destination:202.173.5.153:5060, interval:15s
 17:02:47.425  pjsua_media.c  pjsua_set_snd_dev(): attempting to open devices @16000 Hz
 17:02:47.438   ec0x13b483a0  AEC created, clock_rate=16000, channel=1, samples per frame=320, tail length=200 ms, latency=20 ms
 17:02:47.438   pjsua_call.c  Making call with acc #0 to <sip:1001 at actmind.brastel.ne.jp>
 17:02:47.445  pjsua_media.c  Media index 0 selected for call 0
 17:02:47.447   pjsua_core.c  TX 1143 bytes Request msg INVITE/cseq=23506 (tdta0x1868600) to UDP 202.173.5.153:5060:
INVITE sip:1001 at actmind.brastel.ne.jp SIP/2.0
Via: SIP/2.0/UDP 192.168.11.20:54237;rport;branch=z9hG4bKPjYROUH6GHhn54hYuaBCe4JN.oG4tsA4AA
Max-Forwards: 70
From: "Yamamura Hiroaki" <sip:user1003 at actmind.brastel.ne.jp>;tag=HFEpd81RwgMRvUX3AXGLG-nRva0m8cES
To: <sip:1001 at actmind.brastel.ne.jp>
Contact: "Yamamura Hiroaki" <sip:user1003 at 192.168.11.20:54237>
Call-ID: XFFPb3Z6TrWodo1lLYiXrMr4HkJWSlnN
CSeq: 23506 INVITE
Route: <sip:proxy04.brastel.ne.jp;lr>
Allow: PRACK, INVITE, ACK, BYE, CANCEL, UPDATE, SUBSCRIBE, NOTIFY, REFER, MESSAGE, OPTIONS
Supported: replaces, 100rel, norefersub
User-Agent: Telephone 0.14.3
Content-Type: application/sdp
Content-Length:   462





On 2010/08/26, at 17:44, Adrian Georgescu wrote:

> It is server related in the sense that the server does not send you the Invite. This could also be triggered by the fact that the server does not like something in the original Register but there is no clue in the trace about this.
> 
> Adrian
> 
> 
> On Aug 26, 2010, at 10:31 AM, Yamamura Hiroaki wrote:
> 
>> I see.
>> Thanks to your reply.
>> 
>> Is this SIP provider problem?
>> I can outgoing calls is this correctly?
>> 
>> 
>> On 2010/08/26, at 17:03, Adrian Georgescu <ag at ag-projects.com> wrote:
>> 
>>> You get no INVITE message in Blink.
>>> 
>>> You must find out in the SIP server why not. 
>>> 
>>> Adrian
>>> 
>>> On Aug 26, 2010, at 9:55 AM, Yamamura Hiroaki wrote:
>>> 
>>>> OK, This is log data.
>>>> 
>>>> 
>>>> "Activity"
>>>> 
>>>> 2010-08-26 16:37:46   Starting VNC server at port 5986...
>>>> 2010-08-26 16:37:46   Account('user1003 at actmind.brastel.ne.jp') activated
>>>> 2010-08-26 16:37:46   2010-08-26 16:37:46 Registered Contact Address "sip:iyadvklc at 192.168.1.8:52353" for sip:user1003 at actmind.brastel.ne.jp at 202.173.5.153:5060;transport=udp (expires in 100 seconds).
>>>> 
>>>> 2010-08-26 16:37:46   user1003 at actmind.brastel.ne.jp was registered
>>>> 2010-08-26 16:37:54   Detected NAT Type: Blocked
>>>> 
>>>> 
>>>> 
>>>> "SIP"
>>>> 
>>>> 2010-08-26 16:37:46.598499: DNS lookup A proxy04.brastel.ne.jp succeeded, ttl=3600: 202.173.5.153
>>>> 
>>>> SENDING: Packet 1, +0:00:00
>>>> 2010-08-26 16:37:46.611322: 192.168.11.20:52353 -(SIP over UDP)-> 202.173.5.153:5060
>>>> REGISTER sip:actmind.brastel.ne.jp SIP/2.0
>>>> Via: SIP/2.0/UDP 192.168.11.20:52353;rport;branch=z9hG4bKPjikEdupKYW6OQoe8AHjoxiTqVPV7n5CCJ
>>>> Max-Forwards: 70
>>>> From: "Yamamura Hiroaki" <sip:user1003 at actmind.brastel.ne.jp>;tag=mSminAeqWBW0KM31XPYXaBvrB2r1Aamp
>>>> To: "Yamamura Hiroaki" <sip:user1003 at actmind.brastel.ne.jp>
>>>> Contact: <sip:iyadvklc at 192.168.1.8:52353>
>>>> Call-ID: iedzhdwo5whRKH8KMiiyzUx7GOdGEbZa
>>>> CSeq: 1 REGISTER
>>>> Expires: 60
>>>> User-Agent: Blink 0.19.5 (MacOSX)
>>>> Content-Length:  0
>>>> 
>>>> 2010-08-26 16:37:46.624330: DNS lookup SRV _stun._udp.actmind.brastel.ne.jp failed: DNS record does not exist
>>>> 
>>>> RECEIVED: Packet 2, +0:00:00.010449
>>>> 2010-08-26 16:37:46.621771: 202.173.5.153:5060 -(SIP over UDP)-> 192.168.11.20:52353
>>>> SIP/2.0 407 Proxy Authentication Required
>>>> Via: SIP/2.0/UDP 192.168.11.20:52353;rport=52353;branch=z9hG4bKPjikEdupKYW6OQoe8AHjoxiTqVPV7n5CCJ;received=210.136.2.178
>>>> From: "Yamamura Hiroaki" <sip:user1003 at actmind.brastel.ne.jp>;tag=mSminAeqWBW0KM31XPYXaBvrB2r1Aamp
>>>> To: "Yamamura Hiroaki" <sip:user1003 at actmind.brastel.ne.jp>;tag=f97b1cfc7c50bb7a073f3f8c77e1a407.8f60
>>>> Call-ID: iedzhdwo5whRKH8KMiiyzUx7GOdGEbZa
>>>> CSeq: 1 REGISTER
>>>> Proxy-Authenticate: Digest realm="actmind.brastel.ne.jp", nonce="4c761af619124fabb7c888b30ae7fec282e02228"
>>>> Server: OpenSer (1.1.0-notls (i386/linux))
>>>> Content-Length: 0
>>>> Warning: 392 202.173.5.153:5060 "Noisy feedback tells:  pid=21502 req_src_ip=210.136.2.178 req_src_port=52353 in_uri=sip:actmind.brastel.ne.jp out_uri=sip:actmind.brastel.ne.jp via_cnt==1"
>>>> 
>>>> SENDING: Packet 3, +0:00:00.010635
>>>> 2010-08-26 16:37:46.621957: 192.168.11.20:52353 -(SIP over UDP)-> 202.173.5.153:5060
>>>> REGISTER sip:actmind.brastel.ne.jp SIP/2.0
>>>> Via: SIP/2.0/UDP 192.168.11.20:52353;rport;branch=z9hG4bKPjrHwQr7DpwlZkC7CaoIjUrnJ0YVQlR20d
>>>> Max-Forwards: 70
>>>> From: "Yamamura Hiroaki" <sip:user1003 at actmind.brastel.ne.jp>;tag=mSminAeqWBW0KM31XPYXaBvrB2r1Aamp
>>>> To: "Yamamura Hiroaki" <sip:user1003 at actmind.brastel.ne.jp>
>>>> Contact: <sip:iyadvklc at 192.168.1.8:52353>
>>>> Call-ID: iedzhdwo5whRKH8KMiiyzUx7GOdGEbZa
>>>> CSeq: 2 REGISTER
>>>> Expires: 60
>>>> User-Agent: Blink 0.19.5 (MacOSX)
>>>> Proxy-Authorization: Digest username="user1003", realm="actmind.brastel.ne.jp", nonce="4c761af619124fabb7c888b30ae7fec282e02228", uri="sip:actmind.brastel.ne.jp", response="a7b3e4fdb1aee891b787e7c6f8207be0"
>>>> Content-Length:  0
>>>> 
>>>> RECEIVED: Packet 4, +0:00:00.104044
>>>> 2010-08-26 16:37:46.715366: 202.173.5.153:5060 -(SIP over UDP)-> 192.168.11.20:52353
>>>> SIP/2.0 200 OK
>>>> Via: SIP/2.0/UDP 192.168.11.20:52353;rport=52353;branch=z9hG4bKPjrHwQr7DpwlZkC7CaoIjUrnJ0YVQlR20d;received=210.136.2.178
>>>> From: "Yamamura Hiroaki" <sip:user1003 at actmind.brastel.ne.jp>;tag=mSminAeqWBW0KM31XPYXaBvrB2r1Aamp
>>>> To: "Yamamura Hiroaki" <sip:user1003 at actmind.brastel.ne.jp>;tag=user-RegistrarServer-3081
>>>> Call-ID: iedzhdwo5whRKH8KMiiyzUx7GOdGEbZa
>>>> CSeq: 2 REGISTER
>>>> Contact: <sip:iyadvklc at 192.168.1.8:52353>;expires=100
>>>> Expires: 100
>>>> Content-Length: 0
>>>> 
>>>> 
>>>> 
>>>> 
>>>> 
>>>> 
>>>> 
>>>> On 2010/08/26, at 16:52, Adrian Georgescu wrote:
>>>> 
>>>>> Do you get the call in? Please paste the trace from your log window.
>>>>> 
>>>>> Adrian
>>>>> 
>>>>> 
>>>>> On Aug 26, 2010, at 9:44 AM, Yamamura Hiroaki wrote:
>>>>> 
>>>>>> Adrian,
>>>>>> 
>>>>>> Thank you for your reply.
>>>>>> 
>>>>>>> What do you see in the SIP trace window when a call comes in?
>>>>>> 
>>>>>> 
>>>>>> Nothing. Blink has no reaction .
>>>>>> Other IP phone is no ringing.
>>>>>> 
>>>>>> 
>>>>>> Sincerely,
>>>>>> 
>>>>>> Yamamura Hiroaki
>>>>>> 
>>>>>> 
>>>>>> 
>>>>>> On 2010/08/26, at 16:34, Adrian Georgescu wrote:
>>>>>> 
>>>>>>> Yamamura,
>>>>>>> 
>>>>>>> What do you see in the SIP trace window when a call comes in?
>>>>>>> 
>>>>>>> Adrian
>>>>>>> 
>>>>>>> On Aug 26, 2010, at 4:04 AM, Yamamura Hiroaki wrote:
>>>>>>> 
>>>>>>>> Hi,
>>>>>>>> 
>>>>>>>> I installed Blink Version 0.19.5 and SIP registration is successfully.
>>>>>>>> I can make a call to other IP phone or mobile phone.
>>>>>>>> 
>>>>>>>> But I can't receive inbound phone calls.
>>>>>>>> I have 3 SIP account and IP phone in my office.
>>>>>>>> When launch Blink, all IP phone can't receive inbound phone calls.
>>>>>>>> There is no ringing.
>>>>>>>> 
>>>>>>>> 1. All IP phone is work fine
>>>>>>>> 2. Launch Blink
>>>>>>>> 3. SIP registration on Blink
>>>>>>>> 4. All IP phone and Blink can't receive inbound calls (No ringing)
>>>>>>>> 5. Quit Blink then wait SIP expired time
>>>>>>>> 6. All IP phone is restore and work fine
>>>>>>>> 
>>>>>>>> I tested X-Lite, telephone, iSoftPhone is work fine.
>>>>>>>> 
>>>>>>>> 
>>>>>>>> 
>>>>>>>> Sincerely,
>>>>>>>> 
>>>>>>>> Yamamura Hiroaki
>>>>>>>> _______________________________________________
>>>>>>>> Blink mailing list
>>>>>>>> Blink at lists.ag-projects.com
>>>>>>>> http://lists.ag-projects.com/mailman/listinfo/blink
>>>>>>>> 
>>>>>>> 
>>>>>>> _______________________________________________
>>>>>>> Blink mailing list
>>>>>>> Blink at lists.ag-projects.com
>>>>>>> http://lists.ag-projects.com/mailman/listinfo/blink
>>>>>> 
>>>>>> _______________________________________________
>>>>>> Blink mailing list
>>>>>> Blink at lists.ag-projects.com
>>>>>> http://lists.ag-projects.com/mailman/listinfo/blink
>>>>>> 
>>>>> 
>>>>> _______________________________________________
>>>>> Blink mailing list
>>>>> Blink at lists.ag-projects.com
>>>>> http://lists.ag-projects.com/mailman/listinfo/blink
>>>> 
>>>> _______________________________________________
>>>> Blink mailing list
>>>> Blink at lists.ag-projects.com
>>>> http://lists.ag-projects.com/mailman/listinfo/blink
>>>> 
>>> 
>>> _______________________________________________
>>> Blink mailing list
>>> Blink at lists.ag-projects.com
>>> http://lists.ag-projects.com/mailman/listinfo/blink
>> _______________________________________________
>> Blink mailing list
>> Blink at lists.ag-projects.com
>> http://lists.ag-projects.com/mailman/listinfo/blink
>> 
> 
> _______________________________________________
> Blink mailing list
> Blink at lists.ag-projects.com
> http://lists.ag-projects.com/mailman/listinfo/blink




More information about the Blink mailing list