We have a callflow menu that user complain cannot hear the voice prompt occasionally. Here is the trace.log at that instance and we notice that the time out event comes out immediately after the time out period 5 seconds. However, the voice prompt should have 30 seconds duration. i.e. we expected the timeout event occurs after 35 seconds instead of 5 seconds. The trace.log confirmed with user experience that system skip the playback occasionally. We wonder there is something wrong with the vxml. Any advice will be appreciated.

12/10/2013 17:04:10:603 DEBUG - 24E5E210AA702AC5A5534A8D10D74086:/corporate : *** Reply for [/corporate/DynamicMenu-dmenu] ***
==============================================
12/10/2013 17:04:10:603 DEBUG - 24E5E210AA702AC5A5534A8D10D74086:/corporate : 0:<?xml version="1.0" encoding="UTF-8"?>
1:<vxml version="2.1" xmlns="http://www.w3.org/2001/vxml" xml:lang="en-us">
2:<meta name="author" content="Avaya Aura Orchestration Designer"/>
3:<meta name="runtime-version" content="06.00.11.03"/>
4:<meta name="runtimecommon-version" content="06.00.11.03"/>
5:<meta name="copyright" content="Copyright (c) 2002-2011, Avaya"/>
6:<form id="dmenu">
7:<block>
8:</block>
9:<property name="maxnbest" value="1"/>
10:<var name="nbest" expr="1"/>
11:<var name="dmenu___value"/>
12:<var name="dmenu___confidence"/>
13:<var name="dmenu___utterance"/>
14:<var name="dmenu___inputmode"/>
15:<var name="dmenu___interpretation" expr="'undefined'"/>
16:<var name="dmenu___noinputcount" expr="'0'"/>
17:<var name="dmenu___nomatchcount" expr="'0'"/>
18:<var name="dmenu___dmenuid"/>
19:<var name="graminterp___dmenu" expr="'undefined'"/>
20:<field name="dmenu" modal="false">
21:<prompt bargein="true" bargeintype="speech" timeout="5000ms">
22:<audio src="http://10.252.136.221:7080//corporate/data/cantonese/phrases/1000.wav"/>
23:<audio src="http://10.252.136.221:7080//corporate/data/cantonese/phrases/1017.wav"/>
24:<audio src="http://10.252.136.221:7080//corporate/data/cantonese/phrases/7028.wav"/>
25:<audio src="http://10.252.136.221:7080/corporate/data/cantonese/phrases/9991.wav"/>
26:<audio src="http://10.252.136.221:7080/corporate/data/cantonese/phrases/1050.wav"/>
27:</prompt>
28:<grammar type="application/srgs+xml" mode="dtmf" root="dmenu" weight="1.0" xml:lang="en-us" version="1.0" tag-format="semantics/1.0-literals"><rule id="dmenu" scope="public"><ruleref uri="#dmenuid" /></rule><rule id="dmenuid" scope="private"><one-of><item>1<tag>1</tag></item><item>2<tag>2</tag></item><item>3<tag>3</tag></item><item>4<tag>4</tag></item><item>5<tag>5</tag></item><item>6<tag>6</tag></item><item>7<tag>7</tag></item><item>0<tag>0</tag></item><item>#<tag>#</tag></item><item>*<tag>*</tag></item></one-of></rule></grammar>
29:<catch event="noinput">
30:<assign name="_avayaNoinputCounter" expr="_avayaNoinputCounter + 1"/>
31:<assign name="dmenu___noinputcount" expr="try {_avayaNoinputCounter} catch (errMsg) {'0'}"/>
32:<assign name="dmenu___nomatchcount" expr="try {_avayaNomatchCounter} catch (errMsg) {'0'}"/>
33:<submit next="DynamicMenu-chkdmenutimeout?___DDSESSIONID=24E5E210AA702AC5A5534A8D10D74086%3A%2Fcorporate" namelist="dmenu___noinputcount dmenu___nomatchcount" method="post" enctype="multipart/form-data"/>
34:</catch>
35:<catch event="nomatch">
36:<assign name="_avayaNomatchCounter" expr="_avayaNomatchCounter + 1"/>
37:<assign name="dmenu___noinputcount" expr="try {_avayaNoinputCounter} catch (errMsg) {'0'}"/>
38:<assign name="dmenu___nomatchcount" expr="try {_avayaNomatchCounter} catch (errMsg) {'0'}"/>
39:<submit next="DynamicMenu-chkdmenuinvalid?___DDSESSIONID=24E5E210AA702AC5A5534A8D10D74086%3A%2Fcorporate" namelist="dmenu___noinputcount dmenu___nomatchcount" method="post" enctype="multipart/form-data"/>
40:</catch>
41:<filled>
42:<assign name="dmenu___confidence" expr="getnbest('confidence', nbest)"/>
43:<assign name="dmenu___utterance" expr="getnbest('utterance', nbest)"/>
44:<assign name="dmenu___inputmode" expr="getnbest('inputmode', nbest)"/>
45:<assign name="dmenu___dmenuid" expr="getnbest('interpretation.dmenuid', nbest)"/>
46:<assign name="graminterp___dmenu" expr="dmenu___dmenuid"/>
47:<if cond="containsUndefined(graminterp___dmenu) == false">
48: <assign name="dmenu___interpretation" expr="graminterp___dmenu"/>
49:</if>
50:<if cond="startswith(dmenu___interpretation, 'undefined') == true ">
51: <assign name="dmenu___interpretation" expr="getnbest('interpretation', nbest)"/>
52:</if>
53:<assign name="dmenu___value" expr="dmenu___interpretation"/>
54:<assign name="dmenu___noinputcount" expr="getnbestnmni(_avayaNoinputCounter, nbest)"/>
55:<assign name="dmenu___nomatchcount" expr="getnbestnmni(_avayaNomatchCounter, nbest)"/>
56:</filled>
57:</field>
58:<catch event="connection.disconnect">
59:<var name="dmenu___noinputcount" expr="try {_avayaNoinputCounter} catch (errMsg) {'0'}"/>
60:<var name="dmenu___nomatchcount" expr="try {_avayaNomatchCounter} catch (errMsg) {'0'}"/>
61:<assign name="dmenu___noinputcount" expr="try {_avayaNoinputCounter} catch (errMsg) {'0'}"/>
62:<assign name="dmenu___nomatchcount" expr="try {_avayaNomatchCounter} catch (errMsg) {'0'}"/>
63:<submit next="AvayaDefaultDisconnectHandler?___DDSESSIONID=24E5E210AA702AC5A5534A8D10D74086%3A%2Fcorporate" namelist="dmenu___noinputcount dmenu___nomatchcount" method="post" enctype="multipart/form-data"/>
64:</catch>
65:<block>
66:<submit next="DynamicMenu-dmenustore?___DDSESSIONID=24E5E210AA702AC5A5534A8D10D74086%3A%2Fcorporate" namelist="dmenu___value dmenu___confidence dmenu___utterance dmenu___inputmode dmenu___interpretation dmenu___noinputcount dmenu___nomatchcount dmenu___dmenuid" method="post"/>
67:</block>
68:</form>
69:</vxml>
70:
===================================
12/10/2013 17:04:15:675 INFO - 24E5E210AA702AC5A5534A8D10D74086:/corporate : Using SCESession 24E5E210AA702AC5A5534A8D10D74086:/corporate servlet : DynamicMenu-chkdmenutimeout
12/10/2013 17:04:15:675 INFO - 24E5E210AA702AC5A5534A8D10D74086:/corporate : Storing :dmenu___nomatchcount to complex: dmenu:nomatchcount as [0]
12/10/2013 17:04:15:675 INFO - 24E5E210AA702AC5A5534A8D10D74086:/corporate : Storing :dmenu___noinputcount to complex: dmenu:noinputcount as [1]
12/10/2013 17:04:15:675 INFO - 24E5E210AA702AC5A5534A8D10D74086:/corporate : Incrementing [dmenus:trial]
12/10/2013 17:04:15:675 INFO - 24E5E210AA702AC5A5534A8D10D74086:/corporate : Assigning [timeout] to [dmenus:error]
12/10/2013 17:04:15:675 INFO - 24E5E210AA702AC5A5534A8D10D74086:/corporate : [condition1] Expression [dmenus:trial] String Less Than [dtmfRetry]
12/10/2013 17:04:15:675 INFO - 24E5E210AA702AC5A5534A8D10D74086:/corporate : Using SCESession 24E5E210AA702AC5A5534A8D10D74086:/corporate servlet : DynamicMenu-dmenu
12/10/2013 17:04:15:676 INFO - 24E5E210AA702AC5A5534A8D10D74086:/corporate : [condition] Expression [dmenus:error] String Equal [timeout]
12/10/2013 17:04:15:676 INFO - 24E5E210AA702AC5A5534A8D10D74086:/corporate : [condition] Expression [dmenus:error] String Equal [invalid]
12/10/2013 17:04:15:676 INFO - 24E5E210AA702AC5A5534A8D10D74086:/corporate : [condition] Expression [vsnCount] Numeric Greater Than [1]
12/10/2013 17:04:15:676 INFO - 24E5E210AA702AC5A5534A8D10D74086:/corporate : [condition] Expression [vsnCount] Numeric Greater Than [2]
12/10/2013 17:04:15:676 INFO - 24E5E210AA702AC5A5534A8D10D74086:/corporate : [condition] Expression [vsnCount] Numeric Greater Than [3]
12/10/2013 17:04:15:676 INFO - 24E5E210AA702AC5A5534A8D10D74086:/corporate : [condition] Expression [TransferOperatorFlag] String Equal [0]
12/10/2013 17:04:15:676 INFO - 24E5E210AA702AC5A5534A8D10D74086:/corporate : [condition] Expression [IsOfficeHour] String Equal Ignorecase [yes]
12/10/2013 17:04:15:676 DEBUG - 24E5E210AA702AC5A5534A8D10D74086:/corporate : *** Reply for [/corporate/DynamicMenu-dmenu] ***

Your bargein is set to true, so if customer starts speaking input, the voice prompt will stop playing. Are you expecting any other behavior ?

We expected bargeIn by DTMF. Checking on the log, there is only timeout event, but not any input event. Do we set something wrong here?

Does it mean the playback was interrupted by unknown speech and it wait for DTMF input? How to we limit the bargeIn is DTMF only?

Can you post your AVB log ?

Do you mean the MPP traces under System Maintenance-TraceViewer of AAEP adminpage? If yes, we have not turned on any trace yet. Which category/trace level you need. If no, would you indicate where I can gather the log file?

No, I meant the VXI or voice browser log on the MPP.

Menu with 1050 does not play.
@2013-10-17 18:28:38,749||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|VXML_PROMPT_QUEUE
{
   dialogHandle: 131
   promptID: 150
   promptType: "P_AUDIO"
   language: "none"
   gender: "female"
   bargein: 1
   bargeinType: 0
   position: 0
   promptItem: "/opt/Avaya/ExperiencePortal/MPP/AVB/cache/swi_OSBinet/9/220.sbc131.BAK"
   absoluteURL: "http://10.252.136.221:7080/corporate/data/cantonese/phrases/1050.wav"
   vendorProps: <EMPTY>
   clipBegin: 0
   clipEnd: 2147483647
   repeatCount: 0
   repeatDur: 0
   gain: 0
   speed: 0
   outputModes: "audio video"
}
|chsaaep01####
@2013-10-17 18:28:38,749||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving Utility.cpp:469:LogIPCMessage|chsaaep01####
@2013-10-17 18:28:38,749||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving vpchannel.cpp:6497:SendMessage|chsaaep01####
@2013-10-17 18:28:38,749||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering vpchannel.cpp:6525:WaitForMessage|chsaaep01####
@2013-10-17 18:28:38,749||FINE|VB|16253|Session=chsaaep01-2013290102733-17|waiting for VXML_PROMPT_QUEUED|chsaaep01####
@2013-10-17 18:28:38,749||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = inet.sslMutualAuth Level = 1 value is STRING: no|chsaaep01####
@2013-10-17 18:28:38,749||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = inputmodes Level = 1 value is STRING: dtmf voice|chsaaep01####
@2013-10-17 18:28:38,749||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = maxnbest Level = 1 value is STRING: 1|chsaaep01####
@2013-10-17 18:28:38,749||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = maxspeechtimeout Level = 1 value is STRING: 5000ms|chsaaep01####
@2013-10-17 18:28:38,749||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = objectfetchhint Level = 1 value is STRING: prefetch|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = outputmodes Level = 1 value is STRING: audio video|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = scriptfetchhint Level = 1 value is STRING: prefetch|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = scriptmaxage Level = 1 value is STRING: 3600s|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = sensitivity Level = 1 value is STRING: 0.45|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = speedvsaccuracy Level = 1 value is STRING: 0.5|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = termchar Level = 1 value is STRING: #|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|VB|5017|Session=chsaaep01-2013290102733-17|******** Entering Dialog.cpp:337:QueueMessage|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = termtimeout Level = 1 value is STRING: 0s|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|VB|5017|Session=chsaaep01-2013290102733-17|******** Leaving Dialog.cpp:337:QueueMessage|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|VB|16252|Session=chsaaep01-2013290102733-17|******** Entering Dialog.cpp:348:ProcessInboundMessage|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|VB|16252|Session=chsaaep01-2013290102733-17|******** Entering vpchannel.cpp:5620:QueueMessage|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = timeout Level = 1 value is STRING: 5000ms|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|VB|16252|Session=chsaaep01-2013290102733-17|******** Leaving vpchannel.cpp:5620:QueueMessage|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|VB|16252|Session=chsaaep01-2013290102733-17|successfully added msg to channel queue|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|VB|16252|Session=chsaaep01-2013290102733-17|******** Leaving Dialog.cpp:348:ProcessInboundMessage|chsaaep01####
@2013-10-17 18:28:38,750||FINE|VB|16253|Session=chsaaep01-2013290102733-17|received the expected VXML_PROMPT_QUEUED|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering Utility.cpp:469:LogIPCMessage|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = xml:lang Level = 1 value is STRING: en-us|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|VXML_PROMPT_QUEUED
{
   dialogHandle: 131
   queueStatus: QUEUE_SUCCEEDED
}
|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving Utility.cpp:469:LogIPCMessage|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving vpchannel.cpp:6525:WaitForMessage|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|the send of PROMPT QUEUE succeeded|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = audiofetchhint Level = 0 value is STRING: prefetch|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving vpchannel.cpp:4155:PromptQueue|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = audiomaxage Level = 0 value is STRING: 3600s|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = bargein Level = 0 value is STRING: true|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = bargeintype Level = 0 value is STRING: speech|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = caching Level = 0 value is STRING: fast|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = completetimeout Level = 0 value is STRING: 1000ms|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = confidencelevel Level = 0 value is STRING: 0.25|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = datamaxage Level = 0 value is STRING: 3600s|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = documentfetchhint Level = 0 value is STRING: safe|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = documentmaxage Level = 0 value is STRING: 3600s|chsaaep01####
@2013-10-17 18:28:38,750||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = documentmaxstale Level = 0 value is STRING: 0s|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering vpchannel.cpp:1372:IsHangup|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|VPChannel::IsHangup returning FALSE|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving vpchannel.cpp:1372:IsHangup|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = fetchtimeout Level = 0 value is STRING: 15000ms|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering vpchannel.cpp:1372:IsHangup|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|VPChannel::IsHangup returning FALSE|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving vpchannel.cpp:1372:IsHangup|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = grammarfetchhint Level = 0 value is STRING: prefetch|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering VPrecGrammar.cpp:212:SetEnabled|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|grammar ID: 159, enabled: 1|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving VPrecGrammar.cpp:212:SetEnabled|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = grammarmaxage Level = 0 value is STRING: 3600s|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = incompletetimeout Level = 0 value is STRING: 1000ms|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = inet.authMode Level = 0 value is STRING: None|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering vpchannel.cpp:1372:IsHangup|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|VPChannel::IsHangup returning FALSE|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving vpchannel.cpp:1372:IsHangup|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering vpchannel.cpp:4119:KillFiller|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving vpchannel.cpp:4119:KillFiller|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering vpchannel.cpp:4584:PromptWait|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|VPChannel::PromptWait returning COMPLETE|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving vpchannel.cpp:4584:PromptWait|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = inet.basicAuthUserPwd Level = 0 value is STRING: :|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering vpchannel.cpp:1372:IsHangup|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|VPChannel::IsHangup returning FALSE|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving vpchannel.cpp:1372:IsHangup|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering vpchannel.cpp:4525:PromptPlay|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering vpchannel.cpp:6497:SendMessage|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = inet.sslMutualAuth Level = 0 value is STRING: no|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = inet.urlBase Level = 0 value is STRING: http://10.252.136.221:7080/corporate/route?___DDSESSIONID=76697CC2924AE09D8DA3989E78F13F9C%3A%2Fcorporate&report=0xAF36FB50|chsaaep01####
@2013-10-17 18:28:38,751||FINE|VB|16253|Session=chsaaep01-2013290102733-17|successfully sent message VXML_PROMPT_PLAY|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering Utility.cpp:469:LogIPCMessage|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = inputmodes Level = 0 value is STRING: dtmf voice|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|VXML_PROMPT_PLAY
{
   dialogHandle: 131
}
|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving Utility.cpp:469:LogIPCMessage|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving vpchannel.cpp:6497:SendMessage|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|the send of PROMPT PLAY succeeded|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|VPChannel::PromptPlay returning SUCCESS|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving vpchannel.cpp:4525:PromptPlay|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = maxnbest Level = 0 value is STRING: 1|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = maxspeechtimeout Level = 0 value is STRING: 5000ms|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = objectfetchhint Level = 0 value is STRING: prefetch|chsaaep01####
@2013-10-17 18:28:38,751||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = outputmodes Level = 0 value is STRING: audio video|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = scriptfetchhint Level = 0 value is STRING: prefetch|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = scriptmaxage Level = 0 value is STRING: 3600s|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = sensitivity Level = 0 value is STRING: 0.45|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = speedvsaccuracy Level = 0 value is STRING: 0.5|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = termchar Level = 0 value is STRING: #|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = termtimeout Level = 0 value is STRING: 0s|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = timeout Level = 0 value is STRING: 5000ms|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering vpchannel.cpp:4686:IsQueueEmpty|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving vpchannel.cpp:4686:IsQueueEmpty|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = vxi.prompt.audioReferences Level = 0 value is MAP: -->|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering vpchannel.cpp:1372:IsHangup|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = $_internalName_53133 Level = 1 value is MAP: -->|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|VPChannel::IsHangup returning FALSE|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving vpchannel.cpp:1372:IsHangup|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering vpchannel.cpp:4119:KillFiller|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving vpchannel.cpp:4119:KillFiller|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering vpchannel.cpp:1474:GetInputModes|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering VPrecGrammar.cpp:281:IsEnabled|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving VPrecGrammar.cpp:281:IsEnabled|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering VPrecGrammar.cpp:552:IsShell|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving VPrecGrammar.cpp:552:IsShell|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering VPrecGrammar.cpp:545:IsDTMF|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving VPrecGrammar.cpp:545:IsDTMF|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|grammarID: 159, DTMF true|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|ASR: 0, DTMF: 1|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving vpchannel.cpp:1474:GetInputModes|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = inet.maxage Level = 2 value is INTEGER: 3600|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering vpchannel.cpp:1514:SetRecogProperties|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = inet.prefetchHint Level = 2 value is STRING: prefetch|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering vpchannel.cpp:7042:ExtractVendorProperties|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = inet.timeoutDownload Level = 2 value is INTEGER: 15000|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = inet.timeoutIO Level = 2 value is INTEGER: 15000|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving vpchannel.cpp:7042:ExtractVendorProperties|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|key: allproperties, val: |chsaaep01####
@2013-10-17 18:28:38,752||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = vxi.prompt.audioReference.src Level = 2 value is STRING: http://10.252.136.221:7080//corporate/data/cantonese/phrases/1000.wav|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|key: com.avaya.avb.amobj, val: |chsaaep01####
@2013-10-17 18:28:38,752||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = $_internalName_53134 Level = 1 value is MAP: -->|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|key: inputmodes, val: dtmf voice|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = inet.maxage Level = 2 value is INTEGER: 3600|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|key: vxi.rec.confidenceLevel, val: 0.250000|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = inet.prefetchHint Level = 2 value is STRING: prefetch|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|key: vxi.rec.inputModes, val: 6|chsaaep01####
@2013-10-17 18:28:38,752||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = inet.timeoutDownload Level = 2 value is INTEGER: 15000|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|key: vxi.rec.language, val: en-us|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = inet.timeoutIO Level = 2 value is INTEGER: 15000|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|key: vxi.rec.maxnbest, val: 1|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = vxi.prompt.audioReference.src Level = 2 value is STRING: http://10.252.136.221:7080//corporate/data/cantonese/phrases/1017.wav|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|key: vxi.rec.sensitivity, val: 0.450000|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = vxi.prompt.language Level = 0 value is STRING: en-us|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|key: vxi.rec.speedVsAccuracy, val: 0.500000|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = xml:base Level = 0 value is STRING: |chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|key: vxi.rec.terminatorChar, val: #|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = xml:lang Level = 0 value is STRING: en-us|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|key: vxi.rec.timeout, val: 5000|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|Setting rec param <vxi.rec.timeout> to value <5000>|chsaaep01####
@2013-10-17 18:28:38,753||FINE|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1177:Found Media type to be: audio/x-wav|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|key: vxi.rec.timeoutComplete, val: 1000|chsaaep01####
@2013-10-17 18:28:38,753||FINE|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|Queuing Media: http://10.252.136.221:7080//corporate/data/cantonese/phrases/1017.wav|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|key: vxi.rec.timeoutIncomplete, val: 1000|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetChannel.cpp:312:SBinetChannel::Open: about to open stream|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|key: vxi.rec.timeoutMaxSpeech, val: 5000|chsaaep01####
@2013-10-17 18:28:38,753||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetStream::getCacheInfo: maxAge=3600maxStale=-1|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|key: vxi.rec.timeoutTerminator, val: 0|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|Setting rec param <vxi.rec.timeoutTerminator> to value <0>|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|Setting rec param <vxi.rec.timeoutComplete> to value <1000>|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|Setting rec param <vxi.rec.timeoutIncomplete> to value <1000>|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering vpchannel.cpp:6861:GetDTMFDigitLength|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering VPrecGrammar.cpp:281:IsEnabled|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving VPrecGrammar.cpp:281:IsEnabled|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering VPrecGrammar.cpp:520:GetDTMFLength|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving VPrecGrammar.cpp:520:GetDTMFLength|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving vpchannel.cpp:6861:GetDTMFDigitLength|chsaaep01####
@2013-10-17 18:28:38,753||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetValidator::Log: entering: URL=http://10.252.136.221:7080//corporate/data/cantonese/phrases/1017.wav, refTime=Thu Oct 17 18:28:33 2013
, lastModifiedStr=Tue Oct 15 12:50:00 2013
, expireStr=Thu Jan 1 08:00:00 1970
, must revalidate=false, size=29342, etag=W/"29342-1381812600000"|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|Setting rec param <vxi.rec.dtmfMaxLen> to value <1>|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|Setting rec param <vxi.rec.terminatorChar> to value <#>|chsaaep01####
@2013-10-17 18:28:38,753||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetValidator.cpp:593:SBinetValidator::isExpired() Current Time = 1382005718 Reference Time = 1382005713|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|Setting rec param <vxi.rec.timeoutInterdigit> to value <3000>|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering vpchannel.cpp:6497:SendMessage|chsaaep01####
@2013-10-17 18:28:38,753||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetValidator.cpp:611:SBinetValidator::isExpired() Freshness Time = 0 staleness = 5 mustRevalidate = FALSE Expires Time = -1 maxage = 3600 maxstale = -1|chsaaep01####
@2013-10-17 18:28:38,753||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetHttpCacheStream::readValidatorFromCache: Validator expired, url=http://10.252.136.221:7080//corporate/data/cantonese/phrases/1017.wav|chsaaep01####
@2013-10-17 18:28:38,753||FINE|VB|16253|Session=chsaaep01-2013290102733-17|successfully sent message VXML_REC_SET_PARAMS|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering Utility.cpp:469:LogIPCMessage|chsaaep01####
@2013-10-17 18:28:38,753||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetValidator.cpp:593:SBinetValidator::isExpired() Current Time = 1382005718 Reference Time = 1382005713|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|VXML_REC_SET_PARAMS
{
   dialogHandle: 131
   nameValueList: [
      vxi.rec.timeout: "5000"
      vxi.rec.timeoutTerminator: "0"
      vxi.rec.timeoutComplete: "1000"
      vxi.rec.timeoutIncomplete: "1000"
      vxi.rec.dtmfMaxLen: "1"
      vxi.rec.terminatorChar: "#"
      vxi.rec.timeoutInterdigit: "3000"
   ]
}
|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving Utility.cpp:469:LogIPCMessage|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Leaving vpchannel.cpp:6497:SendMessage|chsaaep01####
@2013-10-17 18:28:38,753||FINEST|VB|16253|Session=chsaaep01-2013290102733-17|******** Entering vpchannel.cpp:6525:WaitForMessage|chsaaep01####
@2013-10-17 18:28:38,753||FINE|VB|16253|Session=chsaaep01-2013290102733-17|waiting for VXML_REC_PARAMS_SET|chsaaep01####
@2013-10-17 18:28:38,753||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetValidator.cpp:611:SBinetValidator::isExpired() Freshness Time = 0 staleness = 5 mustRevalidate = FALSE Expires Time = -1 maxage = 3600 maxstale = -1|chsaaep01####
@2013-10-17 18:28:38,754||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetHttpCacheStream::Open: Validator expired: url=http://10.252.136.221:7080//corporate/data/cantonese/phrases/1017.wav|chsaaep01####
@2013-10-17 18:28:38,754||FINEST|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetHttpStream::initSocket enter|chsaaep01####
@2013-10-17 18:28:38,754||FINEST|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetChannel::getHttpConnection Called url=http://10.252.136.221:7080//corporate/data/cantonese/phrases/1017.wav|chsaaep01####
@2013-10-17 18:28:38,754||FINEST|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetChannel::getHttpConnection getNPath=//corporate/data/cantonese/phrases/1017.wav|chsaaep01####
@2013-10-17 18:28:38,754||FINEST|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetHttpStream.cpp:156:SBinetHttpStream::initSocket, Connect to socket, time=0|chsaaep01####
@2013-10-17 18:28:38,754||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetStream::getCacheInfo: maxAge=3600maxStale=-1|chsaaep01####
@2013-10-17 18:28:38,754||FINEST|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetCookie.cpp:73:SBinetCookie::matchDomain called cdomain=10.252.136.221domain=10.252.136.221true|chsaaep01####
@2013-10-17 18:28:38,754||FINEST|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetCookie.cpp:133:SBinetCookie::matchPath cpath=/corporate, path=//corporate/data/cantonese/phrases/1017.wavfalse|chsaaep01####
@2013-10-17 18:28:38,754||FINEST|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetCookie.cpp:163:SBinetCookie::matchRequest match=false, domain=10.252.136.221, path=//corporate/data/cantonese/phrases/1017.wav, _Name=JSESSIONID, _Value=76697CC2924AE09D8DA3989E78F13F9C, _Name=JSESSIONID, _Domain=10.252.136.221, _Path=/corporate, expires=Thu Jan 1 08:00:00 1970
, _nExpires=0false|chsaaep01####
@2013-10-17 18:28:38,754||FINEST|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetCookie.cpp:73:SBinetCookie::matchDomain called cdomain=10.252.136.221domain=10.252.136.221true|chsaaep01####
@2013-10-17 18:28:38,754||FINEST|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetCookie.cpp:133:SBinetCookie::matchPath cpath=/, path=//corporate/data/cantonese/phrases/1017.wavtrue|chsaaep01####
@2013-10-17 18:28:38,754||FINEST|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetCookie.cpp:163:SBinetCookie::matchRequest match=true, domain=10.252.136.221, path=//corporate/data/cantonese/phrases/1017.wav, _Name=___DDSESSIONID, _Value=76697CC2924AE09D8DA3989E78F13F9C%3A%2Fcorporate, _Name=___DDSESSIONID, _Domain=10.252.136.221, _Path=/, expires=Thu Jan 1 08:00:00 1970
, _nExpires=0false|chsaaep01####
@2013-10-17 18:28:38,754||FINE|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetHttpStream.cpp:1384:SBinetHttpStream::getHeaderInfo: Waited 0ms for HTTP response|chsaaep01####
@2013-10-17 18:28:38,754||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetHttpStream.cpp:1245:SBinetChannel::getHeader: header=Server|chsaaep01####
@2013-10-17 18:28:38,754||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetHttpStream.cpp:1191:SBinetChannel::getValue: value=Apache-Coyote/1.1|chsaaep01####
@2013-10-17 18:28:38,754||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetHttpStream.cpp:1245:SBinetChannel::getHeader: header=ETag|chsaaep01####
@2013-10-17 18:28:38,754||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetHttpStream.cpp:1191:SBinetChannel::getValue: value=W/"29342-1381812600000"|chsaaep01####
@2013-10-17 18:28:38,754||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetHttpStream.cpp:1245:SBinetChannel::getHeader: header=Date|chsaaep01####
@2013-10-17 18:28:38,754||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetHttpStream.cpp:1191:SBinetChannel::getValue: value=Thu, 17 Oct 2013 10:28:38 GMT|chsaaep01####
@2013-10-17 18:28:38,754||FINE|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetHttpStream.cpp:1390:SBinetHttpStream::getHeaderInfo: rc=0, HttpStatus=304|chsaaep01####
@2013-10-17 18:28:38,754||FINE|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|Cache copy is up to date - reusing cache copy of http://10.252.136.221:7080//corporate/data/cantonese/phrases/1017.wav|chsaaep01####
@2013-10-17 18:28:38,754||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetValidator.cpp:682:SBinetValidator::checkPragma No Pragma directive.|chsaaep01####
@2013-10-17 18:28:38,754||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetValidator.cpp:708:SBinetValidator::checkCacheControl: No Cache-Control directive.|chsaaep01####
@2013-10-17 18:28:38,754||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetValidator.cpp:312:SBinetValidator::computeFreshnessLifetime, freshnessLifeTime=0|chsaaep01####
@2013-10-17 18:28:38,754||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetValidator.cpp:682:SBinetValidator::checkPragma No Pragma directive.|chsaaep01####
@2013-10-17 18:28:38,754||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetValidator.cpp:708:SBinetValidator::checkCacheControl: No Cache-Control directive.|chsaaep01####
@2013-10-17 18:28:38,754||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetValidator::Log: entering: URL=http://10.252.136.221:7080//corporate/data/cantonese/phrases/1017.wav, refTime=Thu Oct 17 18:28:38 2013
, lastModifiedStr=-1, expireStr=Thu Jan 1 08:00:00 1970
, must revalidate=false, size=4294967295, etag=W/"29342-1381812600000"|chsaaep01####
@2013-10-17 18:28:38,754||FINEST|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetChannel.cpp:1872:SBinetChannel::putHttpConnection called|chsaaep01####
@2013-10-17 18:28:38,754||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetValidator.cpp:682:SBinetValidator::checkPragma No Pragma directive.|chsaaep01####
@2013-10-17 18:28:38,754||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetValidator.cpp:708:SBinetValidator::checkCacheControl: No Cache-Control directive.|chsaaep01####
@2013-10-17 18:28:38,754||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetValidator.cpp:312:SBinetValidator::computeFreshnessLifetime, freshnessLifeTime=0|chsaaep01####
@2013-10-17 18:28:38,754||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetValidator.cpp:682:SBinetValidator::checkPragma No Pragma directive.|chsaaep01####
@2013-10-17 18:28:38,754||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetValidator.cpp:708:SBinetValidator::checkCacheControl: No Cache-Control directive.|chsaaep01####
@2013-10-17 18:28:38,755||FINER|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBcacheInterface::Open Using cache key 4pNSYcQ2qfkyQYGt0gHyCt== for URL swi:swi:OSBinet:http://10.252.136.221:7080//corporate/data/cantonese/phrases/1017.wav|chsaaep01####
@2013-10-17 18:28:38,755||FINEST|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBinetChannel.cpp:315:stream open returns 0|chsaaep01####
@2013-10-17 18:28:38,755||FINE|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:529:AVBpromptQueue() - mime type: audio/x-wav|chsaaep01####
@2013-10-17 18:28:38,755||FINER|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|BufferTranscoder.cpp:122:Input format sat to Wave|chsaaep01####
@2013-10-17 18:28:38,755||FINER|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|BufferTranscoder.cpp:95:Output format sat to Wave-mulaw|chsaaep01####
@2013-10-17 18:28:38,755||FINER|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|Setting absolute URL to http://10.252.136.221:7080//corporate/data/cantonese/phrases/1017.wav|chsaaep01####
@2013-10-17 18:28:38,755||FINER|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|Setting cache key to http://10.252.136.221:7080//corporate/data/cantonese/phrases/1017.wav_transcoded_wave_mulaw|chsaaep01####
@2013-10-17 18:28:38,755||FINEST|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBcacheInterface::GetCacheEntryURI(): Found URI for cache key swi:swi:OSBinet:http://10.252.136.221:7080//corporate/data/cantonese/phrases/1017.wav_transcoded_wave_mulaw key edUYSzF48l2ju6SU6uEIB3== to be /opt/Avaya/ExperiencePortal/MPP/AVB/cache/swi_OSBinet/9/224.sbc|chsaaep01####
@2013-10-17 18:28:38,755||FINER|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|BufferTranscoder.cpp:517:Transcoding is NOT needed|chsaaep01####
@2013-10-17 18:28:38,755||FINEST|CommonVXI.Cache|4954|Session=chsaaep01-2013290102733-17|SBcacheStream::Close(): Leaving, rc=0|chsaaep01####
@2013-10-17 18:28:38,755||FINE|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|Queuing Audio - URL: http://10.252.136.221:7080//corporate/data/cantonese/phrases/1017.wav Local file: /opt/Avaya/ExperiencePortal/MPP/AVB/cache/swi_OSBinet/9/224.sbc|chsaaep01####
@2013-10-17 18:28:38,755||FINE|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|Absolute prompt URL: http://10.252.136.221:7080//corporate/data/cantonese/phrases/1017.wav|chsaaep01####
@2013-10-17 18:28:38,755||FINE|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1212:AVBpromptQueue: WAV properties|chsaaep01####
@2013-10-17 18:28:38,755||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = absoluteURI Level = 0 value is STRING: http://10.252.136.221:7080/corporate/route?___DDSESSIONID=76697CC2924AE09D8DA3989E78F13F9C%3A%2Fcorporate&report=0xAF36FB50|chsaaep01####
@2013-10-17 18:28:38,755||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = base Level = 0 value is STRING: http://10.252.136.221:7080/corporate/route?___DDSESSIONID=76697CC2924AE09D8DA3989E78F13F9C%3A%2Fcorporate&report=0xAF36FB50|chsaaep01####
@2013-10-17 18:28:38,755||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = lang Level = 0 value is STRING: en-us|chsaaep01####
@2013-10-17 18:28:38,755||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = allproperties Level = 0 value is MAP: -->|chsaaep01####
@2013-10-17 18:28:38,755||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = absoluteURI Level = 1 value is STRING: http://10.252.136.221:7080/corporate/route?___DDSESSIONID=76697CC2924AE09D8DA3989E78F13F9C%3A%2Fcorporate&report=0xAF36FB50|chsaaep01####
@2013-10-17 18:28:38,755||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = base Level = 1 value is STRING: http://10.252.136.221:7080/corporate/route?___DDSESSIONID=76697CC2924AE09D8DA3989E78F13F9C%3A%2Fcorporate&report=0xAF36FB50|chsaaep01####
@2013-10-17 18:28:38,755||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = lang Level = 1 value is STRING: en-us|chsaaep01####
@2013-10-17 18:28:38,755||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = audiofetchhint Level = 1 value is STRING: prefetch|chsaaep01####
@2013-10-17 18:28:38,755||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = audiomaxage Level = 1 value is STRING: 3600s|chsaaep01####
@2013-10-17 18:28:38,755||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = bargein Level = 1 value is STRING: true|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = caching Level = 1 value is STRING: fast|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = completetimeout Level = 1 value is STRING: 1000ms|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = confidencelevel Level = 1 value is STRING: 0.25|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = datamaxage Level = 1 value is STRING: 3600s|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = documentfetchhint Level = 1 value is STRING: safe|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = documentmaxage Level = 1 value is STRING: 3600s|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = documentmaxstale Level = 1 value is STRING: 0s|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = fetchtimeout Level = 1 value is STRING: 15000ms|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = grammarfetchhint Level = 1 value is STRING: prefetch|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = grammarmaxage Level = 1 value is STRING: 3600s|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = incompletetimeout Level = 1 value is STRING: 1000ms|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = inet.authMode Level = 1 value is STRING: None|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = inet.basicAuthUserPwd Level = 1 value is STRING: :|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = inet.sslMutualAuth Level = 1 value is STRING: no|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = inputmodes Level = 1 value is STRING: dtmf voice|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = maxnbest Level = 1 value is STRING: 1|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = maxspeechtimeout Level = 1 value is STRING: 5000ms|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = objectfetchhint Level = 1 value is STRING: prefetch|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = outputmodes Level = 1 value is STRING: audio video|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = scriptfetchhint Level = 1 value is STRING: prefetch|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = scriptmaxage Level = 1 value is STRING: 3600s|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = sensitivity Level = 1 value is STRING: 0.45|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = speedvsaccuracy Level = 1 value is STRING: 0.5|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = termchar Level = 1 value is STRING: #|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = termtimeout Level = 1 value is STRING: 0s|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = timeout Level = 1 value is STRING: 5000ms|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = xml:lang Level = 1 value is STRING: en-us|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = audiofetchhint Level = 0 value is STRING: prefetch|chsaaep01####
@2013-10-17 18:28:38,756||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = audiomaxage Level = 0 value is STRING: 3600s|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = bargein Level = 0 value is STRING: true|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = bargeintype Level = 0 value is STRING: speech|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = caching Level = 0 value is STRING: fast|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = completetimeout Level = 0 value is STRING: 1000ms|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = confidencelevel Level = 0 value is STRING: 0.25|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = datamaxage Level = 0 value is STRING: 3600s|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = documentfetchhint Level = 0 value is STRING: safe|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = documentmaxage Level = 0 value is STRING: 3600s|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = documentmaxstale Level = 0 value is STRING: 0s|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = fetchtimeout Level = 0 value is STRING: 15000ms|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = grammarfetchhint Level = 0 value is STRING: prefetch|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = grammarmaxage Level = 0 value is STRING: 3600s|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = incompletetimeout Level = 0 value is STRING: 1000ms|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = inet.authMode Level = 0 value is STRING: None|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = inet.basicAuthUserPwd Level = 0 value is STRING: :|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = inet.info.absoluteName Level = 0 value is STRING: http://10.252.136.221:7080//corporate/data/cantonese/phrases/1017.wav|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = inet.sslMutualAuth Level = 0 value is STRING: no|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = inet.urlBase Level = 0 value is STRING: http://10.252.136.221:7080/corporate/route?___DDSESSIONID=76697CC2924AE09D8DA3989E78F13F9C%3A%2Fcorporate&report=0xAF36FB50|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = inputmodes Level = 0 value is STRING: dtmf voice|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = maxnbest Level = 0 value is STRING: 1|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = maxspeechtimeout Level = 0 value is STRING: 5000ms|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = objectfetchhint Level = 0 value is STRING: prefetch|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = outputmodes Level = 0 value is STRING: audio video|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = scriptfetchhint Level = 0 value is STRING: prefetch|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = scriptmaxage Level = 0 value is STRING: 3600s|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = sensitivity Level = 0 value is STRING: 0.45|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = speedvsaccuracy Level = 0 value is STRING: 0.5|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = termchar Level = 0 value is STRING: #|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = termtimeout Level = 0 value is STRING: 0s|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = timeout Level = 0 value is STRING: 5000ms|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = vxi.prompt.audioReferences Level = 0 value is MAP: -->|chsaaep01####
@2013-10-17 18:28:38,757||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = $_internalName_53133 Level = 1 value is MAP: -->|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = inet.maxage Level = 2 value is INTEGER: 3600|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = inet.prefetchHint Level = 2 value is STRING: prefetch|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = inet.timeoutDownload Level = 2 value is INTEGER: 15000|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = inet.timeoutIO Level = 2 value is INTEGER: 15000|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = vxi.prompt.audioReference.src Level = 2 value is STRING: http://10.252.136.221:7080//corporate/data/cantonese/phrases/1000.wav|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = $_internalName_53134 Level = 1 value is MAP: -->|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = inet.maxage Level = 2 value is INTEGER: 3600|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = inet.prefetchHint Level = 2 value is STRING: prefetch|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = inet.timeoutDownload Level = 2 value is INTEGER: 15000|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = inet.timeoutIO Level = 2 value is INTEGER: 15000|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = vxi.prompt.audioReference.src Level = 2 value is STRING: http://10.252.136.221:7080//corporate/data/cantonese/phrases/1017.wav|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = vxi.prompt.language Level = 0 value is STRING: en-us|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = xml:base Level = 0 value is STRING: |chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Prompt|4954|Session=chsaaep01-2013290102733-17|osbprompt.cpp:1214:Key = xml:lang Level = 0 value is STRING: en-us|chsaaep01####
@2013-10-17 18:28:38,758||FINE|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager::AddSegment() - queuing segment type: Audio platform returned: 0|chsaaep01####
@2013-10-17 18:28:38,758||FINER|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:905:PromptManager::Bargein is enabled for the prompt|chsaaep01####
@2013-10-17 18:28:38,758||FINER|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:906:PromptManager::AddSegment() - no Play() because bargein is enabled|chsaaep01####
@2013-10-17 18:28:38,758||FINER|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PropertyList.cpp:501:PropertyList::GetFetchobjCacheAttrs - (audiomaxage) of (3600s)|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:677:PromptManager::AddSegment() - Dumping VXI properties...|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = absoluteURI Level = 0 value is STRING: http://10.252.136.221:7080/corporate/route?___DDSESSIONID=76697CC2924AE09D8DA3989E78F13F9C%3A%2Fcorporate&report=0xAF36FB50|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = base Level = 0 value is STRING: http://10.252.136.221:7080/corporate/route?___DDSESSIONID=76697CC2924AE09D8DA3989E78F13F9C%3A%2Fcorporate&report=0xAF36FB50|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = lang Level = 0 value is STRING: en-us|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = allproperties Level = 0 value is MAP: -->|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = absoluteURI Level = 1 value is STRING: http://10.252.136.221:7080/corporate/route?___DDSESSIONID=76697CC2924AE09D8DA3989E78F13F9C%3A%2Fcorporate&report=0xAF36FB50|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = base Level = 1 value is STRING: http://10.252.136.221:7080/corporate/route?___DDSESSIONID=76697CC2924AE09D8DA3989E78F13F9C%3A%2Fcorporate&report=0xAF36FB50|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = lang Level = 1 value is STRING: en-us|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = audiofetchhint Level = 1 value is STRING: prefetch|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = audiomaxage Level = 1 value is STRING: 3600s|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = bargein Level = 1 value is STRING: true|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = caching Level = 1 value is STRING: fast|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = completetimeout Level = 1 value is STRING: 1000ms|chsaaep01####
@2013-10-17 18:28:38,758||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = confidencelevel Level = 1 value is STRING: 0.25|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = datamaxage Level = 1 value is STRING: 3600s|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = documentfetchhint Level = 1 value is STRING: safe|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = documentmaxage Level = 1 value is STRING: 3600s|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = documentmaxstale Level = 1 value is STRING: 0s|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = fetchtimeout Level = 1 value is STRING: 15000ms|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = grammarfetchhint Level = 1 value is STRING: prefetch|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = grammarmaxage Level = 1 value is STRING: 3600s|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = incompletetimeout Level = 1 value is STRING: 1000ms|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = inet.authMode Level = 1 value is STRING: None|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = inet.basicAuthUserPwd Level = 1 value is STRING: :|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = inet.sslMutualAuth Level = 1 value is STRING: no|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = inputmodes Level = 1 value is STRING: dtmf voice|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = maxnbest Level = 1 value is STRING: 1|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = maxspeechtimeout Level = 1 value is STRING: 5000ms|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = objectfetchhint Level = 1 value is STRING: prefetch|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = outputmodes Level = 1 value is STRING: audio video|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = scriptfetchhint Level = 1 value is STRING: prefetch|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = scriptmaxage Level = 1 value is STRING: 3600s|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = sensitivity Level = 1 value is STRING: 0.45|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = speedvsaccuracy Level = 1 value is STRING: 0.5|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = termchar Level = 1 value is STRING: #|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = termtimeout Level = 1 value is STRING: 0s|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = timeout Level = 1 value is STRING: 5000ms|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = xml:lang Level = 1 value is STRING: en-us|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = audiofetchhint Level = 0 value is STRING: prefetch|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = audiomaxage Level = 0 value is STRING: 3600s|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = bargein Level = 0 value is STRING: true|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = bargeintype Level = 0 value is STRING: speech|chsaaep01####
@2013-10-17 18:28:38,759||FINEST|CommonVXI.Interpreter|4954|Session=chsaaep01-2013290102733-17|PromptManager.cpp:680:Key = caching Level = 0 value is STRING: fast|chsaae

I don't see anything unusual, please open a support ticket with EP support to look at your logs in detail.