Hello All,
Wondering if anyone can offer some guidance on
an issue seemingly with a newly setup Sangoma
D-500 Transcoding card.
Issue:
When using transcoding, soon after 1 transcoded
call completes, utimer task messages until
opensips is restarted
seems like it happens when fetch_dlg_value:
looking for <SngTc>
Jan 12 15:05:26
[21578] DBG:tm:timer_routine: timer
routine:2,tl=0x7f9ce5fd3cc0 next=(nil),
timeout=16
Jan 12 15:05:26
[21578] DBG:tm:wait_handler: removing
0x7f9ce5fd3c40 from table
Jan 12 15:05:26
[21578] DBG:tm:delete_cell: delete transaction
0x7f9ce5fd3c40
Jan 12 15:05:26
[21578] DBG:tm:run_trans_callbacks:
trans=0x7f9ce5fd3c40, callback type 4096, id 3
entered
Jan 12 15:05:26
[21578] DBG:dialog:destroy_dlg: destroying
dialog 0x7f9ce5fcdc50
Jan 12 15:05:26
[21578] DBG:dialog:destroy_dlg: dlg expired or
not in list - dlg 0x7f9ce5fcdc50
[57:1450509359] with clid
'[email protected]' and
tags 'as6d2cf831'
'Yjg9IHv3tknz-KgDTUF.K-lleno6X-hI'
Jan 12 15:05:26
[21578] DBG:dialog:run_dlg_callbacks:
dialog=0x7f9ce5fcdc50, type=2048
Jan 12 15:05:26
[21578] DBG:dialog:fetch_dlg_value: looking
for <SngTc>
Jan 12 15:05:26
[21561] WARNING:core:utimer_ticker: utimer
task <tm-utimer> already scheduled 100
ms ago (now 16950 ms), delaying execution
Jan 12 15:05:26
[21561] WARNING:core:utimer_ticker: utimer
task <tm-utimer> already scheduled 200
ms ago (now 17050 ms), delaying execution
Jan 12 15:05:26
[21561] WARNING:core:utimer_ticker: utimer
task <tm-utimer> already scheduled 300
ms ago (now 17150 ms), delaying execution
Jan 12 15:05:26
[21561] WARNING:core:utimer_ticker: utimer
task <tm-utimer> already scheduled 400
ms ago (now 17250 ms), delaying execution
Jan 12 15:05:26
[21561] WARNING:core:utimer_ticker: utimer
task <tm-utimer> already scheduled 490
ms ago (now 17340 ms), delaying execution
Jan 12 15:05:26
[21561] WARNING:core:utimer_ticker: utimer
task <tm-utimer> already scheduled 590
ms ago (now 17440 ms), delaying execution
Jan 12 15:05:27
[21561] WARNING:core:utimer_ticker: utimer
task <tm-utimer> already scheduled 690
ms ago (now 17540 ms), delaying execution
Jan 12 15:05:27
[21561] WARNING:core:utimer_ticker: utimer
task <tm-utimer> already scheduled 790
ms ago (now 17640 ms), delaying execution
Jan 12 15:05:27
[21561] WARNING:core:utimer_ticker: utimer
task <tm-utimer> already scheduled 890
ms ago (now 17740 ms), delaying execution
Jan 12 15:05:27
[21561] WARNING:core:timer_ticker: timer task
<tm-timer> already scheduled 990 ms ago
(now 17740 ms), delayin
opensips-cli trap output ( not sure what am
looking at here, in case helps )
#1 0x00007f9cde9aee5f
in sangoma_worker_loop (proc_no=<optimized
out>) at sngtc_proc.c:46
req
= {type = REQ_FREE_SESSION, response_fd = 78,
sng_req = {usr_priv = 0x7f9ce8c8f86b
<asctime_r+139>, tag = 15, rtcp_enable =
5 '\005', a = {codec_
id = 32668, ms = 20,
host_ip = 0, host_netmask = 2021,
host_udp_port = 0}, b = {codec_id = 9217376,
ms = 0, host_ip = 3905485451, host_netmask =
32668, host_
udp_port = 20}},
sng_reply = 0x7f9ce5fd2c78}
rc
= 0
__FUNCTION__
= "sangoma_worker_loop"
#2 0x00000000005045c8
in start_module_procs () at sr_module.c:858
m
= 0x7f9ce7beafa8
n
= 0
l
= 0
x
= <optimized out>
__FUNCTION__
= "start_module_procs"
#3 0x000000000041e3df
in main_loop () at main.c:779
startup_done
= 0x0
chd_rank
= 0
last_check
= 0
rc
= <optimized out>
#4 main
(argc=<optimized out>,
argv=<optimized out>) at main.c:1479
c
= <optimized out>
r
= 0
tmp
= 0x1 <Address 0x1 out of bounds>
tmp_len
= <optimized out>
port
= <optimized out>
proto
= <optimized out>
protos_no
= <optimized out>
options
= 0x664908
"f:cCm:M:b:l:n:N:rRvdDFEVhw:t:u:g:p:P:G:W:o:a:k:s:"
ret
= -1
seed
= 4061548656
rfd
= <optimized out>
__FUNCTION__
= "main"
thanks
Andy