×

Warning message

  • Cisco Support Forums is in Read Only mode while the site is being migrated.
  • Cisco Support Forums is in Read Only mode while the site is being migrated.

TSP Errors

Unanswered Question
Feb 5th, 2002
User Badges:

Unity 3.1(2) TSP 3.1(2). Sometimes the Unity ports do not forward and users get a busy signal. It happens when subscribers try to access voicemail or outside users call in to the openeing greeting. I have a ton of warning messages in the Application log relating to the TSP. They are:<br><br>Warning<br>EVENT ID 111<br>AvCiscoTsp_MC<br><br>AvCiscoTsp Device 7: Failed blind transfer to extension 5425<br>(This one shows up with differnent device numbers and different extensions)<br><br>Error<br>Miu_MC<br>EVENT ID 525<br>Component Miu: Thread 0x0000096C had a Failure on Port 2 in Method CAvMiuLine::Transfer(eMIU_XFER_RELEASE)<br><br>DESCRIPTION: Timed-out waiting for LINECALLSTATE_IDLE after lineBlindTransfer.<br>DETAILS: <br> HCALL: 0x000104AB<br> CallState: LINECALLSTATE_CONNECTED<br> DestAddress: 5324.<br>CALLINFO: <br> CallerID: 9<br> CalledID: 2802<br> RedirectingID: 2802<br> Origin: Internal<br> Reason: FwdUncond<br> Trunk: 0.<br>CALL SEQUENCE:<br>[15:07:56:265 - 0x00000994] Drop() - S_OK<br>[15:07:56:265 - 0x00000994] Transfer(RELEASE to 4600) - S_OK<br>[15:08:03:781 - 0x0000105C] LINE_APPNEWCALL(0x000104AB)<br>[15:08:03:781 - 0x0000105C] SetEvent(NewCall)<br>[15:08:03:906 - 0x000009AC] Answer() entered<br>[15:08:03:906 - 0x0000105C] LINE_REPLY(0x00010713 | 0x00000000)<br>[15:08:03:906 - 0x000009AC] lineAnswer(0x000104AB) - 0x00010713<br>[15:08:05:453 - 0x0000105C] LINECALLSTATE_CONNECTED(0x000104AB | Active)<br>[15:08:05:453 - 0x000009AC] WaitFor(0x00010713 | CONNECTED) - CONNECTED<br>[15:08:05:453 - 0x000009AC] Answer() - S_MIU_CONNECTED<br>[15:08:05:718 - 0x000009AC] Play() entered<br>[15:08:05:718 - 0x000009AC] WavOpen(0x0AE3B080) - 0x0A6A2CFC<br>[15:08:05:718 - 0x000009AC] WavGetLength(0x0A6A2CFC) - 10794<br>[15:08:05:718 - 0x000009AC] WavClose(0x0A6A2CFC) - 0x00000000<br>[15:08:05:718 - 0x000009AC] WavOpen(0x0AE3B080) - 0x0A6A2CFC<br>[15:08:05:718 - 0x000009AC] WavSetChunks(0x0A6A2CFC) - 0x00000000<br>[15:08:05:718 - 0x000009AC] WavSetPosition(0x0A6A2CFC | 0) - 0<br>[15:08:05:718 - 0x000009AC] WavSetVolume(0x0A6A2CFC | 50) - 0x00000000<br>[15:08:05:718 - 0x000009AC] WavSetSpeed(0x0A6A2CFC | 100) - 0x00000000<br>[15:08:05:968 - 0x000009AC] WavPlay(0x0A6A2CFC) - 0x00000000<br>[15:08:16:687 - 0x000010C0] SetEvent(WavStopped)<br>[15:08:16:687 - 0x000009AC] WaitFor(StopEvents) - WavStopped<br>[15:08:16:687 - 0x000009AC] WavGetLength(0x0A6A2CFC) - 10794<br>[15:08:16:687 - 0x000009AC] WavClose(0x0A6A2CFC) - 0x00000000<br>[15:08:16:687 - 0x000009AC] Play(Item 1 of 1 | IStream 0x0AE3B080) - 0 to 10794<br>[15:08:16:687 - 0x000009AC] Play(1 Item | PlayLength 10794) - S_OK<br>[15:08:16:687 - 0x000009AC] GatherDigits(GATHER) entered<br>[15:08:19:687 - 0x000009AC] WaitFor(Digit) - Timeout<br>[15:08:19:687 - 0x000009AC] GatherDigits(GATHER - <NONE>) - S_MIU_TERM_TIMEOUT<br>[15:08:19:687 - 0x000009AC] Play() entered<br>[15:08:19:687 - 0x000009AC] WavOpen(0x0AE3B080) - 0x0A6A2B2C<br>[15:08:19:687 - 0x000009AC] WavGetLength(0x0A6A2B2C) - 10794<br>[15:08:19:687 - 0x000009AC] WavClose(0x0A6A2B2C) - 0x00000000<br>[15:08:19:687 - 0x000009AC] WavOpen(0x0AE3B080) - 0x0A6A2B2C<br>[15:08:19:687 - 0x000009AC] WavSetChunks(0x0A6A2B2C) - 0x00000000<br>[15:08:19:687 - 0x000009AC] WavSetPosition(0x0A6A2B2C | 0) - 0<br>[15:08:19:687 - 0x000009AC] WavSetVolume(0x0A6A2B2C | 50) - 0x00000000<br>[15:08:19:687 - 0x000009AC] WavSetSpeed(0x0A6A2B2C | 100) - 0x00000000<br>[15:08:19:921 - 0x000009AC] WavPlay(0x0A6A2B2C) - 0x00000000<br>[15:08:24:515 - 0x0000096C] WaitFor(0x00010444 | IDLE) - Timeout.<br><br>Error<br>AvConvMsg_MC<br>EVENT ID 10020<br><br>[Thread 0x00000A04] AvCDEConvBase::Run() Possible infinite loop detected in [PHGreeting]; Object = 03:{80AAA392-EF4D-4795-BE90-623151B54035} <br><br>Error<br>AvConvMsg_MC<br>EVENT ID 10016<br>Transferred to FailSafe conversation while running conversation PHGreeting on Port 4. See the following file for the contents of the Named Properties : D:\CommServer\logs\NPDump_20020205_150251.txt <br><br>There are a few others, but I will start with these for now.<br><br>Thanks<br><br><br><br><br>

  • 1
  • 2
  • 3
  • 4
  • 5
Overall Rating: 0 (0 ratings)
Loading.
kechambe Tue, 02/05/2002 - 07:14
User Badges:
  • Gold, 750 points or more
dnmann Wed, 02/06/2002 - 05:08
User Badges:

It is Call Manager, version 3.1(2c). I am not very familar with the trace process. Would you be able to tell me how to find the trace?

Thank You

Anonymous (not verified) Wed, 02/06/2002 - 10:31
User Badges:

Just another suggestion...

In the original TSP failure message for the blind transfer, it will tell you why the blind transfer failed: either it received busy or reorder from CCM. If you take a closer look at that message for the reason, then you can look into why CCM would be sending busy or reorder to Unity when it is trying to transfer rather than gather CCM traces. This could be a CSS issue if the reason was reorder, or it could be that the phone was busy, but not forwarded.

Steve Olivier
Software Engineer
Cisco Systems

dnmann Wed, 02/06/2002 - 06:56
User Badges:

I think this is a section of a trace indicating one of the problems. Unity had an error that said a blind transfer to 4102 could not occur because the line was busy. This is the corresponding trace from the time of the error. The line is set to forward busy and no answer to Unity.

02/06/2002 10:32:58.645 Cisco CallManager|StationD: 642ecd0 SelectSoftKeys instance=1 reference=33701749 softKeySetIndex=2 validKeyMask=1.|
02/06/2002 10:32:58.645 Cisco CallManager|StationD: 642ecd0 CallState callState=12(Proceed) lineInstance=1 callReference=33702101|
02/06/2002 10:32:58.645 Cisco CallManager|StationD: 642ecd0 CallInfo callingPartyName='Voice Mail' callingParty=2006 cgpnVoiceMailbox= calledPartyName='Deborah Cullen' calledParty=4102 cdpnVoiceMailbox=4102 originalCalledPartyName='Deborah Cullen' originalCalledParty=4102 originalCdpnVoiceMailbox=4102 originalCdpnRedirectReason=0 lastRedirectingPartyName='' lastRedirectingParty= lastRedirectingVoiceMailbox= lastRedirectingReason=0 callType=2(OutBound) lineInstance=1 callReference=33702101.|
02/06/2002 10:32:58.645 Cisco CallManager|StationD::star_StationOutputCallInfo(): callInfo: CI=33702101, CallingPartyName=Voice Mail, CallingParty=2006, CalledPartyName=Deborah Cullen, CalledParty=4102, OriginalCalledPartyName=Deborah Cullen, OriginalCalledParty=4102, lastRedirectingPartyName=, lastRedirectingParty=|
02/06/2002 10:32:58.645 Cisco CallManager|StationD: 642ecd0 DialedNumber dialedNumber=4102 lineInstance=1 callReference=33702101.|
02/06/2002 10:32:58.738 Cisco CallManager|CTI: RoutePatternToCtiCommandData::findValue() : RP=2006:Phones, bRc=0, T=, #entries=0|
02/06/2002 10:32:58.738 Cisco CallManager|CTI: RoutePatternToCtiCommandData::findValue() : RP=2006:Phones, bRc=0, T=, #entries=0|
02/06/2002 10:32:58.738 Cisco CallManager|StationD: 642ecd0 StartTone tone=35(LineBusyTone).|
02/06/2002 10:32:58.926 Cisco CallManager|StationInit: 642ecd0 Stimulus stimulus=9(Line) stimulusInstance=1.|
02/06/2002 10:32:58.926 Cisco CallManager|StationD - StimLine: hold cases|
02/06/2002 10:32:58.926 Cisco CallManager|StationD: 642ecd0 SelectSoftKeys instance=1 reference=33701749 softKeySetIndex=2 validKeyMask=-1.|
02/06/2002 10:32:58.926 Cisco CallManager|StationD: 642ecd0 SetLamp stimulus=9(Line) stimulusInstance=1 lampMode=3(LampWink).|
02/06/2002 10:32:58.926 Cisco CallManager|StationD: 642ecd0 ClearPromptStatus lineInstance=1 callReference=33702101.|
02/06/2002 10:32:58.926 Cisco CallManager|StationD: 642ecd0 CallState callState=2(OnHook) lineInstance=1 callReference=33702101|
02/06/2002 10:32:58.926 Cisco CallManager|StationD: 642ecd0 DefineTimeDate timeDateInfo=? systemTime=1013009578.|
02/06/2002 10:32:58.926 Cisco CallManager|StationD: 642ecd0 StopTone.|

dnmann Wed, 02/06/2002 - 10:48
User Badges:

The problem is, Ican't make it fail. It happens intermittently. I have a hunch it may be occuring because both the forward busy and forward no answer are in use while the person is on the line, so when a fourth person calls in, it rings busy.

How do you stop and start a new trace?

kechambe Wed, 02/06/2002 - 10:57
User Badges:
  • Gold, 750 points or more

The forward busy and forward no answer don't have a concept of in use. They are intercepts or redirects if you will.

Any chance you configured Cisco Messaging Interface?

There is a trace on check box where you configure the traces. Uncheck that, click update then recheck that and check update again.

Keith

Keith Chambers
Unity Technical Lead
Unified Voice Team, San Jose
Cisco Systems
[email protected]

dnmann Wed, 02/06/2002 - 11:01
User Badges:

I did initially configure the CMI, but I found a post here a while ago and got rid of it. I thought that had solve my problem, and it seemed to have for a while. But when I went live into production it seems to have cropped up again. I have noticed that if a phone is off hook, then it takes another call, that one goes right to Unity as per forward busy, the third call will also go to Unity with the first two still active, but the forth one will get a busy signal. Is this normal?

Actions

This Discussion