OutgoingSpoolFailed !?

I am using Elastix auto dialer and I have a big problem with outgoing calls. But when I dial calls manualy, I have not a problems.
I do wish to know , maybe my problem is on side of voip provider.
I use 1.6.2 version of asterisk and sip trunk via voip provider, sipgate.de.
Dialplan patterns under Outbound Routes I have defined as wildcard "."
Maximum channels is set to "unlimited"
Please could you give me some advice and comment on output of CLI

My asteriskCLI shows the following messages

– Executing [failed@from-internal:1] Macro(“OutgoingSpoolFailed”, “user-callerid,SKIPTTL,”) in new stack
– Executing [s@macro-user-callerid:1] Set(“OutgoingSpoolFailed”, “AMPUSER=”) in new stack
– Executing [s@macro-user-callerid:2] GotoIf(“OutgoingSpoolFailed”, “0?report”) in new stack
– Executing [s@macro-user-callerid:3] ExecIf(“OutgoingSpoolFailed”, “1?Set(REALCALLERIDNUM=)”) in new stack
– Executing [s@macro-user-callerid:4] Set(“OutgoingSpoolFailed”, “AMPUSER=”) in new stack
– Executing [s@macro-user-callerid:5] Set(“OutgoingSpoolFailed”, “AMPUSERCIDNAME=”) in new stack
– Executing [s@macro-user-callerid:6] GotoIf(“OutgoingSpoolFailed”, “1?report”) in new stack
– Goto (macro-user-callerid,s,10)
– Executing [s@macro-user-callerid:10] GotoIf(“OutgoingSpoolFailed”, “1?continue”) in new stack
– Goto (macro-user-callerid,s,19)
– Executing [s@macro-user-callerid:19] NoOp(“OutgoingSpoolFailed”, “Using CallerID “” <>”) in new stack
– Executing [failed@from-internal:2] Set(“OutgoingSpoolFailed”, “_NODEST=”) in new stack
– Executing [failed@from-internal:3] Macro(“OutgoingSpoolFailed”, “record-enable,OUT,”) in new stack
– Executing [s@macro-record-enable:1] GotoIf(“OutgoingSpoolFailed”, “1?check”) in new stack
– Goto (macro-record-enable,s,4)
– Executing [s@macro-record-enable:4] ExecIf(“OutgoingSpoolFailed”, “1?MacroExit()”) in new stack
– Executing [failed@from-internal:4] Macro(“OutgoingSpoolFailed”, “dialout-trunk,2,failed,”) in new stack
– Executing [s@macro-dialout-trunk:1] Set(“OutgoingSpoolFailed”, “DIAL_TRUNK=2”) in new stack
– Executing [s@macro-dialout-trunk:2] GosubIf(“OutgoingSpoolFailed”, “0?sub-pincheck,s,1”) in new stack
– Executing [s@macro-dialout-trunk:3] GotoIf(“OutgoingSpoolFailed”, “0?disabletrunk,1”) in new stack
– Executing [s@macro-dialout-trunk:4] Set(“OutgoingSpoolFailed”, “DIAL_NUMBER=failed”) in new stack
– Executing [s@macro-dialout-trunk:5] Set(“OutgoingSpoolFailed”, “DIAL_TRUNK_OPTIONS=tr”) in new stack
– Executing [s@macro-dialout-trunk:6] Set(“OutgoingSpoolFailed”, “OUTBOUND_GROUP=OUT_2”) in new stack
– Executing [s@macro-dialout-trunk:7] GotoIf(“OutgoingSpoolFailed”, “0?nomax”) in new stack
– Executing [s@macro-dialout-trunk:8] GotoIf(“OutgoingSpoolFailed”, “0?chanfull”) in new stack
– Executing [s@macro-dialout-trunk:9] GotoIf(“OutgoingSpoolFailed”, “0?skipoutcid”) in new stack
– Executing [s@macro-dialout-trunk:10] Set(“OutgoingSpoolFailed”, “DIAL_TRUNK_OPTIONS=”) in new stack
– Executing [s@macro-dialout-trunk:11] Macro(“OutgoingSpoolFailed”, “outbound-callerid,2”) in new stack
– Executing [s@macro-outbound-callerid:1] ExecIf(“OutgoingSpoolFailed”, “0?Set(CALLERPRES()=)”) in new stack
– Executing [s@macro-outbound-callerid:2] ExecIf(“OutgoingSpoolFailed”, “1?Set(REALCALLERIDNUM=)”) in new stack
– Executing [s@macro-outbound-callerid:3] GotoIf(“OutgoingSpoolFailed”, “1?normcid”) in new stack
– Goto (macro-outbound-callerid,s,6)
– Executing [s@macro-outbound-callerid:6] Set(“OutgoingSpoolFailed”, “USEROUTCID=”) in new stack
– Executing [s@macro-outbound-callerid:7] Set(“OutgoingSpoolFailed”, “EMERGENCYCID=”) in new stack
– Executing [s@macro-outbound-callerid:8] Set(“OutgoingSpoolFailed”, “TRUNKOUTCID=4984149399489”) in new stack
– Executing [s@macro-outbound-callerid:9] GotoIf(“OutgoingSpoolFailed”, “1?trunkcid”) in new stack
– Goto (macro-outbound-callerid,s,12)
– Executing [s@macro-outbound-callerid:12] ExecIf(“OutgoingSpoolFailed”, “1?Set(CALLERID(all)=4984149399489)”) in new stack
– Executing [s@macro-outbound-callerid:13] ExecIf(“OutgoingSpoolFailed”, “0?Set(CALLERID(all)=)”) in new stack
– Executing [s@macro-outbound-callerid:14] ExecIf(“OutgoingSpoolFailed”, “0?Set(CALLERID(all)=)”) in new stack
– Executing [s@macro-outbound-callerid:15] ExecIf(“OutgoingSpoolFailed”, “0?Set(CALLERPRES()=prohib_passed_screen)”) in new stack
– Executing [s@macro-dialout-trunk:12] ExecIf(“OutgoingSpoolFailed”, “0?AGI(fixlocalprefix)”) in new stack
– Executing [s@macro-dialout-trunk:13] Set(“OutgoingSpoolFailed”, “OUTNUM=failed”) in new stack
– Executing [s@macro-dialout-trunk:14] Set(“OutgoingSpoolFailed”, “custom=SIP/Sipgate”) in new stack
– Executing [s@macro-dialout-trunk:15] ExecIf(“OutgoingSpoolFailed”, “0?Set(DIAL_TRUNK_OPTIONS=M(setmusic^))”) in new stack
– Executing [s@macro-dialout-trunk:16] Macro(“OutgoingSpoolFailed”, “dialout-trunk-predial-hook,”) in new stack
– Executing [s@macro-dialout-trunk-predial-hook:1] MacroExit(“OutgoingSpoolFailed”, “”) in new stack
– Executing [s@macro-dialout-trunk:17] GotoIf(“OutgoingSpoolFailed”, “0?bypass,1”) in new stack
– Executing [s@macro-dialout-trunk:18] GotoIf(“OutgoingSpoolFailed”, “0?customtrunk”) in new stack
– Executing [s@macro-dialout-trunk:19] Dial(“OutgoingSpoolFailed”, “SIP/Sipgate/failed,300,”) in new stack
== Using SIP RTP TOS bits 184
== Using SIP RTP CoS mark 5
– Called Sipgate/failed
– SIP/Sipgate-0000000f is circuit-busy
== Everyone is busy/congested at this time (1:0/1/0)
– Executing [s@macro-dialout-trunk:20] NoOp(“OutgoingSpoolFailed”, “Dial failed for some reason with DIALSTATUS = CONGESTION and HANGUPCAUSE = 1”) in new stack
– Executing [s@macro-dialout-trunk:21] Goto(“OutgoingSpoolFailed”, “s-CONGESTION,1”) in new stack
– Goto (macro-dialout-trunk,s-CONGESTION,1)
– Executing [s-CONGESTION@macro-dialout-trunk:1] Set(“OutgoingSpoolFailed”, “RC=1”) in new stack
– Executing [s-CONGESTION@macro-dialout-trunk:2] Goto(“OutgoingSpoolFailed”, “1,1”) in new stack
– Goto (macro-dialout-trunk,1,1)
– Executing [1@macro-dialout-trunk:1] Goto(“OutgoingSpoolFailed”, “continue,1”) in new stack
– Goto (macro-dialout-trunk,continue,1)
– Executing [continue@macro-dialout-trunk:1] GotoIf(“OutgoingSpoolFailed”, “1?noreport”) in new stack
– Goto (macro-dialout-trunk,continue,3)
– Executing [continue@macro-dialout-trunk:3] NoOp(“OutgoingSpoolFailed”, “TRUNK Dial failed due to CONGESTION HANGUPCAUSE: 1 - failing through to other trunks”) in new stack
– Executing [continue@macro-dialout-trunk:4] Set(“OutgoingSpoolFailed”, “CALLERID(number)=”) in new stack
– Executing [failed@from-internal:5] Macro(“OutgoingSpoolFailed”, “outisbusy,”) in new stack
– Executing [s@macro-outisbusy:1] Progress(“OutgoingSpoolFailed”, “”) in new stack
– Executing [s@macro-outisbusy:2] GotoIf(“OutgoingSpoolFailed”, “0?emergency,1”) in new stack
– Executing [s@macro-outisbusy:3] GotoIf(“OutgoingSpoolFailed”, “0?intracompany,1”) in new stack
– Executing [s@macro-outisbusy:4] Playback(“OutgoingSpoolFailed”, “all-circuits-busy-now&pls-try-call-later, noanswer”) in new stack
– Executing [s@macro-outisbusy:5] Congestion(“OutgoingSpoolFailed”, “20”) in new stack
== Spawn extension (macro-outisbusy, s, 5) exited non-zero on ‘OutgoingSpoolFailed’ in macro ‘outisbusy’
== Spawn extension (from-internal, failed, 5) exited non-zero on ‘OutgoingSpoolFailed’
– Executing [h@from-internal:1] Macro(“OutgoingSpoolFailed”, “hangupcall”) in new stack
– Executing [s@macro-hangupcall:1] GotoIf(“OutgoingSpoolFailed”, “1?noautomon”) in new stack
– Goto (macro-hangupcall,s,3)
– Executing [s@macro-hangupcall:3] NoOp(“OutgoingSpoolFailed”, “TOUCH_MONITOR_OUTPUT=”) in new stack
– Executing [s@macro-hangupcall:4] GotoIf(“OutgoingSpoolFailed”, “1?skiprg”) in new stack
– Goto (macro-hangupcall,s,7)
– Executing [s@macro-hangupcall:7] GotoIf(“OutgoingSpoolFailed”, “1?skipblkvm”) in new stack
– Goto (macro-hangupcall,s,10)
– Executing [s@macro-hangupcall:10] GotoIf(“OutgoingSpoolFailed”, “1?theend”) in new stack
– Goto (macro-hangupcall,s,12)
– Executing [s@macro-hangupcall:12] Hangup(“OutgoingSpoolFailed”, “”) in new stack
== Spawn extension (macro-hangupcall, s, 12) exited non-zero on ‘OutgoingSpoolFailed’ in macro ‘hangupcall’
== Spawn extension (from-internal, h, 1) exited non-zero on ‘OutgoingSpoolFailed’

I use

Your problem starts here:

Usually this means one of two things:

1st The extension which should ring and afterwards should be connected to the outbound channel is not reachable for some reason or
2nd that Your callfile is trying to reach a non-existent extension in the given context (from-internal in this case).

Try to catch a callfile when You use this sceenario and analyze the content of this file. This should bring You to the solution. If You szill have trouble You may post the content of such a call-file here and probably we may asssisst You.

Wow…wow…just slowly:)
Yo are right, because that I have a big amount of failure calls. (about 40% calls is failed). I have very little knowledge about using call files. I have been use google and I found a a lot of things about creating call file.

How can I catch callfile ? Could you help me to create .call file or can you give me some direction what I must do?

This is my dialerd.log file. Maybe from it , you can see interesting information (event, response and reason)

[root@]# tail -f /opt/elastix/dialer/dialerd.log
[CallerIDNum] =>
[CallerIDName] =>
[AccountCode] =>
[Exten] =>
[Context] => from-trunk-sip-Sipgate
[Uniqueid] => 1314030052.9268
[local_timestamp_received] => 1314030052
)

2011-08-22 18:20:52 : (DialerProcess) DEBUG: EXIT OnNewchannel
2011-08-22 18:20:55 : (DialerProcess) DEBUG: con 20 de 20 muestras y 3 por omisión, campaña 95 tiene 19.25 segundos de marcado.
2011-08-22 18:20:55 : (DialerProcess) DEBUG: los siguientes agentes tienen llamadas agendadas:
2011-08-22 18:20:55 : (DialerProcess) DEBUG: (campania 95 cola 1100) todavia quedan 2 llamadas pendientes de OriginateResponse!
2011-08-22 18:20:55 : (DialerProcess) DEBUG: llamada 8071-95-295323 espera respuesta desde hace 24 segundos.
2011-08-22 18:20:55 : (DialerProcess) DEBUG: llamada 8071-95-295326 espera respuesta desde hace 3 segundos.
2011-08-22 18:20:55 : (DialerProcess) DEBUG: (campania 95 cola 1100) no hay agentes libres ni a punto de desocuparse!
2011-08-22 18:20:55 : (DialerProcess) DEBUG: con 20 de 20 muestras y 3 por omisión, campaña 98 tiene 20.95 segundos de marcado.
2011-08-22 18:20:55 : (DialerProcess) DEBUG: los siguientes agentes tienen llamadas agendadas:
2011-08-22 18:20:55 : (DialerProcess) DEBUG: (campania 98 cola 1200) todavia quedan 2 llamadas pendientes de OriginateResponse!
2011-08-22 18:20:55 : (DialerProcess) DEBUG: llamada 8071-98-300209 espera respuesta desde hace 6 segundos.
2011-08-22 18:20:55 : (DialerProcess) DEBUG: llamada 8071-98-300210 espera respuesta desde hace 3 segundos.
2011-08-22 18:20:55 : (DialerProcess) DEBUG: (campania 98 cola 1200) no hay agentes libres ni a punto de desocuparse!
2011-08-22 18:20:57 : (DialerProcess) DEBUG: ENTER OnLink
2011-08-22 18:20:57 : (DialerProcess) DEBUG: bridge:
params => Array
(
[Event] => Bridge
[Privilege] => call,all
[Bridgestate] => Link
[Bridgetype] => core
[Channel1] => SIP/106-00001606
[Channel2] => SIP/Sipgate-00001607
[Uniqueid1] => 1314030036.9260
[Uniqueid2] => 1314030036.9261
[CallerID1] => 4984149399489
[CallerID2] => 00492687494
[local_timestamp_received] => 1314030057
)

2011-08-22 18:20:57 : (DialerProcess) DEBUG: ENTER notificarLink
2011-08-22 18:20:57 : (DialerProcess) DEBUG: no se encuentra un agente llamado SIP/106-00001606 ni uno llamado SIP/Sipgate-00001607 en cache de agentes : Array
(
[Agent/116] => Array
(
[0] => 1100
[1] => 3500
)

[Agent/115] => Array
    (
        [0] => 1100
        [1] => 3500
    )

[Agent/114] => Array
    (
        [0] => 1100
        [1] => 3500
    )

[Agent/113] => Array
    (
        [0] => 1100
        [1] => 3500
    )

[Agent/112] => Array
    (
        [0] => 1100
        [1] => 3500
    )

[Agent/111] => Array
    (
        [0] => 1100
        [1] => 5001
        [2] => 3500
    )

[Agent/205] => Array
    (
        [0] => 7200
    )

[Agent/204] => Array
    (
        [0] => 7200
    )

[Agent/203] => Array
    (
        [0] => 7200
    )

[Agent/202] => Array
    (
        [0] => 7200
    )

[Agent/201] => Array
    (
        [0] => 7200
    )

[Agent/212] => Array
    (
        [0] => 1200
        [1] => 3500
    )

[Agent/211] => Array
    (
        [0] => 1200
        [1] => 3500
    )

[Agent/216] => Array
    (
        [0] => 1200
        [1] => 3500
    )

[Agent/215] => Array
    (
        [0] => 1200
        [1] => 3500
    )

[Agent/214] => Array
    (
        [0] => 1200
        [1] => 3500
    )

[Agent/213] => Array
    (
        [0] => 1200
        [1] => 3500
    )

[Agent/106] => Array
    (
        [0] => 7100
    )

[Agent/105] => Array
    (
        [0] => 7100
    )

[Agent/104] => Array
    (
        [0] => 7100
    )

[Agent/103] => Array
    (
        [0] => 7100
    )

[Agent/102] => Array
    (
        [0] => 7100
    )

[Agent/101] => Array
    (
        [0] => 7100
    )

)

2011-08-22 18:20:57 : (DialerProcess) DEBUG: EXIT notificarLink
2011-08-22 18:20:57 : (DialerProcess) DEBUG: bridge: evento no corresponde a llamadas monitoreadas!
2011-08-22 18:20:57 : (DialerProcess) DEBUG: EXIT OnLink
2011-08-22 18:20:58 : (DialerProcess) DEBUG: con 20 de 20 muestras y 3 por omisión, campaña 95 tiene 19.25 segundos de marcado.
2011-08-22 18:20:58 : (DialerProcess) DEBUG: los siguientes agentes tienen llamadas agendadas:
2011-08-22 18:20:58 : (DialerProcess) DEBUG: (campania 95 cola 1100) todavia quedan 2 llamadas pendientes de OriginateResponse!
2011-08-22 18:20:58 : (DialerProcess) DEBUG: llamada 8071-95-295323 espera respuesta desde hace 27 segundos.
2011-08-22 18:20:58 : (DialerProcess) DEBUG: llamada 8071-95-295326 espera respuesta desde hace 6 segundos.
2011-08-22 18:20:58 : (DialerProcess) DEBUG: (campania 95 cola 1100) no hay agentes libres ni a punto de desocuparse!
2011-08-22 18:20:58 : (DialerProcess) DEBUG: con 20 de 20 muestras y 3 por omisión, campaña 98 tiene 20.95 segundos de marcado.
2011-08-22 18:20:58 : (DialerProcess) DEBUG: los siguientes agentes tienen llamadas agendadas:
2011-08-22 18:20:58 : (DialerProcess) DEBUG: (campania 98 cola 1200) todavia quedan 2 llamadas pendientes de OriginateResponse!
2011-08-22 18:20:58 : (DialerProcess) DEBUG: llamada 8071-98-300209 espera respuesta desde hace 9 segundos.
2011-08-22 18:20:58 : (DialerProcess) DEBUG: llamada 8071-98-300210 espera respuesta desde hace 6 segundos.
2011-08-22 18:20:58 : (DialerProcess) DEBUG: (campania 98 cola 1200) no hay agentes libres ni a punto de desocuparse!
2011-08-22 18:21:00 : (DialerProcess) DEBUG: ENTER OnOriginateResponse
2011-08-22 18:21:00 : (DialerProcess) DEBUG: originateresponse:
params => Array
(
[Event] => OriginateResponse
[Privilege] => call,all
[ActionID] => 8071-98-300209
[Response] => Success
[Channel] => SIP/Sipgate-0000160a
[Context] => from-internal
[Exten] => 1200
[Reason] => 4
[Uniqueid] => 1314030049.9266
[CallerIDNum] => 4984149399489
[CallerIDName] =>
[local_timestamp_received] => 1314030060
)

2011-08-22 18:21:00 : (DialerProcess) DEBUG: llamada identificada es: 8071-98-300209 : stdClass Object
(
[id_campaign] => 98
[id] => 300209
[phone] => 073154387
[queue] => 1200
[OriginateStart] => 1314030049
[OriginateEnd] => 1314030060
[agent] =>
[Channel] =>
[OnHold] =>
[DialString] =>
[PendingEvents] =>
)

2011-08-22 18:21:00 : (DialerProcess) DEBUG: llamada colocada luego de 11 s. de espera.
2011-08-22 18:21:00 : (DialerProcess) DEBUG: EXIT OnOriginateResponse
2011-08-22 18:21:00 : (DialerProcess) DEBUG: ENTER OnJoin
2011-08-22 18:21:00 : (DialerProcess) DEBUG: join:
params => Array
(
[Event] => Join
[Privilege] => call,all
[Channel] => SIP/Sipgate-0000160a
[CallerIDNum] => 4984149399489
[CallerIDName] => unknown
[Queue] => 1200
[Position] => 1
[Count] => 1
[Uniqueid] => 1314030049.9266
[local_timestamp_received] => 1314030060
)

2011-08-22 18:21:00 : (DialerProcess) DEBUG: ENTER notificarJoin
2011-08-22 18:21:00 : (DialerProcess) DEBUG: EXIT notificarJoin
2011-08-22 18:21:00 : (DialerProcess) DEBUG: EXIT OnJoin
2011-08-22 18:21:00 : (DialerProcess) DEBUG: ENTER OnNewchannel
2011-08-22 18:21:00 : (DialerProcess) DEBUG: newchannel:
params => Array
(
[Event] => Newchannel
[Privilege] => call,all
[Channel] => Agent/214
[ChannelState] => 0
[ChannelStateDesc] => Down
[CallerIDNum] =>
[CallerIDName] =>
[AccountCode] =>
[Exten] => *8888214
[Context] => from-internal
[Uniqueid] => 1314030060.9269
[local_timestamp_received] => 1314030060
)

2011-08-22 18:21:00 : (DialerProcess) DEBUG: EXIT OnNewchannel
2011-08-22 18:21:00 : (DialerProcess) DEBUG: ENTER OnOriginateResponse
2011-08-22 18:21:00 : (DialerProcess) DEBUG: originateresponse:
params => Array
(
[Event] => OriginateResponse
[Privilege] => call,all
[ActionID] => 8071-95-295323
[Response] => Success
[Channel] => SIP/Sipgate-00001602
[Context] => from-internal
[Exten] => 1100
[Reason] => 4
[Uniqueid] => 1314030031.9255
[CallerIDNum] => 4984149399489
[CallerIDName] =>
[local_timestamp_received] => 1314030060
)

2011-08-22 18:21:00 : (DialerProcess) DEBUG: llamada identificada es: 8071-95-295323 : stdClass Object
(
[id_campaign] => 95
[id] => 295323
[phone] => 073466365
[queue] => 1100
[OriginateStart] => 1314030031
[OriginateEnd] => 1314030060
[agent] =>
[Channel] =>
[OnHold] =>
[DialString] =>
[PendingEvents] =>
)

2011-08-22 18:21:00 : (DialerProcess) DEBUG: llamada colocada luego de 29 s. de espera.
2011-08-22 18:21:00 : (DialerProcess) DEBUG: EXIT OnOriginateResponse
2011-08-22 18:21:00 : (DialerProcess) DEBUG: ENTER OnJoin
2011-08-22 18:21:00 : (DialerProcess) DEBUG: join:
params => Array
(
[Event] => Join
[Privilege] => call,all
[Channel] => SIP/Sipgate-00001602
[CallerIDNum] => 4984149399489
[CallerIDName] => unknown
[Queue] => 1100
[Position] => 1
[Count] => 1
[Uniqueid] => 1314030031.9255
[local_timestamp_received] => 1314030060
)

2011-08-22 18:21:00 : (DialerProcess) DEBUG: ENTER notificarJoin
2011-08-22 18:21:00 : (DialerProcess) DEBUG: EXIT notificarJoin
2011-08-22 18:21:00 : (DialerProcess) DEBUG: EXIT OnJoin
2011-08-22 18:21:00 : (DialerProcess) DEBUG: ENTER OnNewchannel
2011-08-22 18:21:00 : (DialerProcess) DEBUG: newchannel:
params => Array
(
[Event] => Newchannel
[Privilege] => call,all
[Channel] => Agent/112
[ChannelState] => 0
[ChannelStateDesc] => Down
[CallerIDNum] =>
[CallerIDName] =>
[AccountCode] =>
[Exten] => *8888112
[Context] => from-internal
[Uniqueid] => 1314030060.9270
[local_timestamp_received] => 1314030060
)

2011-08-22 18:21:00 : (DialerProcess) DEBUG: EXIT OnNewchannel
2011-08-22 18:21:00 : (DialerProcess) DEBUG: ENTER OnLink
2011-08-22 18:21:00 : (DialerProcess) DEBUG: bridge:
params => Array
(
[Event] => Bridge
[Privilege] => call,all
[Bridgestate] => Link
[Bridgetype] => core
[Channel1] => SIP/Sipgate-0000160a
[Channel2] => Agent/214
[Uniqueid1] => 1314030049.9266
[Uniqueid2] => 1314030060.9269
[CallerID1] => 4984149399489
[CallerID2] => 4984149399489
[local_timestamp_received] => 1314030060
)

2011-08-22 18:21:00 : (DialerProcess) DEBUG: ENTER notificarLink
2011-08-22 18:21:00 : (DialerProcess) DEBUG: cola(s) candidata(s) [1200 3500] no se encuentra en cache de colas monitoreadas: Array
(
[5] => 8005
)

2011-08-22 18:21:00 : (DialerProcess) DEBUG: EXIT notificarLink
2011-08-22 18:21:00 : (DialerProcess) DEBUG: bridge: llamada 8071-98-300209 => stdClass Object
(
[id_campaign] => 98
[id] => 300209
[phone] => 073154387
[queue] => 1200
[OriginateStart] => 1314030049
[OriginateEnd] => 1314030060
[agent] =>
[Channel] =>
[OnHold] =>
[DialString] =>
[PendingEvents] =>
[Uniqueid] => 1314030049.9266
[Response] => Success
[enterqueue_timestamp] => 1314030060
[start_timestamp] => 1314030060
[end_timestamp] =>
)

2011-08-22 18:21:00 : (DialerProcess) DEBUG: bridge: identificado agente 214
2011-08-22 18:21:00 : (DialerProcess) DEBUG: bridge: llamada 8071-98-300209 asignada a agente 214
2011-08-22 18:21:01 : (DialerProcess) DEBUG: bridge: llamada 8071-98-300209 para agente 214 acaba de ser insertada en current_calls
2011-08-22 18:21:01 : (DialerProcess) DEBUG: current_calls:
2011-08-22 18:21:01 : (DialerProcess) DEBUG: fecha_inicio Uniqueid queue agentnum id_call event Channel ChannelClient:
2011-08-22 18:21:01 : (DialerProcess) DEBUG: 2011-08-22 18:17:58 1314029868.9178 1200 215 300198 Link Agent/215 SIP/Sipgate-000015d3
2011-08-22 18:21:01 : (DialerProcess) DEBUG: 2011-08-22 18:20:29 1314030016.9252 1200 213 300208 Link Agent/213 SIP/Sipgate-00001601
2011-08-22 18:21:01 : (DialerProcess) DEBUG: 2011-08-22 18:20:48 1314030037.9262 1100 113 295324 Link Agent/113 SIP/Sipgate-00001608
2011-08-22 18:21:01 : (DialerProcess) DEBUG: 2011-08-22 18:21:00 1314030049.9266 1200 214 300209 Link Agent/214 SIP/Sipgate-0000160a
2011-08-22 18:21:01 : (DialerProcess) DEBUG: EXIT OnLink
2011-08-22 18:21:01 : (DialerProcess) DEBUG: con 20 de 20 muestras y 3 por omisión, campaña 95 tiene 19.25 segundos de marcado.
2011-08-22 18:21:01 : (DialerProcess) DEBUG: los siguientes agentes tienen llamadas agendadas:
2011-08-22 18:21:01 : (DialerProcess) DEBUG: (campania 95 cola 1100) todavia quedan 1 llamadas pendientes de OriginateResponse!
2011-08-22 18:21:01 : (DialerProcess) DEBUG: llamada 8071-95-295326 espera respuesta desde hace 9 segundos.
2011-08-22 18:21:01 : (DialerProcess) DEBUG: (campania 95 cola 1100) no hay agentes libres ni a punto de desocuparse!
2011-08-22 18:21:01 : (DialerProcess) DEBUG: con 20 de 20 muestras y 3 por omisión, campaña 98 tiene 20.60 segundos de marcado.
2011-08-22 18:21:01 : (DialerProcess) DEBUG: los siguientes agentes tienen llamadas agendadas:
2011-08-22 18:21:01 : (DialerProcess) DEBUG: (campania 98 cola 1200) todavia quedan 1 llamadas pendientes de OriginateResponse!
2011-08-22 18:21:01 : (DialerProcess) DEBUG: llamada 8071-98-300210 espera respuesta desde hace 9 segundos.
2011-08-22 18:21:01 : (DialerProcess) DEBUG: (campania 98 cola 1200) no hay agentes libres ni a punto de desocuparse!
2011-08-22 18:21:01 : (DialerProcess) DEBUG: ENTER OnLink
2011-08-22 18:21:01 : (DialerProcess) DEBUG: bridge:
params => Array
(
[Event] => Bridge
[Privilege] => call,all
[Bridgestate] => Link
[Bridgetype] => core
[Channel1] => SIP/Sipgate-00001602
[Channel2] => Agent/112
[Uniqueid1] => 1314030031.9255
[Uniqueid2] => 1314030060.9270
[CallerID1] => 4984149399489
[CallerID2] => 4984149399489
[local_timestamp_received] => 1314030061
)

2011-08-22 18:21:01 : (DialerProcess) DEBUG: ENTER notificarLink
2011-08-22 18:21:01 : (DialerProcess) DEBUG: cola(s) candidata(s) [1100 3500] no se encuentra en cache de colas monitoreadas: Array
(
[5] => 8005
)

2011-08-22 18:21:01 : (DialerProcess) DEBUG: EXIT notificarLink
2011-08-22 18:21:01 : (DialerProcess) DEBUG: bridge: llamada 8071-95-295323 => stdClass Object
(
[id_campaign] => 95
[id] => 295323
[phone] => 073466365
[queue] => 1100
[OriginateStart] => 1314030031
[OriginateEnd] => 1314030060
[agent] =>
[Channel] =>
[OnHold] =>
[DialString] =>
[PendingEvents] =>
[Uniqueid] => 1314030031.9255
[Response] => Success
[enterqueue_timestamp] => 1314030060
[start_timestamp] => 1314030061
[end_timestamp] =>
)

2011-08-22 18:21:01 : (DialerProcess) DEBUG: bridge: identificado agente 112
2011-08-22 18:21:01 : (DialerProcess) DEBUG: bridge: llamada 8071-95-295323 asignada a agente 112
2011-08-22 18:21:01 : (DialerProcess) DEBUG: bridge: llamada 8071-95-295323 para agente 112 acaba de ser insertada en current_calls
2011-08-22 18:21:01 : (DialerProcess) DEBUG: current_calls:
2011-08-22 18:21:01 : (DialerProcess) DEBUG: fecha_inicio Uniqueid queue agentnum id_call event Channel ChannelClient:
2011-08-22 18:21:01 : (DialerProcess) DEBUG: 2011-08-22 18:17:58 1314029868.9178 1200 215 300198 Link Agent/215 SIP/Sipgate-000015d3
2011-08-22 18:21:01 : (DialerProcess) DEBUG: 2011-08-22 18:20:29 1314030016.9252 1200 213 300208 Link Agent/213 SIP/Sipgate-00001601
2011-08-22 18:21:01 : (DialerProcess) DEBUG: 2011-08-22 18:20:48 1314030037.9262 1100 113 295324 Link Agent/113 SIP/Sipgate-00001608
2011-08-22 18:21:01 : (DialerProcess) DEBUG: 2011-08-22 18:21:00 1314030049.9266 1200 214 300209 Link Agent/214 SIP/Sipgate-0000160a
2011-08-22 18:21:01 : (DialerProcess) DEBUG: 2011-08-22 18:21:01 1314030031.9255 1100 112 295323 Link Agent/112 SIP/Sipgate-00001602
2011-08-22 18:21:01 : (DialerProcess) DEBUG: EXIT OnLink
2011-08-22 18:21:02 : (DialerProcess) DEBUG: ENTER OnUnlink
2011-08-22 18:21:02 : (DialerProcess) DEBUG: unlink:
params => Array
(
[Event] => Unlink
[Privilege] => call,all
[Channel1] => SIP/106-00001606
[Channel2] => SIP/Sipgate-00001607
[Uniqueid1] => 1314030036.9260
[Uniqueid2] => 1314030036.9261
[CallerID1] => 4984149399489
[CallerID2] => 00492687494
[local_timestamp_received] => 1314030062
)

2011-08-22 18:21:02 : (DialerProcess) DEBUG: EXIT OnUnlink
2011-08-22 18:21:02 : (DialerProcess) DEBUG: ENTER OnHangup
2011-08-22 18:21:02 : (DialerProcess) DEBUG: hangup:
params => Array
(
[Event] => Hangup
[Privilege] => call,all
[Channel] => SIP/Sipgate-00001607
[Uniqueid] => 1314030036.9261
[CallerIDNum] => 00492687494
[CallerIDName] =>
[Cause] => 16
[Cause-txt] => Normal Clearing
[local_timestamp_received] => 1314030062
)

2011-08-22 18:21:02 : (DialerProcess) DEBUG: ENTER notificarHangup
2011-08-22 18:21:02 : (DialerProcess) DEBUG: EXIT notificarHangup
2011-08-22 18:21:02 : (DialerProcess) DEBUG: EXIT OnHangup
2011-08-22 18:21:02 : (DialerProcess) DEBUG: ENTER OnDial
2011-08-22 18:21:02 : (DialerProcess) DEBUG: dial:
params => Array
(
[Event] => Dial
[Privilege] => call,all
[SubEvent] => End
[Channel] => SIP/106-00001606
[UniqueID] => 1314030036.9260
[DialStatus] => ANSWER
[local_timestamp_received] => 1314030062
)

2011-08-22 18:21:02 : (DialerProcess) DEBUG: EXIT OnDial
2011-08-22 18:21:02 : (DialerProcess) DEBUG: ENTER OnHangup
2011-08-22 18:21:02 : (DialerProcess) DEBUG: hangup:
params => Array
(
[Event] => Hangup
[Privilege] => call,all
[Channel] => SIP/106-00001606
[Uniqueid] => 1314030036.9260
[CallerIDNum] => 4984149399489
[CallerIDName] =>
[Cause] => 16
[Cause-txt] => Normal Clearing
[local_timestamp_received] => 1314030062
)

2011-08-22 18:21:02 : (DialerProcess) DEBUG: ENTER notificarHangup
2011-08-22 18:21:02 : (DialerProcess) DEBUG: EXIT notificarHangup
2011-08-22 18:21:02 : (DialerProcess) DEBUG: EXIT OnHangup
2011-08-22 18:21:03 : (DialerProcess) DEBUG: ENTER OnOriginateResponse
2011-08-22 18:21:03 : (DialerProcess) DEBUG: originateresponse:
params => Array
(
[Event] => OriginateResponse
[Privilege] => call,all
[ActionID] => 8071-95-295326
[Response] => Success
[Channel] => SIP/Sipgate-0000160b
[Context] => from-internal
[Exten] => 1100
[Reason] => 4
[Uniqueid] => 1314030052.9267
[CallerIDNum] => 4984149399489
[CallerIDName] =>
[local_timestamp_received] => 1314030063
)

2011-08-22 18:21:03 : (DialerProcess) DEBUG: llamada identificada es: 8071-95-295326 : stdClass Object
(
[id_campaign] => 95
[id] => 295326
[phone] => 07346922290
[queue] => 1100
[OriginateStart] => 1314030052
[OriginateEnd] => 1314030063
[agent] =>
[Channel] =>
[OnHold] =>
[DialString] =>
[PendingEvents] =>
)

2011-08-22 18:21:03 : (DialerProcess) DEBUG: llamada colocada luego de 11 s. de espera.
2011-08-22 18:21:03 : (DialerProcess) DEBUG: EXIT OnOriginateResponse
2011-08-22 18:21:03 : (DialerProcess) DEBUG: ENTER OnJoin
2011-08-22 18:21:03 : (DialerProcess) DEBUG: join:
params => Array
(
[Event] => Join
[Privilege] => call,all
[Channel] => SIP/Sipgate-0000160b
[CallerIDNum] => 4984149399489
[CallerIDName] => unknown
[Queue] => 1100
[Position] => 1
[Count] => 1
[Uniqueid] => 1314030052.9267
[local_timestamp_received] => 1314030063
)

2011-08-22 18:21:03 : (DialerProcess) DEBUG: ENTER notificarJoin
2011-08-22 18:21:03 : (DialerProcess) DEBUG: EXIT notificarJoin
2011-08-22 18:21:03 : (DialerProcess) DEBUG: EXIT OnJoin
2011-08-22 18:21:03 : (DialerProcess) DEBUG: ENTER OnNewchannel
2011-08-22 18:21:03 : (DialerProcess) DEBUG: newchannel:
params => Array
(
[Event] => Newchannel
[Privilege] => call,all
[Channel] => Agent/114
[ChannelState] => 0
[ChannelStateDesc] => Down
[CallerIDNum] =>
[CallerIDName] =>
[AccountCode] =>
[Exten] => *8888114
[Context] => from-internal
[Uniqueid] => 1314030063.9271
[local_timestamp_received] => 1314030063
)

2011-08-22 18:21:03 : (DialerProcess) DEBUG: EXIT OnNewchannel
2011-08-22 18:21:03 : (DialerProcess) DEBUG: ENTER OnLink
2011-08-22 18:21:03 : (DialerProcess) DEBUG: bridge:
params => Array
(
[Event] => Bridge
[Privilege] => call,all
[Bridgestate] => Link
[Bridgetype] => core
[Channel1] => SIP/Sipgate-0000160b
[Channel2] => Agent/114
[Uniqueid1] => 1314030052.9267
[Uniqueid2] => 1314030063.9271
[CallerID1] => 4984149399489
[CallerID2] => 4984149399489
[local_timestamp_received] => 1314030063
)

2011-08-22 18:21:03 : (DialerProcess) DEBUG: ENTER notificarLink
2011-08-22 18:21:03 : (DialerProcess) DEBUG: cola(s) candidata(s) [1100 3500] no se encuentra en cache de colas monitoreadas: Array
(
[5] => 8005
)

2011-08-22 18:21:03 : (DialerProcess) DEBUG: EXIT notificarLink
2011-08-22 18:21:03 : (DialerProcess) DEBUG: bridge: llamada 8071-95-295326 => stdClass Object
(
[id_campaign] => 95
[id] => 295326
[phone] => 07346922290
[queue] => 1100
[OriginateStart] => 1314030052
[OriginateEnd] => 1314030063
[agent] =>
[Channel] =>
[OnHold] =>
[DialString] =>
[PendingEvents] =>
[Uniqueid] => 1314030052.9267
[Response] => Success
[enterqueue_timestamp] => 1314030063
[start_timestamp] => 1314030063
[end_timestamp] =>
)

2011-08-22 18:21:03 : (DialerProcess) DEBUG: bridge: identificado agente 114
2011-08-22 18:21:03 : (DialerProcess) DEBUG: bridge: llamada 8071-95-295326 asignada a agente 114
2011-08-22 18:21:03 : (DialerProcess) DEBUG: bridge: llamada 8071-95-295326 para agente 114 acaba de ser insertada en current_calls
2011-08-22 18:21:03 : (DialerProcess) DEBUG: current_calls:
2011-08-22 18:21:03 : (DialerProcess) DEBUG: fecha_inicio Uniqueid queue agentnum id_call event Channel ChannelClient:
2011-08-22 18:21:03 : (DialerProcess) DEBUG: 2011-08-22 18:17:58 1314029868.9178 1200 215 300198 Link Agent/215 SIP/Sipgate-000015d3
2011-08-22 18:21:03 : (DialerProcess) DEBUG: 2011-08-22 18:20:29 1314030016.9252 1200 213 300208 Link Agent/213 SIP/Sipgate-00001601
2011-08-22 18:21:03 : (DialerProcess) DEBUG: 2011-08-22 18:20:48 1314030037.9262 1100 113 295324 Link Agent/113 SIP/Sipgate-00001608
2011-08-22 18:21:03 : (DialerProcess) DEBUG: 2011-08-22 18:21:00 1314030049.9266 1200 214 300209 Link Agent/214 SIP/Sipgate-0000160a
2011-08-22 18:21:03 : (DialerProcess) DEBUG: 2011-08-22 18:21:01 1314030031.9255 1100 112 295323 Link Agent/112 SIP/Sipgate-00001602
2011-08-22 18:21:03 : (DialerProcess) DEBUG: 2011-08-22 18:21:03 1314030052.9267 1100 114 295326 Link Agent/114 SIP/Sipgate-0000160b
2011-08-22 18:21:03 : (DialerProcess) DEBUG: EXIT OnLink
2011-08-22 18:21:04 : (DialerProcess) DEBUG: con 20 de 20 muestras y 3 por omisión, campaña 95 tiene 18.70 segundos de marcado.
2011-08-22 18:21:04 : (DialerProcess) DEBUG: los siguientes agentes tienen llamadas agendadas:
2011-08-22 18:21:04 : (DialerProcess) DEBUG: (campania 95 cola 1100) no hay agentes libres ni a punto de desocuparse!
2011-08-22 18:21:04 : (DialerProcess) DEBUG: con 20 de 20 muestras y 3 por omisión, campaña 98 tiene 20.60 segundos de marcado.
2011-08-22 18:21:04 : (DialerProcess) DEBUG: los siguientes agentes tienen llamadas agendadas:
2011-08-22 18:21:04 : (DialerProcess) DEBUG: (campania 98 cola 1200) todavia quedan 1 llamadas pendientes de OriginateResponse!
2011-08-22 18:21:04 : (DialerProcess) DEBUG: llamada 8071-98-300210 espera respuesta desde hace 12 segundos.
2011-08-22 18:21:04 : (DialerProcess) DEBUG: (campania 98 cola 1200) no hay agentes libres ni a punto de desocuparse!
2011-08-22 18:21:05 : (DialerProcess) DEBUG: ENTER OnUnlink
2011-08-22 18:21:05 : (DialerProcess) DEBUG: unlink:
params => Array
(
[Event] => Unlink
[Privilege] => call,all
[Channel1] => SIP/Sipgate-0000160b
[Channel2] => Agent/114
[Uniqueid1] => 1314030052.9267
[Uniqueid2] => 1314030063.9271
[CallerID1] => 4984149399489
[CallerID2] => 4984149399489
[local_timestamp_received] => 1314030065
)

2011-08-22 18:21:05 : (DialerProcess) DEBUG: EXIT OnUnlink
2011-08-22 18:21:05 : (DialerProcess) DEBUG: ENTER OnHangup
2011-08-22 18:21:05 : (DialerProcess) DEBUG: hangup:
params => Array
(
[Event] => Hangup
[Privilege] => call,all
[Channel] => Agent/114
[Uniqueid] => 1314030063.9271
[CallerIDNum] => 4984149399489
[CallerIDName] =>
[Cause] => 0
[Cause-txt] => Unknown
[local_timestamp_received] => 1314030065
)

2011-08-22 18:21:05 : (DialerProcess) DEBUG: ENTER notificarHangup
2011-08-22 18:21:05 : (DialerProcess) DEBUG: EXIT notificarHangup
2011-08-22 18:21:05 : (DialerProcess) DEBUG: EXIT OnHangup
2011-08-22 18:21:05 : (DialerProcess) DEBUG: ENTER OnHangup
2011-08-22 18:21:05 : (DialerProcess) DEBUG: hangup:
params => Array
(
[Event] => Hangup
[Privilege] => call,all
[Channel] => SIP/Sipgate-0000160b
[Uniqueid] => 1314030052.9267
[CallerIDNum] => 4984149399489
[CallerIDName] =>
[Cause] => 16
[Cause-txt] => Normal Clearing
[local_timestamp_received] => 1314030065
)

2011-08-22 18:21:05 : (DialerProcess) DEBUG: ENTER notificarHangup
2011-08-22 18:21:05 : (DialerProcess) DEBUG: EXIT notificarHangup
2011-08-22 18:21:05 : (DialerProcess) DEBUG: hangup: llamada 8071-95-295326 => stdClass Object
(
[id_campaign] => 95
[id] => 295326
[phone] => 07346922290
[queue] => 1100
[OriginateStart] => 1314030052
[OriginateEnd] => 1314030063
[agent] =>
[Channel] =>
[OnHold] =>
[DialString] =>
[PendingEvents] =>
[Uniqueid] => 1314030052.9267
[Response] => Success
[enterqueue_timestamp] => 1314030063
[start_timestamp] => 1314030063
[end_timestamp] => 1314030065
[ActualChannel] => SIP/Sipgate-0000160b
)

2011-08-22 18:21:05 : (DialerProcess) DEBUG: duración de la llamada fue de 2 s.
2011-08-22 18:21:05 : (DialerProcess) DEBUG: llamada fue identificada como llamada corta!
2011-08-22 18:21:05 : (DialerProcess) DEBUG: EXIT OnHangup
2011-08-22 18:21:07 : (DialerProcess) DEBUG: con 20 de 20 muestras y 3 por omisión, campaña 95 tiene 18.70 segundos de marcado.
2011-08-22 18:21:07 : (DialerProcess) DEBUG: los siguientes agentes tienen llamadas agendadas:
2011-08-22 18:21:07 : (DialerProcess) DEBUG: (campania 95 cola 1100) no hay agentes libres ni a punto de desocuparse!
2011-08-22 18:21:07 : (DialerProcess) DEBUG: con 20 de 20 muestras y 3 por omisión, campaña 98 tiene 20.60 segundos de marcado.
2011-08-22 18:21:07 : (DialerProcess) DEBUG: los siguientes agentes tienen llamadas agendadas:
2011-08-22 18:21:07 : (DialerProcess) DEBUG: (campania 98 cola 1200) todavia quedan 1 llamadas pendientes de OriginateResponse!
2011-08-22 18:21:07 : (DialerProcess) DEBUG: llamada 8071-98-300210 espera respuesta desde hace 15 segundos.
2011-08-22 18:21:07 : (DialerProcess) DEBUG: (campania 98 cola 1200) no hay agentes libres ni a punto de desocuparse!
2011-08-22 18:21:10 : (DialerProcess) DEBUG: con 20 de 20 muestras y 3 por omisión, campaña 95 tiene 18.70 segundos de marcado.
2011-08-22 18:21:10 : (DialerProcess) DEBUG: los siguientes agentes tienen llamadas agendadas:
2011-08-22 18:21:10 : (DialerProcess) DEBUG: (campania 95 cola 1100) no hay agentes libres ni a punto de desocuparse!
2011-08-22 18:21:10 : (DialerProcess) DEBUG: con 20 de 20 muestras y 3 por omisión, campaña 98 tiene 20.60 segundos de marcado.
2011-08-22 18:21:10 : (DialerProcess) DEBUG: los siguientes agentes tienen llamadas agendadas:
2011-08-22 18:21:10 : (DialerProcess) DEBUG: (campania 98 cola 1200) todavia quedan 1 llamadas pendientes de OriginateResponse!
2011-08-22 18:21:10 : (DialerProcess) DEBUG: llamada 8071-98-300210 espera respuesta desde hace 18 segundos.
2011-08-22 18:21:10 : (DialerProcess) DEBUG: (campania 98 cola 1200) no hay agentes libres ni a punto de desocuparse!
2011-08-22 18:21:11 : (DialerProcess) DEBUG: ENTER OnUnlink
2011-08-22 18:21:11 : (DialerProcess) DEBUG: unlink:
params => Array
(
[Event] => Unlink
[Privilege] => call,all
[Channel1] => SIP/Sipgate-00001602
[Channel2] => Agent/112
[Uniqueid1] => 1314030031.9255
[Uniqueid2] => 1314030060.9270
[CallerID1] => 4984149399489
[CallerID2] => 4984149399489
[local_timestamp_received] => 1314030071
)

2011-08-22 18:21:11 : (DialerProcess) DEBUG: EXIT OnUnlink
2011-08-22 18:21:11 : (DialerProcess) DEBUG: ENTER OnHangup
2011-08-22 18:21:11 : (DialerProcess) DEBUG: hangup:
params => Array
(
[Event] => Hangup
[Privilege] => call,all
[Channel] => Agent/112
[Uniqueid] => 1314030060.9270
[CallerIDNum] => 4984149399489
[CallerIDName] =>
[Cause] => 0
[Cause-txt] => Unknown
[local_timestamp_received] => 1314030071
)

2011-08-22 18:21:11 : (DialerProcess) DEBUG: ENTER notificarHangup
2011-08-22 18:21:11 : (DialerProcess) DEBUG: EXIT notificarHangup
2011-08-22 18:21:11 : (DialerProcess) DEBUG: EXIT OnHangup
2011-08-22 18:21:11 : (DialerProcess) DEBUG: ENTER OnHangup
2011-08-22 18:21:11 : (DialerProcess) DEBUG: hangup:
params => Array
(
[Event] => Hangup
[Privilege] => call,all
[Channel] => SIP/Sipgate-00001602
[Uniqueid] => 1314030031.9255
[CallerIDNum] => 4984149399489
[CallerIDName] =>
[Cause] => 16
[Cause-txt] => Normal Clearing
[local_timestamp_received] => 1314030071
)

2011-08-22 18:21:11 : (DialerProcess) DEBUG: ENTER notificarHangup
2011-08-22 18:21:11 : (DialerProcess) DEBUG: EXIT notificarHangup
2011-08-22 18:21:11 : (DialerProcess) DEBUG: hangup: llamada 8071-95-295323 => stdClass Object
(
[id_campaign] => 95
[id] => 295323
[phone] => 073466365
[queue] => 1100
[OriginateStart] => 1314030031
[OriginateEnd] => 1314030060
[agent] =>
[Channel] =>
[OnHold] =>
[DialString] =>
[PendingEvents] =>
[Uniqueid] => 1314030031.9255
[Response] => Success
[enterqueue_timestamp] => 1314030060
[start_timestamp] => 1314030061
[end_timestamp] => 1314030071
[ActualChannel] => SIP/Sipgate-00001602
)

2011-08-22 18:21:11 : (DialerProcess) DEBUG: duración de la llamada fue de 10 s.
2011-08-22 18:21:11 : (DialerProcess) DEBUG: luego de 431 llamadas: prom: 51.90 var: 14370.67 std.dev: 119.88
2011-08-22 18:21:11 : (DialerProcess) DEBUG: EXIT OnHangup
2011-08-22 18:21:13 : (DialerProcess) DEBUG: con 20 de 20 muestras y 3 por omisión, campaña 95 tiene 18.70 segundos de marcado.
2011-08-22 18:21:13 : (DialerProcess) DEBUG: los siguientes agentes tienen llamadas agendadas:
2011-08-22 18:21:13 : (DialerProcess) DEBUG: (campania 95 cola 1100) se pueden colocar un máximo de 1 llamadas…
2011-08-22 18:21:13 : (DialerProcess) DEBUG: (campania 95 cola 1100) total de llamadas a generar: 1
2011-08-22 18:21:13 : (DialerProcess) DEBUG: generando llamada
Clave… 8071-95-295327
Destino… 07346923969
Cola… 1100
Contexto… from-internal
Var. Contexto ID_CAMPAIGN=95,ID_CALL=295327,NUMBER=07346923969,QUEUE=1100,CONTEXT=from-internal
Trunk… SIP/Sipgate
Plantilla… SIP/Sipgate/$OUTNUM$
Caller ID… 4984149399489
Cadena de marcado SIP/Sipgate/07346923969
2011-08-22 18:21:13 : (DialerProcess) DEBUG: llamada generada: 8071-95-295327 SIP/Sipgate/07346923969

2011-08-22 18:21:13 : (DialerProcess) DEBUG: con 20 de 20 muestras y 3 por omisión, campaña 98 tiene 20.60 segundos de marcado.
2011-08-22 18:21:13 : (DialerProcess) DEBUG: los siguientes agentes tienen llamadas agendadas:
2011-08-22 18:21:13 : (DialerProcess) DEBUG: (campania 98 cola 1200) todavia quedan 1 llamadas pendientes de OriginateResponse!
2011-08-22 18:21:13 : (DialerProcess) DEBUG: llamada 8071-98-300210 espera respuesta desde hace 21 segundos.
2011-08-22 18:21:13 : (DialerProcess) DEBUG: (campania 98 cola 1200) no hay agentes libres ni a punto de desocuparse!
2011-08-22 18:21:13 : (DialerProcess) DEBUG: ENTER OnNewchannel
2011-08-22 18:21:13 : (DialerProcess) DEBUG: newchannel:
params => Array
(
[Event] => Newchannel
[Privilege] => call,all
[Channel] => SIP/Sipgate-0000160d
[ChannelState] => 0
[ChannelStateDesc] => Down
[CallerIDNum] =>
[CallerIDName] =>
[AccountCode] =>
[Exten] =>
[Context] => from-trunk-sip-Sipgate
[Uniqueid] => 1314030073.9272
[local_timestamp_received] => 1314030073
)

2011-08-22 18:21:13 : (DialerProcess) DEBUG: EXIT OnNewchannel
2011-08-22 18:21:13 : (DialerProcess) DEBUG: ENTER OnUnlink
2011-08-22 18:21:13 : (DialerProcess) DEBUG: unlink:
params => Array
(
[Event] => Unlink
[Privilege] => call,all
[Channel1] => SIP/Sipgate-00001601
[Channel2] => Agent/213
[Uniqueid1] => 1314030016.9252
[Uniqueid2] => 1314030028.9254
[CallerID1] => 4984149399489
[CallerID2] => 4984149399489
[local_timestamp_received] => 1314030073
)

2011-08-22 18:21:13 : (DialerProcess) DEBUG: EXIT OnUnlink
2011-08-22 18:21:13 : (DialerProcess) DEBUG: ENTER OnHangup
2011-08-22 18:21:13 : (DialerProcess) DEBUG: hangup:
params => Array
(
[Event] => Hangup
[Privilege] => call,all
[Channel] => Agent/213
[Uniqueid] => 1314030028.9254
[CallerIDNum] => 4984149399489
[CallerIDName] =>
[Cause] => 0
[Cause-txt] => Unknown
[local_timestamp_received] => 1314030073
)

2011-08-22 18:21:13 : (DialerProcess) DEBUG: ENTER notificarHangup
2011-08-22 18:21:13 : (DialerProcess) DEBUG: EXIT notificarHangup
2011-08-22 18:21:13 : (DialerProcess) DEBUG: EXIT OnHangup
2011-08-22 18:21:13 : (DialerProcess) DEBUG: ENTER OnHangup
2011-08-22 18:21:13 : (DialerProcess) DEBUG: hangup:
params => Array
(
[Event] => Hangup
[Privilege] => call,all
[Channel] => SIP/Sipgate-00001601
[Uniqueid] => 1314030016.9252
[CallerIDNum] => 4984149399489
[CallerIDName] =>
[Cause] => 16
[Cause-txt] => Normal Clearing
[local_timestamp_received] => 1314030073
)

2011-08-22 18:21:13 : (DialerProcess) DEBUG: ENTER notificarHangup
2011-08-22 18:21:13 : (DialerProcess) DEBUG: EXIT notificarHangup
2011-08-22 18:21:13 : (DialerProcess) DEBUG: hangup: llamada 8071-98-300208 => stdClass Object
(
[id_campaign] => 98
[id] => 300208
[phone] => 073154289
[queue] => 1200
[OriginateStart] => 1314030016
[OriginateEnd] => 1314030028
[agent] =>
[Channel] =>
[OnHold] =>
[DialString] =>
[PendingEvents] =>
[Uniqueid] => 1314030016.9252
[Response] => Success
[enterqueue_timestamp] => 1314030028
[start_timestamp] => 1314030029
[end_timestamp] => 1314030073
[ActualChannel] => SIP/Sipgate-00001601
)

2011-08-22 18:21:13 : (DialerProcess) DEBUG: duración de la llamada fue de 44 s.
2011-08-22 18:21:13 : (DialerProcess) DEBUG: luego de 287 llamadas: prom: 46.99 var: 5165.97 std.dev: 71.87
2011-08-22 18:21:13 : (DialerProcess) DEBUG: EXIT OnHangup
2011-08-22 18:21:15 : (DialerProcess) DEBUG: ENTER OnOriginateResponse
2011-08-22 18:21:15 : (DialerProcess) DEBUG: originateresponse:
params => Array
(
[Event] => OriginateResponse
[Privilege] => call,all
[ActionID] => 8071-98-300210
[Response] => Success
[Channel] => SIP/Sipgate-0000160c
[Context] => from-internal
[Exten] => 1200
[Reason] => 4
[Uniqueid] => 1314030052.9268
[CallerIDNum] => 4984149399489
[CallerIDName] =>
[local_timestamp_received] => 1314030075
)

2011-08-22 18:21:15 : (DialerProcess) DEBUG: llamada identificada es: 8071-98-300210 : stdClass Object
(
[id_campaign] => 98
[id] => 300210
[phone] => 073154392
[queue] => 1200
[OriginateStart] => 1314030052
[OriginateEnd] => 1314030075
[agent] =>
[Channel] =>
[OnHold] =>
[DialString] =>
[PendingEvents] =>
)

2011-08-22 18:21:15 : (DialerProcess) DEBUG: llamada colocada luego de 23 s. de espera.
2011-08-22 18:21:15 : (DialerProcess) DEBUG: EXIT OnOriginateResponse
2011-08-22 18:21:15 : (DialerProcess) DEBUG: ENTER OnJoin
2011-08-22 18:21:15 : (DialerProcess) DEBUG: join:
params => Array