rendered paste body------------------- broken ---------------------
[Apr 3 11:06:51] VERBOSE[16823] logger.c: -- Executing Queue("SIP/112233-082644c0", "26093|t|||300")
[Apr 3 11:06:51] DEBUG[16823] app_queue.c: SIP/112233-082644c0: Got priority 5 from ${QUEUE_PRIO}.
[Apr 3 11:06:51] DEBUG[16823] app_queue.c: queue: 26093, options: t, url: , announce: , expires: 1207246311, priority: 5
[Apr 3 11:06:51] DEBUG[16823] res_config_mysql.c: MySQL RealTime: Everything is fine.
[Apr 3 11:06:51] DEBUG[16823] res_config_mysql.c: MySQL RealTime: Retrieve SQL: SELECT * FROM queue_table WHERE name = '26093'
[Apr 3 11:06:51] DEBUG[16823] res_config_mysql.c: MySQL RealTime: Everything is fine.
[Apr 3 11:06:51] DEBUG[16823] res_config_mysql.c: MySQL RealTime: Retrieve SQL: SELECT * FROM queue_members WHERE interface LIKE '%' AND queue_name = '26093' ORDER BY interface
[Apr 3 11:06:51] DEBUG[16823] res_config_mysql.c: MySQL RealTime: Everything is fine.
[Apr 3 11:06:51] DEBUG[16823] res_config_mysql.c: MySQL RealTime: Insert SQL: INSERT INTO queue_callers SET queue = '26093', uniqueid = '1207245990.56', channel = 'SIP/112233-082644c0', priority = '5', callerid_name = '26093-----8009814905', callerid_num = '8009814905', accountcode = '1207245990.56', started = '1207246011'
[Apr 3 11:06:51] DEBUG[16823] res_config_mysql.c: MySQL RealTime: row inserted on table: queue_callers, id: 0
[Apr 3 11:06:51] DEBUG[16823] app_queue.c: Queue '26093' Join, Channel 'SIP/112233-082644c0', Position '1'
[Apr 3 11:06:51] VERBOSE[16823] logger.c: -- Started music on hold, class 'ASAP', on SIP/112233-082644c0
[Apr 3 11:06:51] DEBUG[16823] app_queue.c: It's our turn (SIP/112233-082644c0).
[Apr 3 11:06:51] DEBUG[16823] app_queue.c: SIP/112233-082644c0 is trying to call a queue member.
[Apr 3 11:06:51] DEBUG[16823] app_queue.c: Trying 'Local/21168@default_queue' with metric 5001000
[Apr 3 11:06:51] DEBUG[16823] app_queue.c: Local/21168@default_queue paused, can't receive call
[Apr 3 11:06:51] DEBUG[16823] app_queue.c: Nobody left to try ringing in queue
[Apr 3 11:06:51] NOTICE[16823] app_queue.c: No one is answering queue '26093' (1/0/0)
[Apr 3 11:06:51] DEBUG[16823] res_config_mysql.c: MySQL RealTime: Everything is fine.
[Apr 3 11:06:51] DEBUG[16823] res_config_mysql.c: MySQL RealTime: Retrieve SQL: SELECT * FROM queue_members WHERE interface LIKE '%' AND queue_name = '26093' ORDER BY interface
[Apr 3 11:06:52] DEBUG[7206] chan_sip.c: ** SIP timers: Rescheduling retransmission 2 to 1000 ms (t1 500 ms (Retrans id #398))
[Apr 3 11:06:52] DEBUG[7206] chan_sip.c: = Found Their Call ID: 491b0f9653f6074275391ade7eb7dcef@81.198.164.118 Their Tag SD4mc8099-cd3e0004-0-1210438313 Our tag: as303b5e15
[Apr 3 11:06:52] DEBUG[7206] chan_sip.c: Stopping retransmission on '491b0f9653f6074275391ade7eb7dcef@81.198.164.118' of Request 102: Match Found
[Apr 3 11:06:52] DEBUG[7206] chan_sip.c: = Found Their Call ID: 491b0f9653f6074275391ade7eb7dcef@81.198.164.118 Their Tag Our tag: as303b5e15
[Apr 3 11:06:52] DEBUG[7206] chan_sip.c: Stopping retransmission on '491b0f9653f6074275391ade7eb7dcef@81.198.164.118' of Request 102: Match Not Found
[Apr 3 11:06:52] DEBUG[7206] chan_sip.c: SIP response 487 to standard invite
[Apr 3 11:06:52] DEBUG[7206] chan_sip.c: Updating call counter for outgoing call
[Apr 3 11:06:52] DEBUG[7206] chan_sip.c: Setting SIP_ALREADYGONE on dialog 491b0f9653f6074275391ade7eb7dcef@81.198.164.118
[Apr 3 11:06:52] VERBOSE[7206] logger.c: Really destroying SIP dialog '491b0f9653f6074275391ade7eb7dcef@81.198.164.118' Method: INVITE
[Apr 3 11:06:53] DEBUG[7187] devicestate.c: Changing state for SIP/204.11.200.152-082f2b28 - state 4 (Invalid)
[Apr 3 11:06:53] DEBUG[7187] devicestate.c: No provider found, checking channel drivers for SIP - 204.11.200.152
[Apr 3 11:06:53] DEBUG[7187] chan_sip.c: Checking device state for peer 204.11.200.152
[Apr 3 11:06:53] DEBUG[7224] app_queue.c: Device 'SIP/204.11.200.152-082f2b28' changed to state '4' (Invalid) but we don't care because they're not a member of any queue.
[Apr 3 11:06:53] DEBUG[7187] res_config_mysql.c: MySQL RealTime: Everything is fine.
[Apr 3 11:06:53] DEBUG[7187] res_config_mysql.c: MySQL RealTime: Retrieve SQL: SELECT * FROM sip_buddies WHERE name = '204.11.200.152' AND host = 'dynamic'
[Apr 3 11:06:53] DEBUG[7187] res_config_mysql.c: MySQL RealTime: Everything is fine.
[Apr 3 11:06:53] DEBUG[7187] res_config_mysql.c: MySQL RealTime: Retrieve SQL: SELECT * FROM sip_buddies WHERE name = '204.11.200.152'
[Apr 3 11:06:53] DEBUG[7187] devicestate.c: Changing state for SIP/204.11.200.152 - state 1 (Not in use)
[Apr 3 11:06:53] DEBUG[7224] app_queue.c: Device 'SIP/204.11.200.152' changed to state '1' (Not in use) but we don't care because they're not a member of any queue.
[Apr 3 11:06:56] DEBUG[16823] app_queue.c: It's our turn (SIP/112233-082644c0).
[Apr 3 11:06:56] DEBUG[16823] app_queue.c: SIP/112233-082644c0 is trying to call a queue member.
[Apr 3 11:06:56] DEBUG[16823] app_queue.c: Trying 'Local/21168@default_queue' with metric 5001000
[Apr 3 11:06:56] DEBUG[16823] app_queue.c: Local/21168@default_queue paused, can't receive call
[Apr 3 11:06:56] DEBUG[16823] app_queue.c: Nobody left to try ringing in queue
[Apr 3 11:06:56] NOTICE[16823] app_queue.c: No one is answering queue '26093' (1/0/0)
[Apr 3 11:06:56] DEBUG[16823] res_config_mysql.c: MySQL RealTime: Everything is fine.
[Apr 3 11:06:56] DEBUG[16823] res_config_mysql.c: MySQL RealTime: Retrieve SQL: SELECT * FROM queue_members WHERE interface LIKE '%' AND queue_name = '26093' ORDER BY interface
----------------------- ok --------------------------
[Apr 3 11:06:08] VERBOSE[16799] logger.c: -- Executing Queue("SIP/112233-082644c0", "26093|t|||300")
[Apr 3 11:06:08] DEBUG[16799] app_queue.c: SIP/112233-082644c0: Got priority 5 from ${QUEUE_PRIO}.
[Apr 3 11:06:08] DEBUG[16799] app_queue.c: queue: 26093, options: t, url: , announce: , expires: 1207246268, priority: 5
[Apr 3 11:06:08] DEBUG[16799] res_config_mysql.c: MySQL RealTime: Everything is fine.
[Apr 3 11:06:08] DEBUG[16799] res_config_mysql.c: MySQL RealTime: Retrieve SQL: SELECT * FROM queue_table WHERE name = '26093'
[Apr 3 11:06:08] DEBUG[16799] res_config_mysql.c: MySQL RealTime: Everything is fine.
[Apr 3 11:06:08] DEBUG[16799] res_config_mysql.c: MySQL RealTime: Retrieve SQL: SELECT * FROM queue_members WHERE interface LIKE '%' AND queue_name = '26093' ORDER BY interface
[Apr 3 11:06:08] DEBUG[16799] res_config_mysql.c: MySQL RealTime: Everything is fine.
[Apr 3 11:06:08] DEBUG[16799] res_config_mysql.c: MySQL RealTime: Insert SQL: INSERT INTO queue_callers SET queue = '26093', uniqueid = '1207245964.55', channel = 'SIP/112233-082644c0', priority = '5', callerid_name = '26093-----112233', callerid_num = '112233', accountcode = '1207245964.55', started = '1207245968'
[Apr 3 11:06:08] DEBUG[16799] res_config_mysql.c: MySQL RealTime: row inserted on table: queue_callers, id: 0
[Apr 3 11:06:08] DEBUG[16799] app_queue.c: Queue '26093' Join, Channel 'SIP/112233-082644c0', Position '1'
[Apr 3 11:06:08] VERBOSE[16799] logger.c: -- Started music on hold, class 'ASAP', on SIP/112233-082644c0
[Apr 3 11:06:08] DEBUG[16799] app_queue.c: It's our turn (SIP/112233-082644c0).
[Apr 3 11:06:08] DEBUG[16799] app_queue.c: SIP/112233-082644c0 is trying to call a queue member.
[Apr 3 11:06:08] DEBUG[16799] app_queue.c: Trying 'Local/21168@default_queue' with metric 5001000
[Apr 3 11:06:08] DEBUG[16799] app_queue.c: Local/21168@default_queue paused, can't receive call
[Apr 3 11:06:08] DEBUG[16799] app_queue.c: Nobody left to try ringing in queue
[Apr 3 11:06:08] NOTICE[16799] app_queue.c: No one is answering queue '26093' (1/0/0)
[Apr 3 11:06:08] DEBUG[16799] res_config_mysql.c: MySQL RealTime: Everything is fine.
[Apr 3 11:06:08] DEBUG[16799] res_config_mysql.c: MySQL RealTime: Retrieve SQL: SELECT * FROM queue_members WHERE interface LIKE '%' AND queue_name = '26093' ORDER BY interface
[Apr 3 11:06:08] DEBUG[16799] channel.c: Internal timing is disabled (option_internal_timing=0 chan->timingfd=-1)
[Apr 3 11:06:08] DEBUG[16799] channel.c: Set channel SIP/112233-082644c0 to write format alaw
[Apr 3 11:06:08] DEBUG[16799] res_musiconhold.c: SIP/112233-082644c0 Opened file 2 '/var/lib/asterisk/moh-playlists/ASAP/OH-generic-contemp-2'
[Apr 3 11:06:08] DEBUG[16799] rtp.c: Difference is 6160, ms is 790
[Apr 3 11:06:08] DEBUG[16799] channel.c: Internal timing is disabled (option_internal_timing=0 chan->timingfd=-1)
[Apr 3 11:06:08] DEBUG[16799] channel.c: Internal timing is disabled (option_internal_timing=0 chan->timingfd=-1)
[Apr 3 11:06:08] DEBUG[16799] channel.c: Internal timing is disabled (option_internal_timing=0 chan->timingfd=-1)
[Apr 3 11:06:08] DEBUG[16799] channel.c: Internal timing is disabled (option_internal_timing=0 chan->timingfd=-1)
[Apr 3 11:06:08] DEBUG[16799] channel.c: Internal timing is disabled (option_internal_timing=0 chan->timingfd=-1)
[Apr 3 11:06:08] DEBUG[16799] channel.c: Internal timing is disabled (option_internal_timing=0 chan->timingfd=-1)
[Apr 3 11:06:08] DEBUG[16799] channel.c: Internal timing is disabled (option_internal_timing=0 chan->timingfd=-1)