Flow for Login, Logout

From DocWiki

Revision as of 19:28, 15 November 2011 by Ginod (Talk | contribs)
(diff) ← Older revision | Latest revision (diff) | Newer revision → (diff)
Jump to: navigation, search


Contents

Key logs for troubleshooting Integrated Login issues

Access Logs <--> Application Server logs <--> Listener Logs <--> CTI Server Logs

Access Logs: Agent PC requests from Application Server Login JSP page on default partition.

10.77.30.8 - - [13/Jun/2011:02:33:52 +0000] "GET /system/web/view/platform/common/login/root.jsp?partitionId=1 HTTP/1.1" 200 14599
10.77.30.8 - - [13/Jun/2011:02:33:53 +0000] "GET /system/web/view/platform/common/login/top.jsp?partitionId=1&userName=NA&password=NA&terminalId=NA&terminalPassword=NA&isAspectUser=false&locale=en_us HTTP/1.1" 200 10727
10.77.30.8 - - [13/Jun/2011:02:33:53 +0000] "GET /system/web/view/platform/common/login/login.jsp?partitionId=1&userName=NA&password=NA&terminalId=NA&terminalPassword=NA&locale=en_us HTTP/1.1" 200 9970
10.77.30.8 - - [13/Jun/2011:02:33:53 +0000] "GET /system/web/view/platform/common/login/singleton.jsp?partitionId=1&isAspectUser=false HTTP/1.1" 200 26124

Access Logs: Agent PC requests user_login on default partition.

10.77.30.8 - - [13/Jun/2011:02:34:04 +0000] "GET /system/web/view/platform/common/loguserevent.jsp?statusParam=1&request_action=user_login&userId=1002&partitionId=1&language=en&country=us&__time__=1307932415945 HTTP/1.1" 200 367

Application Server checks agent authentication for login.

2011-06-12 22:34:03.489 GMT-0400 <@> INFO <@> [36061:ajp-eimApp.eim.lab%2F14.104.48.16-15006-4] <@> ProcessId:1024 <@> PID:1 <@> UID:-1 <@> HttpSessionId:A3311B9673780BFC72082B55ACBB38B3 <@> com.egain.platform.user.authenticate.AuthenticateUser <@> authenticate() <@> thirdPartyControlAgent ->   true <@> 
2011-06-12 22:34:03.489 GMT-0400 <@> INFO <@> [36061:ajp-eimApp.eim.lab%2F14.104.48.16-15006-4] <@> ProcessId:1024 <@> PID:1 <@> UID:-1 <@> HttpSessionId:A3311B9673780BFC72082B55ACBB38B3 <@> com.cisco.ipcc.IPCCAgentHook <@> agentAuthentication() <@> loginName  JDoe <@> 
2011-06-12 22:34:03.489 GMT-0400 <@> INFO <@> [36061:ajp-eimApp.eim.lab%2F14.104.48.16-15006-4] <@> ProcessId:1024 <@> PID:1 <@> UID:-1 <@> HttpSessionId:A3311B9673780BFC72082B55ACBB38B3 <@> com.cisco.ipcc.IPCCAgentHook <@> agentAuthentication() <@> skillTargetID  5005 <@> 
2011-06-12 22:34:03.489 GMT-0400 <@> INFO <@> [36061:ajp-eimApp.eim.lab%2F14.104.48.16-15006-4] <@> ProcessId:1024 <@> PID:1 <@> UID:-1 <@> HttpSessionId:A3311B9673780BFC72082B55ACBB38B3 <@> com.cisco.ipcc.IPCCAgentHook <@> agentAuthentication() <@> peripheralID  5000 <@> 
2011-06-12 22:34:03.489 GMT-0400 <@> INFO <@> [36061:ajp-eimApp.eim.lab%2F14.104.48.16-15006-4] <@> ProcessId:1024 <@> PID:1 <@> UID:-1 <@> HttpSessionId:A3311B9673780BFC72082B55ACBB38B3 <@> com.cisco.ipcc.IPCCAgentHook <@> agentAuthentication() <@> loginEnabled  Y <@> 
2011-06-12 22:34:03.554 GMT-0400 <@> INFO <@> [36061:ajp-eimApp.eim.lab%2F14.104.48.16-15006-4] <@> ProcessId:1024 <@> PID:1 <@> UID:-1 <@> HttpSessionId:A3311B9673780BFC72082B55ACBB38B3 <@> com.cisco.ipcc.IPCCAgentHook <@> agentAuthentication() <@> personDeleted  N <@> 
2011-06-12 22:34:03.554 GMT-0400 <@> INFO <@> [36061:ajp-eimApp.eim.lab%2F14.104.48.16-15006-4] <@> ProcessId:1024 <@> PID:1 <@> UID:-1 <@> HttpSessionId:A3311B9673780BFC72082B55ACBB38B3 <@> com.cisco.ipcc.IPCCAgentHook <@> agentAuthentication() <@> agentDeleted  N <@> 

Listener sends MEDIA_LOGIN_REQ to CTI Server for each MRDid.

2011-06-12 22:34:03.654 GMT-0400 <@> INFO <@> [1611:pool-5-thread-6] <@> ProcessId:3976 <@> PID:1 <@> UID:1002 <@> HttpSessionId:A3311B9673780BFC72082B55ACBB38B3 <@> com.cisco.ipcc.listener.login.LoginLogoutController <@> loginAgentToARM() <@> AGENT_EVENT: MEDIA_LOGIN_REQ, AgentId:1002, MRDId:5001 <@> 
2011-06-12 22:34:03.654 GMT-0400 <@> INFO <@> [1611:pool-5-thread-6] <@> ProcessId:3976 <@> PID:1 <@> UID:1002 <@> HttpSessionId:A3311B9673780BFC72082B55ACBB38B3 <@> com.cisco.ipcc.listener.login.LoginLogoutController <@> loginAgentToARM() <@> AGENT_EVENT: MEDIA_LOGIN_REQ, AgentId:1002, MRDId:5002 <@> 
2011-06-12 22:34:03.654 GMT-0400 <@> INFO <@> [1611:pool-5-thread-6] <@> ProcessId:3976 <@> PID:1 <@> UID:1002 <@> HttpSessionId:A3311B9673780BFC72082B55ACBB38B3 <@> com.cisco.ipcc.listener.login.LoginLogoutController <@> loginAgentToARM() <@> AGENT_EVENT: MEDIA_LOGIN_REQ, AgentId:1002, MRDId:5003 <@> 

CTI Server sends MEDIA_LOGIN_REQ to OPC which returns a MEDIA_LOGIN_RESP.

22:34:03:783 cg1A-ctisvr SESSION 2: MsgType:MEDIA_LOGIN_REQ (InvokeID:0xf83d MRDID:5001 ICMAgentID:5005 AgentMode:0 IsAvailable:False  
22:34:03:783 cg1A-ctisvr SESSION 2:         MaxTaskLimit:1 AgentInfo:"1002" ) 
22:34:03:783 cg1A-ctisvr SESSION 2: MsgType:MEDIA_LOGIN_RESP (InvokeID:0xf83d ARMStatus:E_ARM_STAT_OK ) 

22:34:03:783 cg1A-ctisvr SESSION 2: MsgType:MEDIA_LOGIN_REQ (InvokeID:0xf83e MRDID:5002 ICMAgentID:5005 AgentMode:0 IsAvailable:False  
22:34:03:783 cg1A-ctisvr SESSION 2:         MaxTaskLimit:1 AgentInfo:"1002" ) 
22:34:03:783 cg1A-ctisvr SESSION 2: MsgType:MEDIA_LOGIN_RESP (InvokeID:0xf83e ARMStatus:E_ARM_STAT_OK ) 

22:34:03:783 cg1A-ctisvr SESSION 2: MsgType:MEDIA_LOGIN_REQ (InvokeID:0xf83f MRDID:5003 ICMAgentID:5005 AgentMode:0 IsAvailable:False  
22:34:03:783 cg1A-ctisvr SESSION 2:         MaxTaskLimit:1 AgentInfo:"1002" ) 
22:34:03:799 cg1A-ctisvr SESSION 2: MsgType:MEDIA_LOGIN_RESP (InvokeID:0xf83f ARMStatus:E_ARM_STAT_OK ) 

Listener receives MEDIA_LOGIN_RESP from CTI Server.

2011-06-12 22:34:03.685 GMT-0400 <@> INFO <@> [119:pool-6-thread-3] <@> ProcessId:3976 <@> PID:1 <@> UID:12 <@> HttpSessionId:  <@> com.cisco.ipcc.listener.command.arm.MediaLoginRespCmd <@> executeCommand() <@> PRINT_STATE  after receiving MEDIA_LOGIN_RESP from ARM: 
icmAgentID=5005
MrdId=5003
STATE=
 icmAgentId -> 5005
 mrdId -> 5003
 mAgentMode -> 0
 mAvailableTime -> 0
 mInterruptingInvokeId -> 0
 mInterruptingMrdId -> 0
 mIsInterrupted -> com.cisco.ipcc.listener.arm.datatype.Bool@9147c1
 mIsNotReady -> com.cisco.ipcc.listener.arm.datatype.Bool@1fdeef7
 mLoginTime -> 1307932443654
 mRoutTime -> 0
 mAvailableTime -> 0
 mNotReadyTime -> 1307932443654
 mLogonDuration -> 0
 mRoutableDuration -> 0
 mAvailableDuration -> 0
 mNotReadyDuration -> 0
 mMaxTaskLimit -> 1
 skillGrpId -> 0 <@> 
2011-06-12 22:34:03.701 GMT-0400 <@> INFO <@> [481:pool-6-thread-6] <@> ProcessId:3976 <@> PID:1 <@> UID:12 <@> HttpSessionId:  <@> com.cisco.ipcc.listener.command.arm.MediaLoginRespCmd <@> executeCommand() <@> PRINT_STATE  after receiving MEDIA_LOGIN_RESP from ARM: 
icmAgentID=5005
MrdId=5002
STATE=
 icmAgentId -> 5005
 mrdId -> 5002
 mAgentMode -> 0
 mAvailableTime -> 0
 mInterruptingInvokeId -> 0
 mInterruptingMrdId -> 0
 mIsInterrupted -> com.cisco.ipcc.listener.arm.datatype.Bool@b0c981
 mIsNotReady -> com.cisco.ipcc.listener.arm.datatype.Bool@7d45f2
 mLoginTime -> 1307932443670
 mRoutTime -> 0
 mAvailableTime -> 0
 mNotReadyTime -> 1307932443670
 mLogonDuration -> 0
 mRoutableDuration -> 0
 mAvailableDuration -> 0
 mNotReadyDuration -> 0
 mMaxTaskLimit -> 1
 skillGrpId -> 0 <@> 
2011-06-12 22:34:03.701 GMT-0400 <@> INFO <@> [124:pool-6-thread-4] <@> ProcessId:3976 <@> PID:1 <@> UID:12 <@> HttpSessionId:  <@> com.cisco.ipcc.listener.command.arm.MediaLoginRespCmd <@> executeCommand() <@> PRINT_STATE  after receiving MEDIA_LOGIN_RESP from ARM: 
icmAgentID=5005
MrdId=5001
STATE=
 icmAgentId -> 5005
 mrdId -> 5001
 mAgentMode -> 0
 mAvailableTime -> 0
 mInterruptingInvokeId -> 0
 mInterruptingMrdId -> 0
 mIsInterrupted -> com.cisco.ipcc.listener.arm.datatype.Bool@13f2975
 mIsNotReady -> com.cisco.ipcc.listener.arm.datatype.Bool@1bacc3f
 mLoginTime -> 1307932443670
 mRoutTime -> 0
 mAvailableTime -> 0
 mNotReadyTime -> 1307932443670
 mLogonDuration -> 0
 mRoutableDuration -> 0
 mAvailableDuration -> 0
 mNotReadyDuration -> 0
 mMaxTaskLimit -> 1
 skillGrpId -> 0 <@> 

Agent state changes and logout follow the same pattern.

  • MAKE_AGENT_ROUTABLE_IND
  • MAKE_AGENT_READY_IND
  • MAKE_AGENT_NOT_ROUTABLE_REQ / MAKE_AGENT_NOT_ROUTABLE_RESP
  • MAKE_AGENT_NOT_READY_REQ / MAKE_AGENT_NOT_READY_RESP
  • MEDIA_LOGOUT_IND

Successful Login and Logout

Note that Access Log timestamps (GMT) are not the same as other component logs. This explains why the login/logout are seen long before the other messages in the below ladder diagram.

CFTloginlogout.png

Rating: 5.0/5 (1 vote cast)

Personal tools