1 2 3 Previous Next 39 Replies Latest reply on Oct 15, 2013 9:47 AM by Siddu angadi

    BBSA Application server service is not starting

      Hi All,

       

      I am getting below error "Error 1053: Service did not respond to start or control request in timely manner"

       

      i.e. BBSA Application server service is not starting.Initially it shows starting but it fails to start.

      Attached screen-shot showing same.

       

      Why it is so?BBSA_App.png

        • 1. Re: BBSA Application server service is not starting
          Bill Robinson

          What’s in the appserver log ?

          • 2. Re: BBSA Application server service is not starting


            Sorry

            but I am new in BBSA, where do i need to search for logs.

            Can you provide me complete path for logs.

            • 3. Re: BBSA Application server service is not starting
              Aryan Anantwar

              Hi James,

               

              Below is path for appserver.log

              c:\Program Files\BMC Software\BladeLogic\NSH\br\appserver.log

               

              Please confirm that, the DB & Fileserver are properly configured & Appserver is able o communicate with them.

              Open AppServer Configuration Wizard & check the connectivity with DB & FileServer.

               

              If still you face the same issue & share the appserver.log

               

              Regards,

              Aryan Anantwar

              • 4. Re: BBSA Application server service is not starting

                Few tips for new BSA user:

                Please check firewall,  file server and app server are ping using name (check DNS setting)

                provide rights to user in the exports file, it is in C:\Windows\rsc
                *   rw, user=Administrator

                • 5. Re: BBSA Application server service is not starting

                  Hi Aryan,

                   

                  I found from logs,BBSA App server is not able to communicate with file server.

                   

                  I am able to telnet locally to file server at 4750, but failed to do so through BBSA App server.

                   

                  I have checked firewall is disabled, rw,user and rw,map permission in exports and user.locals file are fine.i.e Administrator.


                  what to do?



                  PFA Logs



                  [31 Jul 2013 19:29:50,255] [main] [INFO] [::] [] Starting Agent Service...

                  [31 Jul 2013 19:29:50,271] [main] [INFO] [::] [] Agent Service started.

                  [31 Jul 2013 19:29:50,380] [main] [INFO] [::] [] ClientValidation Service started.

                  [31 Jul 2013 19:29:50,380] [main] [INFO] [::] [] Starting Configuration Service...

                  [31 Jul 2013 19:29:50,396] [main] [INFO] [::] [] Configuration Service started.

                  [31 Jul 2013 19:29:50,411] [main] [INFO] [::] [] Starting Content Importer Service...

                  [31 Jul 2013 19:29:50,411] [main] [INFO] [::] [] Content Importer Service started.

                  [31 Jul 2013 19:29:50,599] [main] [INFO] [::] [] Loading JNI libaries...

                  [31 Jul 2013 19:29:50,646] [main] [INFO] [::] [] Loaded JNI library BlAsJni

                  [31 Jul 2013 19:29:50,646] [main] [INFO] [::] [] Loaded JNI library XJNIService

                  [31 Jul 2013 19:29:50,646] [main] [INFO] [::] [] Loaded JNI library Atrium Core

                  [31 Jul 2013 19:29:50,646] [main] [INFO] [::] [] Initializing JNI Configuration...

                  [31 Jul 2013 19:29:50,646] [main] [INFO] [::] [] Initialized JNI library BlAsJni

                  [31 Jul 2013 19:29:50,661] [main] [INFO] [::] [] Initialized JNI library XJNIService

                  [31 Jul 2013 19:29:50,661] [main] [INFO] [::] [] Initialized JNI library Atrium Core

                  [31 Jul 2013 19:29:50,661] [main] [INFO] [::] [] JNI Configuration complete.

                  [31 Jul 2013 19:29:50,661] [main] [INFO] [::] [] Job Infra Manager Service is starting

                  [31 Jul 2013 19:29:50,692] [main] [INFO] [::] [] Starting LDAP Connection Service...

                  [31 Jul 2013 19:29:50,692] [main] [INFO] [::] [] LDAP Connection Service started.

                  [31 Jul 2013 19:29:50,755] [main] [INFO] [::] [] Starting Model Graph Service...

                  [31 Jul 2013 19:29:52,411] [main] [INFO] [::] [] Model Graph Service started.

                  [31 Jul 2013 19:29:52,474] [main] [INFO] [::] [] Starting ObjectExporter Service...

                  [31 Jul 2013 19:29:52,474] [main] [INFO] [::] [] Verifying exporter classes...

                  [31 Jul 2013 19:29:52,489] [main] [INFO] [::] [] Object exporters verified.

                  [31 Jul 2013 19:29:52,489] [main] [INFO] [::] [] ObjectExporter Service started.

                  [31 Jul 2013 19:29:52,677] [main] [INFO] [::] [] Starting PKI Service...

                  [31 Jul 2013 19:29:52,692] [main] [INFO] [::] [] PKI Service started.

                  [31 Jul 2013 19:29:52,692] [main] [INFO] [::] [] Starting LDAP Service...

                  [31 Jul 2013 19:29:52,692] [main] [INFO] [::] [] LDAP service is not configured.

                  [31 Jul 2013 19:29:52,692] [main] [INFO] [::] [] LDAP Service started.

                  [31 Jul 2013 19:29:52,692] [main] [INFO] [::] [] Starting Port Provider...

                  [31 Jul 2013 19:29:52,692] [main] [INFO] [::] [] Port Provider started.

                  [31 Jul 2013 19:29:52,724] [main] [INFO] [::] [] Starting Sizing Service...

                  [31 Jul 2013 19:29:52,724] [main] [INFO] [::] [] Sizing Service started.

                  [31 Jul 2013 19:29:52,724] [main] [INFO] [::] [] Starting Caching Service...

                  [31 Jul 2013 19:29:52,724] [main] [INFO] [::] [] Caching Service started.

                  [31 Jul 2013 19:29:52,739] [main] [INFO] [::] [] Starting Session Service...

                  [31 Jul 2013 19:29:52,739] [main] [INFO] [::] [] Session Service started.

                  [31 Jul 2013 19:29:52,739] [main] [INFO] [::] [] Starting JCIFS Connection Service...

                  [31 Jul 2013 19:29:52,739] [main] [INFO] [::] [] JCIFS Connection Service started.

                  [31 Jul 2013 19:29:52,755] [main] [INFO] [::] [] Starting SSH Connection Service...

                  [31 Jul 2013 19:29:52,755] [main] [INFO] [::] [] SSH Connection Service started.

                  [31 Jul 2013 19:29:52,771] [main] [INFO] [::] [] Starting Task Scheduling Service...

                  [31 Jul 2013 19:29:52,771] [main] [INFO] [::] [] Task Scheduling Service started.

                  [31 Jul 2013 19:29:52,786] [main] [INFO] [::] [] Starting Directory Service...

                  [31 Jul 2013 19:29:52,786] [main] [INFO] [::] [] Starting RMI registry on host: WIN-DFCEVAM1YJX

                  [31 Jul 2013 19:29:52,802] [main] [INFO] [::] [] Directory Service started.

                  [31 Jul 2013 19:29:52,802] [main] [INFO] [::] [] Setting authenticator: com.bladelogic.om.infra.app.service.manage.auth.BlSessionServerAuthenticator

                  [31 Jul 2013 19:29:52,802] [main] [INFO] [::] [] Setting server socket factory: com.bladelogic.om.infra.app.service.client.ServerSocketFactory

                  [31 Jul 2013 19:29:52,802] [main] [INFO] [::] [] Setting client socket factory: com.bladelogic.om.infra.app.service.client.OMClientSocketFactory

                  [31 Jul 2013 19:29:52,802] [main] [INFO] [::] [] Starting Management Service ...

                  [31 Jul 2013 19:29:52,880] [main] [INFO] [::] [] Management Service started.

                  [31 Jul 2013 19:29:52,880] [main] [INFO] [::] [] Starting Instrumentation Service...

                  [31 Jul 2013 19:29:52,880] [main] [INFO] [::] [] Instrumentation Service started.

                  [31 Jul 2013 19:29:52,880] [main] [INFO] [::] [] Starting App Server Data Source...

                  [31 Jul 2013 19:29:54,833] [main] [INFO] [::] [] Initialized connection pool General-Connection-Pool with url = jdbc:sqlserver://WIN-CXMV8389JIF:1433;DatabaseName=Bladelogic_Apps;SelectMethod=cursor and user = sa

                  [31 Jul 2013 19:29:54,880] [main] [INFO] [::] [] Initialized connection pool Job-Connection-Pool with url = jdbc:sqlserver://WIN-CXMV8389JIF:1433;DatabaseName=Bladelogic_Apps;SelectMethod=cursor and user = sa

                  [31 Jul 2013 19:29:54,958] [main] [INFO] [::] [] Initialized connection pool Client-Connection-Pool with url = jdbc:sqlserver://WIN-CXMV8389JIF:1433;DatabaseName=Bladelogic_Apps;SelectMethod=cursor and user = sa

                  [31 Jul 2013 19:29:54,958] [main] [INFO] [::] [] App Server Data Source started.

                  [31 Jul 2013 19:29:55,536] [main] [INFO] [::] [] Starting Database Service...

                  [31 Jul 2013 19:29:55,739] [main] [INFO] [::] [] Loaded C:/Program Files/BMC Software/BladeLogic/NSH/br/deployments/default/sql/sqlmap.properties

                  [31 Jul 2013 19:29:56,224] [main] [INFO] [::] [] Loaded C:/Program Files/BMC Software/BladeLogic/NSH/br/deployments/default/sql/streamable_sqlmap.properties

                  [31 Jul 2013 19:29:56,505] [main] [INFO] [::] [] Database service loaded 2 mapping files.

                  [31 Jul 2013 19:29:56,505] [main] [INFO] [::] [] Database Service started.

                  [31 Jul 2013 19:29:56,677] [main] [INFO] [::] [] Starting App Server Service...

                  [31 Jul 2013 19:29:59,521] [main] [INFO] [::] [] Server: win-dfcevam1yjx; id: 1; RMI Port: 9836

                  [31 Jul 2013 19:29:59,567] [main] [INFO] [::] [] App Server Service started.

                  [31 Jul 2013 19:29:59,567] [main] [INFO] [::] [] Starting Job Executor Service...

                  [31 Jul 2013 19:29:59,567] [main] [INFO] [::] [] Job Executor Service started.

                  [31 Jul 2013 19:29:59,567] [main] [INFO] [::] [] Starting Atrium Import Service...

                  [31 Jul 2013 19:29:59,567] [main] [INFO] [::] [] Atrium Import Service started.

                  [31 Jul 2013 19:29:59,567] [main] [INFO] [::] [] Starting Notification Service...

                  [31 Jul 2013 19:29:59,567] [main] [INFO] [::] [] Notification Service started.

                  [31 Jul 2013 19:29:59,567] [main] [INFO] [::] [] Starting SRP Authentication Service...

                  [31 Jul 2013 19:29:59,724] [main] [INFO] [::] [] SRP Authentication Service started.

                  [31 Jul 2013 19:29:59,724] [main] [INFO] [::] [] Verifying object deleters...

                  [31 Jul 2013 19:29:59,724] [main] [INFO] [::] [] Object deleters verified.

                  [31 Jul 2013 19:29:59,724] [main] [INFO] [::] [] Verifying object soft deleters...

                  [31 Jul 2013 19:29:59,739] [main] [INFO] [::] [] Object soft deleters verified.

                  [31 Jul 2013 19:29:59,755] [main] [INFO] [::] [] Starting NshProxyConnection Service...

                  [31 Jul 2013 19:29:59,755] [main] [INFO] [::] [] Nsh-Proxy is reserving the controlport

                  [31 Jul 2013 19:29:59,755] [main] [INFO] [::] [] Nsh-Proxy is establishing control connection...

                  [31 Jul 2013 19:29:59,755] [Thread-7] [INFO] [::] [] Nsh-Proxy is waiting for control socket ...

                  [31 Jul 2013 19:29:59,755] [Thread-7] [INFO] [::] [] Nsh-Proxy accepted the control socket connection

                  [31 Jul 2013 19:29:59,755] [main] [INFO] [::] [] Nsh-Proxy established control connection.

                  [31 Jul 2013 19:29:59,771] [main] [INFO] [::] [] Nsh-Proxy is starting the selector

                  [31 Jul 2013 19:29:59,771] [main] [INFO] [::] [] Nsh-Proxy is starting the acceptor

                  [31 Jul 2013 19:29:59,771] [main] [INFO] [::] [] NshProxyConnection Service started.

                  [31 Jul 2013 19:29:59,771] [main] [INFO] [::] [] Starting Event Service...

                  [31 Jul 2013 19:29:59,790] [Event-Processor-Thread-0] [INFO] [::] [] Event processor thread started.

                  [31 Jul 2013 19:29:59,790] [Event-Processor-Thread-1] [INFO] [::] [] Event processor thread started.

                  [31 Jul 2013 19:29:59,790] [Event-Processor-Thread-2] [INFO] [::] [] Event processor thread started.

                  [31 Jul 2013 19:29:59,790] [Event-Processor-Thread-3] [INFO] [::] [] Event processor thread started.

                  [31 Jul 2013 19:29:59,790] [Event-Processor-Thread-4] [INFO] [::] [] Event processor thread started.

                  [31 Jul 2013 19:29:59,806] [Event-Transfer-Thread-0] [INFO] [::] [] Event transfer thread started.

                  [31 Jul 2013 19:29:59,806] [main] [INFO] [::] [] Event Service started.

                  [31 Jul 2013 19:29:59,806] [main] [INFO] [::] [] Starting Diagnostic Service...

                  [31 Jul 2013 19:29:59,806] [Event-Transfer-Thread-2] [INFO] [::] [] Event transfer thread started.

                  [31 Jul 2013 19:29:59,806] [Event-Transfer-Thread-4] [INFO] [::] [] Event transfer thread started.

                  [31 Jul 2013 19:29:59,806] [Event-Transfer-Thread-1] [INFO] [::] [] Event transfer thread started.

                  [31 Jul 2013 19:29:59,806] [Event-Transfer-Thread-3] [INFO] [::] [] Event transfer thread started.

                  [31 Jul 2013 19:29:59,806] [Event-Dispatcher-Thread] [INFO] [::] [] Event dispatcher thread started.

                  [31 Jul 2013 19:29:59,806] [Diagnostic-Test-Runner-Thread-0] [INFO] [::] [] Diagnostic test execution thread started.

                  [31 Jul 2013 19:29:59,806] [Diagnostic-Test-Runner-Thread-1] [INFO] [::] [] Diagnostic test execution thread started.

                  [31 Jul 2013 19:29:59,806] [Diagnostic-Test-Runner-Thread-2] [INFO] [::] [] Diagnostic test execution thread started.

                  [31 Jul 2013 19:29:59,806] [main] [INFO] [::] [] Diagnostic Service started.

                  [31 Jul 2013 19:29:59,806] [main] [INFO] [::] [] Starting RBAC User Service...

                  [31 Jul 2013 19:29:59,806] [main] [INFO] [::] [] RBAC User Service started.

                  [31 Jul 2013 19:29:59,806] [main] [INFO] [::] [] Starting RBAC Role Service...

                  [31 Jul 2013 19:29:59,806] [main] [INFO] [::] [] RBAC Role Service started.

                  [31 Jul 2013 19:29:59,837] [main] [INFO] [::] [] Adding method invocation provider: com.bladelogic.om.infra.app.api.manage.APIMethodInvocationProvider

                  [31 Jul 2013 19:29:59,837] [main] [INFO] [::] [] Adding method invocation provider: com.bladelogic.om.infra.app.service.agentservice.AgentMethodInvocationProvider

                  [31 Jul 2013 19:29:59,853] [Bl-Exec-0] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:29:59,853] [Bl-Exec-1] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:29:59,853] [Bl-Exec-3] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:29:59,853] [Bl-Exec-5] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:29:59,853] [Bl-Exec-2] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:29:59,853] [Bl-Exec-9] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:29:59,853] [Bl-Exec-18] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:29:59,853] [Bl-Exec-16] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:29:59,853] [Bl-Exec-13] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:29:59,853] [Bl-Exec-15] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:29:59,853] [Bl-Exec-17] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:29:59,853] [Bl-Exec-19] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:29:59,853] [Bl-Exec-7] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:29:59,853] [Bl-Exec-10] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:29:59,853] [Bl-Exec-12] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:29:59,853] [Bl-Exec-6] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:29:59,853] [Bl-Exec-14] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:29:59,853] [Bl-Exec-4] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:29:59,853] [Bl-Exec-8] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:29:59,853] [Bl-Exec-11] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:29:59,868] [main] [INFO] [::] [] BlExec Service started.

                  [31 Jul 2013 19:29:59,868] [main] [INFO] [::] [] Starting Schedule Service...

                  [31 Jul 2013 19:29:59,868] [main] [INFO] [::] [] Schedule Service started.

                  [31 Jul 2013 19:29:59,868] [main] [INFO] [::] [] Starting Distribution Manager...

                  [31 Jul 2013 19:29:59,884] [main] [INFO] [::] [] Distribution Manager started.

                  [31 Jul 2013 19:29:59,884] [main] [INFO] [::] [] Starting Job Run Service...

                  [31 Jul 2013 19:29:59,884] [main] [INFO] [::] [] Job Run Service started.

                  [31 Jul 2013 19:29:59,884] [main] [INFO] [::] [] Starting Routing Service...

                  [31 Jul 2013 19:30:06,103] [main] [INFO] [::] [] Routing Service started.

                  [31 Jul 2013 19:30:06,118] [main] [INFO] [::] [] Starting RBAC Service...

                  [31 Jul 2013 19:30:06,118] [main] [INFO] [::] [] Registering Security checkers...

                  [31 Jul 2013 19:30:06,118] [main] [INFO] [::] [] Security checkers registered.

                  [31 Jul 2013 19:30:06,118] [main] [INFO] [::] [] RBAC Service started.

                  [31 Jul 2013 19:30:06,118] [main] [INFO] [::] [] Starting Job Schedule Approval Service...

                  [31 Jul 2013 19:30:06,149] [Approval-0] [INFO] [::] [] Approval processor thread started.

                  [31 Jul 2013 19:30:06,149] [Approval-1] [INFO] [::] [] Approval processor thread started.

                  [31 Jul 2013 19:30:06,149] [Approval-2] [INFO] [::] [] Approval processor thread started.

                  [31 Jul 2013 19:30:06,165] [main] [INFO] [::] [] Starting File Manager Service...

                  [31 Jul 2013 19:30:06,353] [main] [INFO] [::] [] Validating file server host (WIN-CXMV8389JIF)...

                  [31 Jul 2013 19:30:07,899] [main] [ERROR] [::] [] File server validation failed because either the file server is not specified, cannot be contacted, or sufficient permissions are not granted on the file server agent to the appserver. Please verify the connectivity between appserver and file server and ensure that the appserver has read write permissions on the file server.

                  [31 Jul 2013 19:30:07,899] [main] [ERROR] [::] [] Error installing to Start: name=bladelogic.service.FileManagerService state=Create

                  com.bladelogic.om.infra.app.service.ServiceInitializationException: com.bladelogic.om.infra.mfw.util.BlException: File server validation failed because either the file server is not specified, cannot be contacted, or sufficient permissions are not granted on the file server agent to the appserver. Please verify the connectivity between appserver and file server and ensure that the appserver has read write permissions on the file server.

                    at com.bladelogic.om.infra.app.service.file.FileManagerServiceImpl.start(FileManagerServiceImpl.java:226)

                    at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)

                    at sun.reflect.NativeMethodAccessorImpl.invoke(Unknown Source)

                    at sun.reflect.DelegatingMethodAccessorImpl.invoke(Unknown Source)

                    at java.lang.reflect.Method.invoke(Unknown Source)

                    at org.jboss.joinpoint.plugins.reflect.ReflectMethodJoinPoint.dispatch(ReflectMethodJoinPoint.java:72)

                    at org.jboss.kernel.plugins.dependency.KernelControllerContextActions$DispatchJoinPoint.run(KernelControllerContextActions.java:631)

                    at java.security.AccessController.doPrivileged(Native Method)

                    at org.jboss.kernel.plugins.dependency.KernelControllerContextActions.dispatchJoinPoint(KernelControllerContextActions.java:99)

                    at org.jboss.kernel.plugins.dependency.KernelControllerContextActions$LifecycleAction.installAction(KernelControllerContextActions.java:452)

                    at org.jboss.kernel.plugins.dependency.KernelControllerContextActions$1.run(KernelControllerContextActions.java:156)

                    at java.security.AccessController.doPrivileged(Native Method)

                    at org.jboss.kernel.plugins.dependency.KernelControllerContextActions$KernelControllerContextAction.install(KernelControllerContextActions.java:179)

                    at org.jboss.dependency.plugins.AbstractControllerContextActions.install(AbstractControllerContextActions.java:51)

                    at org.jboss.dependency.plugins.AbstractControllerContext.install(AbstractControllerContext.java:226)

                    at org.jboss.dependency.plugins.AbstractController.install(AbstractController.java:593)

                    at org.jboss.dependency.plugins.AbstractController.incrementState(AbstractController.java:346)

                    at org.jboss.dependency.plugins.AbstractController.resolveContexts(AbstractController.java:438)

                    at org.jboss.dependency.plugins.AbstractController.resolveContexts(AbstractController.java:379)

                    at org.jboss.dependency.plugins.AbstractController.install(AbstractController.java:225)

                    at org.jboss.dependency.plugins.AbstractController.install(AbstractController.java:151)

                    at org.jboss.kernel.plugins.deployment.AbstractKernelDeployer.deployBean(AbstractKernelDeployer.java:291)

                    at com.bladelogic.om.infra.app.service.bootstrap.ServiceBeanXMLDeployer.deployBean(ServiceBeanXMLDeployer.java:38)

                    at org.jboss.kernel.plugins.deployment.AbstractKernelDeployer.deployBeans(AbstractKernelDeployer.java:261)

                    at org.jboss.kernel.plugins.deployment.AbstractKernelDeployer.deploy(AbstractKernelDeployer.java:117)

                    at org.jboss.kernel.plugins.deployment.xml.BeanXMLDeployer.deploy(BeanXMLDeployer.java:91)

                    at com.bladelogic.om.infra.app.service.bootstrap.ServiceBootstrap.deploy(ServiceBootstrap.java:252)

                    at com.bladelogic.om.infra.app.service.bootstrap.ServiceBootstrap.deployService(ServiceBootstrap.java:199)

                    at com.bladelogic.om.infra.app.service.bootstrap.ServiceBootstrap.bootstrap(ServiceBootstrap.java:153)

                    at org.jboss.kernel.plugins.bootstrap.AbstractBootstrap.run(AbstractBootstrap.java:91)

                    at com.bladelogic.om.infra.app.service.bootstrap.ServiceBootstrap.startup(ServiceBootstrap.java:66)

                    at com.bladelogic.om.infra.mfw.fw.BlManager.start(BlManager.java:883)

                    at com.bladelogic.om.infra.mfw.fw.BlManager.main(BlManager.java:1403)

                  Caused by: com.bladelogic.om.infra.mfw.util.BlException: File server validation failed because either the file server is not specified, cannot be contacted, or sufficient permissions are not granted on the file server agent to the appserver. Please verify the connectivity between appserver and file server and ensure that the appserver has read write permissions on the file server.

                    at com.bladelogic.om.infra.app.service.file.FileManagerServiceImpl.validateCurrentFileServer(FileManagerServiceImpl.java:406)

                    at com.bladelogic.om.infra.app.service.file.FileManagerServiceImpl.start(FileManagerServiceImpl.java:160)

                    ... 32 more

                  [31 Jul 2013 19:30:07,915] [main] [INFO] [::] [] Starting RBAC Authentication User Service...

                  [31 Jul 2013 19:30:07,915] [main] [INFO] [::] [] RBAC Authentication User Service started.

                  [31 Jul 2013 19:30:07,915] [main] [INFO] [::] [] Starting SSLConnectionManager Service...

                  [31 Jul 2013 19:30:07,978] [main] [INFO] [::] [] SSL-Connections is starting the worker threads

                  [31 Jul 2013 19:30:07,978] [SSL-Connections-Thread-0] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:30:07,978] [SSL-Connections-Thread-1] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:30:07,993] [SSL-Connections-Thread-4] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:30:07,993] [SSL-Connections-Thread-3] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:30:07,993] [SSL-Connections-Thread-7] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:30:07,993] [SSL-Connections-Thread-5] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:30:07,978] [SSL-Connections-Thread-2] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:30:07,993] [main] [INFO] [::] [] SSL-Connections is reserving the controlport

                  [31 Jul 2013 19:30:07,993] [SSL-Connections-Thread-6] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:30:07,993] [SSL-Connections-Thread-9] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:30:07,993] [SSL-Connections-Thread-8] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:30:07,993] [main] [INFO] [::] [] SSL-Connections is establishing control connection...

                  [31 Jul 2013 19:30:07,993] [Thread-8] [INFO] [::] [] SSL-Connections is waiting for control socket ...

                  [31 Jul 2013 19:30:07,993] [Thread-8] [INFO] [::] [] SSL-Connections accepted the control socket connection

                  [31 Jul 2013 19:30:07,993] [main] [INFO] [::] [] SSL-Connections established control connection.

                  [31 Jul 2013 19:30:08,009] [main] [INFO] [::] [] SSL-Connections is starting the selector

                  [31 Jul 2013 19:30:08,009] [main] [INFO] [::] [] SSL-Connections is starting the acceptor

                  [31 Jul 2013 19:30:08,009] [main] [INFO] [::] [] SSLConnectionManager Service started.

                  [31 Jul 2013 19:30:08,009] [main] [INFO] [::] [] Starting Authentication Service...

                  [31 Jul 2013 19:30:08,009] [main] [INFO] [::] [] Authentication-Service is starting worker threads

                  [31 Jul 2013 19:30:08,009] [main] [INFO] [::] [] Authentication Service started.

                  [31 Jul 2013 19:30:08,009] [Authentication-Service-Thread-0] [INFO] [::] [] Authentication Service thread started

                  [31 Jul 2013 19:30:08,009] [Authentication-Service-Thread-2] [INFO] [::] [] Authentication Service thread started

                  [31 Jul 2013 19:30:08,010] [Authentication-Service-Thread-1] [INFO] [::] [] Authentication Service thread started

                  [31 Jul 2013 19:30:08,025] [main] [INFO] [::] [] Starting ClientConnection Service...

                  [31 Jul 2013 19:30:08,416] [main] [INFO] [::] [] Client-Connections is starting the worker threads

                  [31 Jul 2013 19:30:08,416] [Client-Connections-Thread-0] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:30:08,416] [Client-Connections-Thread-1] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:30:08,416] [Client-Connections-Thread-3] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:30:08,416] [Client-Connections-Thread-4] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:30:08,416] [main] [INFO] [::] [] ClientConnection Service started.

                  [31 Jul 2013 19:30:08,416] [Client-Connections-Thread-6] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:30:08,416] [Client-Connections-Thread-5] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:30:08,416] [Client-Connections-Thread-2] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:30:08,416] [Client-Connections-Thread-8] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:30:08,416] [Client-Connections-Thread-9] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:30:08,416] [Client-Connections-Thread-7] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:30:08,432] [main] [INFO] [::] [] Starting Service Lifecycle Service...

                  [31 Jul 2013 19:30:08,432] [main] [INFO] [::] [] Service Lifecycle Service started.

                  [31 Jul 2013 19:30:08,432] [main] [INFO] [::] [] Registering remote services...

                  [31 Jul 2013 19:30:08,432] [main] [INFO] [::] [] Shutdown processes complete

                  [31 Jul 2013 19:30:08,432] [Thread-1] [INFO] [::] [] Undeploying

                  [31 Jul 2013 19:30:08,447] [Thread-1] [ERROR] [::] [] java.rmi.NotBoundException: bladelogic.service.AppServerService

                  [31 Jul 2013 19:42:14,593] [main] [INFO] [::] [] Starting Agent Service...

                  [31 Jul 2013 19:42:14,625] [main] [INFO] [::] [] Agent Service started.

                  [31 Jul 2013 19:42:14,921] [main] [INFO] [::] [] ClientValidation Service started.

                  [31 Jul 2013 19:42:14,921] [main] [INFO] [::] [] Starting Configuration Service...

                  [31 Jul 2013 19:42:14,953] [main] [INFO] [::] [] Configuration Service started.

                  [31 Jul 2013 19:42:14,968] [main] [INFO] [::] [] Starting Content Importer Service...

                  [31 Jul 2013 19:42:14,968] [main] [INFO] [::] [] Content Importer Service started.

                  [31 Jul 2013 19:42:15,328] [main] [INFO] [::] [] Loading JNI libaries...

                  [31 Jul 2013 19:42:15,390] [main] [INFO] [::] [] Loaded JNI library BlAsJni

                  [31 Jul 2013 19:42:15,406] [main] [INFO] [::] [] Loaded JNI library XJNIService

                  [31 Jul 2013 19:42:15,406] [main] [INFO] [::] [] Loaded JNI library Atrium Core

                  [31 Jul 2013 19:42:15,406] [main] [INFO] [::] [] Initializing JNI Configuration...

                  [31 Jul 2013 19:42:15,406] [main] [INFO] [::] [] Initialized JNI library BlAsJni

                  [31 Jul 2013 19:42:15,406] [main] [INFO] [::] [] Initialized JNI library XJNIService

                  [31 Jul 2013 19:42:15,406] [main] [INFO] [::] [] Initialized JNI library Atrium Core

                  [31 Jul 2013 19:42:15,406] [main] [INFO] [::] [] JNI Configuration complete.

                  [31 Jul 2013 19:42:15,421] [main] [INFO] [::] [] Job Infra Manager Service is starting

                  [31 Jul 2013 19:42:15,500] [main] [INFO] [::] [] Starting LDAP Connection Service...

                  [31 Jul 2013 19:42:15,500] [main] [INFO] [::] [] LDAP Connection Service started.

                  [31 Jul 2013 19:42:15,578] [main] [INFO] [::] [] Starting Model Graph Service...

                  [31 Jul 2013 19:42:17,562] [main] [INFO] [::] [] Model Graph Service started.

                  [31 Jul 2013 19:42:17,687] [main] [INFO] [::] [] Starting ObjectExporter Service...

                  [31 Jul 2013 19:42:17,687] [main] [INFO] [::] [] Verifying exporter classes...

                  [31 Jul 2013 19:42:17,875] [main] [INFO] [::] [] Object exporters verified.

                  [31 Jul 2013 19:42:17,875] [main] [INFO] [::] [] ObjectExporter Service started.

                  [31 Jul 2013 19:42:18,078] [main] [INFO] [::] [] Starting PKI Service...

                  [31 Jul 2013 19:42:18,140] [main] [INFO] [::] [] PKI Service started.

                  [31 Jul 2013 19:42:18,156] [main] [INFO] [::] [] Starting LDAP Service...

                  [31 Jul 2013 19:42:18,156] [main] [INFO] [::] [] LDAP service is not configured.

                  [31 Jul 2013 19:42:18,156] [main] [INFO] [::] [] LDAP Service started.

                  [31 Jul 2013 19:42:18,156] [main] [INFO] [::] [] Starting Port Provider...

                  [31 Jul 2013 19:42:18,156] [main] [INFO] [::] [] Port Provider started.

                  [31 Jul 2013 19:42:18,234] [main] [INFO] [::] [] Starting Sizing Service...

                  [31 Jul 2013 19:42:18,234] [main] [INFO] [::] [] Sizing Service started.

                  [31 Jul 2013 19:42:18,234] [main] [INFO] [::] [] Starting Caching Service...

                  [31 Jul 2013 19:42:18,234] [main] [INFO] [::] [] Caching Service started.

                  [31 Jul 2013 19:42:18,234] [main] [INFO] [::] [] Starting Session Service...

                  [31 Jul 2013 19:42:18,250] [main] [INFO] [::] [] Session Service started.

                  [31 Jul 2013 19:42:18,250] [main] [INFO] [::] [] Starting JCIFS Connection Service...

                  [31 Jul 2013 19:42:18,250] [main] [INFO] [::] [] JCIFS Connection Service started.

                  [31 Jul 2013 19:42:18,296] [main] [INFO] [::] [] Starting SSH Connection Service...

                  [31 Jul 2013 19:42:18,296] [main] [INFO] [::] [] SSH Connection Service started.

                  [31 Jul 2013 19:42:18,312] [main] [INFO] [::] [] Starting Task Scheduling Service...

                  [31 Jul 2013 19:42:18,312] [main] [INFO] [::] [] Task Scheduling Service started.

                  [31 Jul 2013 19:42:18,328] [main] [INFO] [::] [] Starting Directory Service...

                  [31 Jul 2013 19:42:18,328] [main] [INFO] [::] [] Starting RMI registry on host: WIN-DFCEVAM1YJX

                  [31 Jul 2013 19:42:18,359] [main] [INFO] [::] [] Directory Service started.

                  [31 Jul 2013 19:42:18,359] [main] [INFO] [::] [] Setting client socket factory: com.bladelogic.om.infra.app.service.client.OMClientSocketFactory

                  [31 Jul 2013 19:42:18,359] [main] [INFO] [::] [] Setting server socket factory: com.bladelogic.om.infra.app.service.client.ServerSocketFactory

                  [31 Jul 2013 19:42:18,359] [main] [INFO] [::] [] Setting authenticator: com.bladelogic.om.infra.app.service.manage.auth.BlSessionServerAuthenticator

                  [31 Jul 2013 19:42:18,359] [main] [INFO] [::] [] Starting Management Service ...

                  [31 Jul 2013 19:42:18,421] [main] [INFO] [::] [] Management Service started.

                  [31 Jul 2013 19:42:18,421] [main] [INFO] [::] [] Starting App Server Data Source...

                  [31 Jul 2013 19:42:18,640] [main] [INFO] [::] [] Initialized connection pool General-Connection-Pool with url = jdbc:sqlserver://WIN-CXMV8389JIF:1433;DatabaseName=Bladelogic_Apps;SelectMethod=cursor and user = sa

                  [31 Jul 2013 19:42:18,687] [main] [INFO] [::] [] Initialized connection pool Job-Connection-Pool with url = jdbc:sqlserver://WIN-CXMV8389JIF:1433;DatabaseName=Bladelogic_Apps;SelectMethod=cursor and user = sa

                  [31 Jul 2013 19:42:18,734] [main] [INFO] [::] [] Initialized connection pool Client-Connection-Pool with url = jdbc:sqlserver://WIN-CXMV8389JIF:1433;DatabaseName=Bladelogic_Apps;SelectMethod=cursor and user = sa

                  [31 Jul 2013 19:42:18,734] [main] [INFO] [::] [] App Server Data Source started.

                  [31 Jul 2013 19:42:18,734] [main] [INFO] [::] [] Starting Instrumentation Service...

                  [31 Jul 2013 19:42:18,734] [main] [INFO] [::] [] Instrumentation Service started.

                  [31 Jul 2013 19:42:18,796] [main] [INFO] [::] [] Starting Database Service...

                  [31 Jul 2013 19:42:19,312] [main] [INFO] [::] [] Loaded C:/Program Files/BMC Software/BladeLogic/NSH/br/deployments/default/sql/sqlmap.properties

                  [31 Jul 2013 19:42:20,328] [main] [INFO] [::] [] Loaded C:/Program Files/BMC Software/BladeLogic/NSH/br/deployments/default/sql/streamable_sqlmap.properties

                  [31 Jul 2013 19:42:20,359] [main] [INFO] [::] [] Database service loaded 2 mapping files.

                  [31 Jul 2013 19:42:20,359] [main] [INFO] [::] [] Database Service started.

                  [31 Jul 2013 19:42:20,546] [main] [INFO] [::] [] Starting App Server Service...

                  [31 Jul 2013 19:42:21,078] [main] [INFO] [::] [] Server: win-dfcevam1yjx; id: 1; RMI Port: 9836

                  [31 Jul 2013 19:42:21,093] [main] [INFO] [::] [] App Server Service started.

                  [31 Jul 2013 19:42:21,093] [main] [INFO] [::] [] Verifying object deleters...

                  [31 Jul 2013 19:42:21,109] [main] [INFO] [::] [] Object deleters verified.

                  [31 Jul 2013 19:42:21,109] [main] [INFO] [::] [] Verifying object soft deleters...

                  [31 Jul 2013 19:42:21,140] [main] [INFO] [::] [] Object soft deleters verified.

                  [31 Jul 2013 19:42:21,140] [main] [INFO] [::] [] Starting Notification Service...

                  [31 Jul 2013 19:42:21,140] [main] [INFO] [::] [] Notification Service started.

                  [31 Jul 2013 19:42:21,140] [main] [INFO] [::] [] Starting Atrium Import Service...

                  [31 Jul 2013 19:42:21,140] [main] [INFO] [::] [] Atrium Import Service started.

                  [31 Jul 2013 19:42:21,140] [main] [INFO] [::] [] Starting Job Executor Service...

                  [31 Jul 2013 19:42:21,140] [main] [INFO] [::] [] Job Executor Service started.

                  [31 Jul 2013 19:42:21,140] [main] [INFO] [::] [] Starting SRP Authentication Service...

                  [31 Jul 2013 19:42:21,156] [main] [INFO] [::] [] SRP Authentication Service started.

                  [31 Jul 2013 19:42:21,171] [main] [INFO] [::] [] Starting RBAC User Service...

                  [31 Jul 2013 19:42:21,171] [main] [INFO] [::] [] RBAC User Service started.

                  [31 Jul 2013 19:42:21,171] [main] [INFO] [::] [] Starting NshProxyConnection Service...

                  [31 Jul 2013 19:42:21,171] [main] [INFO] [::] [] Nsh-Proxy is reserving the controlport

                  [31 Jul 2013 19:42:21,171] [main] [INFO] [::] [] Nsh-Proxy is establishing control connection...

                  [31 Jul 2013 19:42:21,171] [Thread-7] [INFO] [::] [] Nsh-Proxy is waiting for control socket ...

                  [31 Jul 2013 19:42:21,187] [Thread-7] [INFO] [::] [] Nsh-Proxy accepted the control socket connection

                  [31 Jul 2013 19:42:21,187] [main] [INFO] [::] [] Nsh-Proxy established control connection.

                  [31 Jul 2013 19:42:21,187] [main] [INFO] [::] [] Nsh-Proxy is starting the selector

                  [31 Jul 2013 19:42:21,203] [main] [INFO] [::] [] Nsh-Proxy is starting the acceptor

                  [31 Jul 2013 19:42:21,203] [main] [INFO] [::] [] NshProxyConnection Service started.

                  [31 Jul 2013 19:42:21,203] [main] [INFO] [::] [] Starting Event Service...

                  [31 Jul 2013 19:42:21,203] [Event-Processor-Thread-0] [INFO] [::] [] Event processor thread started.

                  [31 Jul 2013 19:42:21,203] [Event-Processor-Thread-1] [INFO] [::] [] Event processor thread started.

                  [31 Jul 2013 19:42:21,203] [Event-Processor-Thread-2] [INFO] [::] [] Event processor thread started.

                  [31 Jul 2013 19:42:21,203] [Event-Processor-Thread-3] [INFO] [::] [] Event processor thread started.

                  [31 Jul 2013 19:42:21,203] [Event-Processor-Thread-4] [INFO] [::] [] Event processor thread started.

                  [31 Jul 2013 19:42:21,220] [Event-Transfer-Thread-0] [INFO] [::] [] Event transfer thread started.

                  [31 Jul 2013 19:42:21,220] [Event-Transfer-Thread-1] [INFO] [::] [] Event transfer thread started.

                  [31 Jul 2013 19:42:21,220] [main] [INFO] [::] [] Event Service started.

                  [31 Jul 2013 19:42:21,220] [main] [INFO] [::] [] Starting Diagnostic Service...

                  [31 Jul 2013 19:42:21,220] [Event-Transfer-Thread-2] [INFO] [::] [] Event transfer thread started.

                  [31 Jul 2013 19:42:21,220] [Event-Dispatcher-Thread] [INFO] [::] [] Event dispatcher thread started.

                  [31 Jul 2013 19:42:21,220] [Event-Transfer-Thread-3] [INFO] [::] [] Event transfer thread started.

                  [31 Jul 2013 19:42:21,220] [Event-Transfer-Thread-4] [INFO] [::] [] Event transfer thread started.

                  [31 Jul 2013 19:42:21,220] [Diagnostic-Test-Runner-Thread-0] [INFO] [::] [] Diagnostic test execution thread started.

                  [31 Jul 2013 19:42:21,220] [Diagnostic-Test-Runner-Thread-2] [INFO] [::] [] Diagnostic test execution thread started.

                  [31 Jul 2013 19:42:21,220] [Diagnostic-Test-Runner-Thread-1] [INFO] [::] [] Diagnostic test execution thread started.

                  [31 Jul 2013 19:42:21,236] [main] [INFO] [::] [] Diagnostic Service started.

                  [31 Jul 2013 19:42:21,236] [main] [INFO] [::] [] Starting RBAC Role Service...

                  [31 Jul 2013 19:42:21,236] [main] [INFO] [::] [] RBAC Role Service started.

                  [31 Jul 2013 19:42:21,236] [main] [INFO] [::] [] Adding method invocation provider: com.bladelogic.om.infra.app.api.manage.APIMethodInvocationProvider

                  [31 Jul 2013 19:42:21,236] [main] [INFO] [::] [] Adding method invocation provider: com.bladelogic.om.infra.app.service.agentservice.AgentMethodInvocationProvider

                  [31 Jul 2013 19:42:21,236] [main] [INFO] [::] [] Starting Schedule Service...

                  [31 Jul 2013 19:42:21,236] [main] [INFO] [::] [] Schedule Service started.

                  [31 Jul 2013 19:42:21,236] [main] [INFO] [::] [] Starting RBAC Service...

                  [31 Jul 2013 19:42:21,236] [main] [INFO] [::] [] Registering Security checkers...

                  [31 Jul 2013 19:42:21,236] [main] [INFO] [::] [] Security checkers registered.

                  [31 Jul 2013 19:42:21,236] [main] [INFO] [::] [] RBAC Service started.

                  [31 Jul 2013 19:42:21,251] [main] [INFO] [::] [] Starting Routing Service...

                  [31 Jul 2013 19:42:24,376] [main] [INFO] [::] [] Routing Service started.

                  [31 Jul 2013 19:42:24,376] [main] [INFO] [::] [] Starting Job Run Service...

                  [31 Jul 2013 19:42:24,392] [main] [INFO] [::] [] Job Run Service started.

                  [31 Jul 2013 19:42:24,392] [main] [INFO] [::] [] Starting Distribution Manager...

                  [31 Jul 2013 19:42:24,423] [main] [INFO] [::] [] Distribution Manager started.

                  [31 Jul 2013 19:42:24,423] [Bl-Exec-0] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:42:24,423] [Bl-Exec-1] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:42:24,423] [Bl-Exec-12] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:42:24,423] [Bl-Exec-14] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:42:24,423] [Bl-Exec-4] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:42:24,423] [Bl-Exec-8] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:42:24,439] [main] [INFO] [::] [] BlExec Service started.

                  [31 Jul 2013 19:42:24,439] [main] [INFO] [::] [] Starting Job Schedule Approval Service...

                  [31 Jul 2013 19:42:24,439] [Bl-Exec-6] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:42:24,439] [Bl-Exec-10] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:42:24,439] [Bl-Exec-16] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:42:24,439] [Bl-Exec-18] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:42:24,439] [Bl-Exec-11] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:42:24,439] [Bl-Exec-9] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:42:24,439] [Bl-Exec-7] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:42:24,439] [Bl-Exec-5] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:42:24,439] [Bl-Exec-3] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:42:24,439] [Bl-Exec-2] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:42:24,439] [Bl-Exec-19] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:42:24,439] [Bl-Exec-17] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:42:24,439] [Bl-Exec-13] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:42:24,439] [Bl-Exec-15] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:42:24,455] [Approval-0] [INFO] [::] [] Approval processor thread started.

                  [31 Jul 2013 19:42:24,470] [Approval-1] [INFO] [::] [] Approval processor thread started.

                  [31 Jul 2013 19:42:24,470] [Approval-2] [INFO] [::] [] Approval processor thread started.

                  [31 Jul 2013 19:42:24,470] [main] [INFO] [::] [] Starting SSLConnectionManager Service...

                  [31 Jul 2013 19:42:24,533] [main] [INFO] [::] [] SSL-Connections is starting the worker threads

                  [31 Jul 2013 19:42:24,533] [SSL-Connections-Thread-0] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:42:24,548] [SSL-Connections-Thread-2] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:42:24,548] [main] [INFO] [::] [] SSL-Connections is reserving the controlport

                  [31 Jul 2013 19:42:24,548] [SSL-Connections-Thread-6] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:42:24,548] [SSL-Connections-Thread-4] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:42:24,548] [main] [INFO] [::] [] SSL-Connections is establishing control connection...

                  [31 Jul 2013 19:42:24,548] [SSL-Connections-Thread-8] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:42:24,548] [Thread-8] [INFO] [::] [] SSL-Connections is waiting for control socket ...

                  [31 Jul 2013 19:42:24,548] [SSL-Connections-Thread-9] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:42:24,548] [SSL-Connections-Thread-1] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:42:24,548] [SSL-Connections-Thread-3] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:42:24,548] [SSL-Connections-Thread-5] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:42:24,548] [Thread-8] [INFO] [::] [] SSL-Connections accepted the control socket connection

                  [31 Jul 2013 19:42:24,548] [main] [INFO] [::] [] SSL-Connections established control connection.

                  [31 Jul 2013 19:42:24,548] [SSL-Connections-Thread-7] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:42:24,564] [main] [INFO] [::] [] SSL-Connections is starting the selector

                  [31 Jul 2013 19:42:24,564] [main] [INFO] [::] [] SSL-Connections is starting the acceptor

                  [31 Jul 2013 19:42:24,564] [main] [INFO] [::] [] SSLConnectionManager Service started.

                  [31 Jul 2013 19:42:24,564] [main] [INFO] [::] [] Starting RBAC Authentication User Service...

                  [31 Jul 2013 19:42:24,564] [main] [INFO] [::] [] RBAC Authentication User Service started.

                  [31 Jul 2013 19:42:24,564] [main] [INFO] [::] [] Starting File Manager Service...

                  [31 Jul 2013 19:42:24,627] [main] [INFO] [::] [] Validating file server host (WIN-CXMV8389JIF)...

                  [31 Jul 2013 19:42:36,409] [main] [ERROR] [::] [] File server validation failed because either the file server is not specified, cannot be contacted, or sufficient permissions are not granted on the file server agent to the appserver. Please verify the connectivity between appserver and file server and ensure that the appserver has read write permissions on the file server.

                  [31 Jul 2013 19:42:36,409] [main] [ERROR] [::] [] Error installing to Start: name=bladelogic.service.FileManagerService state=Create

                  com.bladelogic.om.infra.app.service.ServiceInitializationException: com.bladelogic.om.infra.mfw.util.BlException: File server validation failed because either the file server is not specified, cannot be contacted, or sufficient permissions are not granted on the file server agent to the appserver. Please verify the connectivity between appserver and file server and ensure that the appserver has read write permissions on the file server.

                    at com.bladelogic.om.infra.app.service.file.FileManagerServiceImpl.start(FileManagerServiceImpl.java:226)

                    at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)

                    at sun.reflect.NativeMethodAccessorImpl.invoke(Unknown Source)

                    at sun.reflect.DelegatingMethodAccessorImpl.invoke(Unknown Source)

                    at java.lang.reflect.Method.invoke(Unknown Source)

                    at org.jboss.joinpoint.plugins.reflect.ReflectMethodJoinPoint.dispatch(ReflectMethodJoinPoint.java:72)

                    at org.jboss.kernel.plugins.dependency.KernelControllerContextActions$DispatchJoinPoint.run(KernelControllerContextActions.java:631)

                    at java.security.AccessController.doPrivileged(Native Method)

                    at org.jboss.kernel.plugins.dependency.KernelControllerContextActions.dispatchJoinPoint(KernelControllerContextActions.java:99)

                    at org.jboss.kernel.plugins.dependency.KernelControllerContextActions$LifecycleAction.installAction(KernelControllerContextActions.java:452)

                    at org.jboss.kernel.plugins.dependency.KernelControllerContextActions$1.run(KernelControllerContextActions.java:156)

                    at java.security.AccessController.doPrivileged(Native Method)

                    at org.jboss.kernel.plugins.dependency.KernelControllerContextActions$KernelControllerContextAction.install(KernelControllerContextActions.java:179)

                    at org.jboss.dependency.plugins.AbstractControllerContextActions.install(AbstractControllerContextActions.java:51)

                    at org.jboss.dependency.plugins.AbstractControllerContext.install(AbstractControllerContext.java:226)

                    at org.jboss.dependency.plugins.AbstractController.install(AbstractController.java:593)

                    at org.jboss.dependency.plugins.AbstractController.incrementState(AbstractController.java:346)

                    at org.jboss.dependency.plugins.AbstractController.resolveContexts(AbstractController.java:438)

                    at org.jboss.dependency.plugins.AbstractController.resolveContexts(AbstractController.java:379)

                    at org.jboss.dependency.plugins.AbstractController.install(AbstractController.java:225)

                    at org.jboss.dependency.plugins.AbstractController.install(AbstractController.java:151)

                    at org.jboss.kernel.plugins.deployment.AbstractKernelDeployer.deployBean(AbstractKernelDeployer.java:291)

                    at com.bladelogic.om.infra.app.service.bootstrap.ServiceBeanXMLDeployer.deployBean(ServiceBeanXMLDeployer.java:38)

                    at org.jboss.kernel.plugins.deployment.AbstractKernelDeployer.deployBeans(AbstractKernelDeployer.java:261)

                    at org.jboss.kernel.plugins.deployment.AbstractKernelDeployer.deploy(AbstractKernelDeployer.java:117)

                    at org.jboss.kernel.plugins.deployment.xml.BeanXMLDeployer.deploy(BeanXMLDeployer.java:91)

                    at com.bladelogic.om.infra.app.service.bootstrap.ServiceBootstrap.deploy(ServiceBootstrap.java:252)

                    at com.bladelogic.om.infra.app.service.bootstrap.ServiceBootstrap.deployService(ServiceBootstrap.java:199)

                    at com.bladelogic.om.infra.app.service.bootstrap.ServiceBootstrap.bootstrap(ServiceBootstrap.java:153)

                    at org.jboss.kernel.plugins.bootstrap.AbstractBootstrap.run(AbstractBootstrap.java:91)

                    at com.bladelogic.om.infra.app.service.bootstrap.ServiceBootstrap.startup(ServiceBootstrap.java:66)

                    at com.bladelogic.om.infra.mfw.fw.BlManager.start(BlManager.java:883)

                    at com.bladelogic.om.infra.mfw.fw.BlManager.main(BlManager.java:1403)

                  Caused by: com.bladelogic.om.infra.mfw.util.BlException: File server validation failed because either the file server is not specified, cannot be contacted, or sufficient permissions are not granted on the file server agent to the appserver. Please verify the connectivity between appserver and file server and ensure that the appserver has read write permissions on the file server.

                    at com.bladelogic.om.infra.app.service.file.FileManagerServiceImpl.validateCurrentFileServer(FileManagerServiceImpl.java:406)

                    at com.bladelogic.om.infra.app.service.file.FileManagerServiceImpl.start(FileManagerServiceImpl.java:160)

                    ... 32 more

                  [31 Jul 2013 19:42:36,424] [main] [INFO] [::] [] Starting Authentication Service...

                  [31 Jul 2013 19:42:36,424] [main] [INFO] [::] [] Authentication-Service is starting worker threads

                  [31 Jul 2013 19:42:36,440] [main] [INFO] [::] [] Authentication Service started.

                  [31 Jul 2013 19:42:36,440] [Authentication-Service-Thread-1] [INFO] [::] [] Authentication Service thread started

                  [31 Jul 2013 19:42:36,440] [Authentication-Service-Thread-2] [INFO] [::] [] Authentication Service thread started

                  [31 Jul 2013 19:42:36,440] [Authentication-Service-Thread-0] [INFO] [::] [] Authentication Service thread started

                  [31 Jul 2013 19:42:36,440] [main] [INFO] [::] [] Starting ClientConnection Service...

                  [31 Jul 2013 19:42:36,877] [main] [INFO] [::] [] Client-Connections is starting the worker threads

                  [31 Jul 2013 19:42:36,877] [Client-Connections-Thread-1] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:42:36,877] [Client-Connections-Thread-0] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:42:36,877] [Client-Connections-Thread-4] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:42:36,877] [Client-Connections-Thread-6] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:42:36,877] [Client-Connections-Thread-8] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:42:36,877] [Client-Connections-Thread-2] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:42:36,877] [Client-Connections-Thread-9] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:42:36,877] [Client-Connections-Thread-7] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:42:36,877] [Client-Connections-Thread-5] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:42:36,877] [main] [INFO] [::] [] ClientConnection Service started.

                  [31 Jul 2013 19:42:36,893] [Client-Connections-Thread-3] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:42:36,893] [main] [INFO] [::] [] Starting Service Lifecycle Service...

                  [31 Jul 2013 19:42:36,893] [main] [INFO] [::] [] Service Lifecycle Service started.

                  [31 Jul 2013 19:42:36,893] [main] [INFO] [::] [] Registering remote services...

                  [31 Jul 2013 19:42:36,893] [main] [INFO] [::] [] Shutdown processes complete

                  [31 Jul 2013 19:42:36,893] [Thread-1] [INFO] [::] [] Undeploying

                  [31 Jul 2013 19:42:36,909] [Thread-1] [ERROR] [::] [] java.rmi.NotBoundException: bladelogic.service.AppServerService

                  [31 Jul 2013 19:43:20,137] [main] [INFO] [::] [] Starting Agent Service...

                  [31 Jul 2013 19:43:20,153] [main] [INFO] [::] [] Agent Service started.

                  [31 Jul 2013 19:43:20,262] [main] [INFO] [::] [] ClientValidation Service started.

                  [31 Jul 2013 19:43:20,262] [main] [INFO] [::] [] Starting Configuration Service...

                  [31 Jul 2013 19:43:20,293] [main] [INFO] [::] [] Configuration Service started.

                  [31 Jul 2013 19:43:20,309] [main] [INFO] [::] [] Starting Content Importer Service...

                  [31 Jul 2013 19:43:20,309] [main] [INFO] [::] [] Content Importer Service started.

                  [31 Jul 2013 19:43:20,496] [main] [INFO] [::] [] Loading JNI libaries...

                  [31 Jul 2013 19:43:20,528] [main] [INFO] [::] [] Loaded JNI library BlAsJni

                  [31 Jul 2013 19:43:20,528] [main] [INFO] [::] [] Loaded JNI library XJNIService

                  [31 Jul 2013 19:43:20,528] [main] [INFO] [::] [] Loaded JNI library Atrium Core

                  [31 Jul 2013 19:43:20,528] [main] [INFO] [::] [] Initializing JNI Configuration...

                  [31 Jul 2013 19:43:20,528] [main] [INFO] [::] [] Initialized JNI library BlAsJni

                  [31 Jul 2013 19:43:20,543] [main] [INFO] [::] [] Initialized JNI library XJNIService

                  [31 Jul 2013 19:43:20,543] [main] [INFO] [::] [] Initialized JNI library Atrium Core

                  [31 Jul 2013 19:43:20,543] [main] [INFO] [::] [] JNI Configuration complete.

                  [31 Jul 2013 19:43:20,543] [main] [INFO] [::] [] Job Infra Manager Service is starting

                  [31 Jul 2013 19:43:20,575] [main] [INFO] [::] [] Starting LDAP Connection Service...

                  [31 Jul 2013 19:43:20,575] [main] [INFO] [::] [] LDAP Connection Service started.

                  [31 Jul 2013 19:43:20,653] [main] [INFO] [::] [] Starting Model Graph Service...

                  [31 Jul 2013 19:43:22,309] [main] [INFO] [::] [] Model Graph Service started.

                  [31 Jul 2013 19:43:22,403] [main] [INFO] [::] [] Starting ObjectExporter Service...

                  [31 Jul 2013 19:43:22,403] [main] [INFO] [::] [] Verifying exporter classes...

                  [31 Jul 2013 19:43:22,403] [main] [INFO] [::] [] Object exporters verified.

                  [31 Jul 2013 19:43:22,403] [main] [INFO] [::] [] ObjectExporter Service started.

                  [31 Jul 2013 19:43:22,418] [main] [INFO] [::] [] Starting PKI Service...

                  [31 Jul 2013 19:43:22,434] [main] [INFO] [::] [] PKI Service started.

                  [31 Jul 2013 19:43:22,434] [main] [INFO] [::] [] Starting LDAP Service...

                  [31 Jul 2013 19:43:22,434] [main] [INFO] [::] [] LDAP service is not configured.

                  [31 Jul 2013 19:43:22,434] [main] [INFO] [::] [] LDAP Service started.

                  [31 Jul 2013 19:43:22,450] [main] [INFO] [::] [] Starting Port Provider...

                  [31 Jul 2013 19:43:22,450] [main] [INFO] [::] [] Port Provider started.

                  [31 Jul 2013 19:43:22,481] [main] [INFO] [::] [] Starting Sizing Service...

                  [31 Jul 2013 19:43:22,481] [main] [INFO] [::] [] Sizing Service started.

                  [31 Jul 2013 19:43:22,481] [main] [INFO] [::] [] Starting Caching Service...

                  [31 Jul 2013 19:43:22,481] [main] [INFO] [::] [] Caching Service started.

                  [31 Jul 2013 19:43:22,496] [main] [INFO] [::] [] Starting Session Service...

                  [31 Jul 2013 19:43:22,496] [main] [INFO] [::] [] Session Service started.

                  [31 Jul 2013 19:43:22,496] [main] [INFO] [::] [] Starting JCIFS Connection Service...

                  [31 Jul 2013 19:43:22,496] [main] [INFO] [::] [] JCIFS Connection Service started.

                  [31 Jul 2013 19:43:22,528] [main] [INFO] [::] [] Starting SSH Connection Service...

                  [31 Jul 2013 19:43:22,528] [main] [INFO] [::] [] SSH Connection Service started.

                  [31 Jul 2013 19:43:22,543] [main] [INFO] [::] [] Starting Task Scheduling Service...

                  [31 Jul 2013 19:43:22,543] [main] [INFO] [::] [] Task Scheduling Service started.

                  [31 Jul 2013 19:43:22,543] [main] [INFO] [::] [] Starting Directory Service...

                  [31 Jul 2013 19:43:22,559] [main] [INFO] [::] [] Starting RMI registry on host: WIN-DFCEVAM1YJX

                  [31 Jul 2013 19:43:22,575] [main] [INFO] [::] [] Directory Service started.

                  [31 Jul 2013 19:43:22,590] [main] [INFO] [::] [] Setting client socket factory: com.bladelogic.om.infra.app.service.client.OMClientSocketFactory

                  [31 Jul 2013 19:43:22,590] [main] [INFO] [::] [] Setting server socket factory: com.bladelogic.om.infra.app.service.client.ServerSocketFactory

                  [31 Jul 2013 19:43:22,590] [main] [INFO] [::] [] Setting authenticator: com.bladelogic.om.infra.app.service.manage.auth.BlSessionServerAuthenticator

                  [31 Jul 2013 19:43:22,590] [main] [INFO] [::] [] Starting Management Service ...

                  [31 Jul 2013 19:43:22,653] [main] [INFO] [::] [] Management Service started.

                  [31 Jul 2013 19:43:22,668] [main] [INFO] [::] [] Starting App Server Data Source...

                  [31 Jul 2013 19:43:23,137] [main] [INFO] [::] [] Initialized connection pool General-Connection-Pool with url = jdbc:sqlserver://WIN-CXMV8389JIF:1433;DatabaseName=Bladelogic_Apps;SelectMethod=cursor and user = sa

                  [31 Jul 2013 19:43:23,168] [main] [INFO] [::] [] Initialized connection pool Job-Connection-Pool with url = jdbc:sqlserver://WIN-CXMV8389JIF:1433;DatabaseName=Bladelogic_Apps;SelectMethod=cursor and user = sa

                  [31 Jul 2013 19:43:23,200] [main] [INFO] [::] [] Initialized connection pool Client-Connection-Pool with url = jdbc:sqlserver://WIN-CXMV8389JIF:1433;DatabaseName=Bladelogic_Apps;SelectMethod=cursor and user = sa

                  [31 Jul 2013 19:43:23,200] [main] [INFO] [::] [] App Server Data Source started.

                  [31 Jul 2013 19:43:23,200] [main] [INFO] [::] [] Starting Instrumentation Service...

                  [31 Jul 2013 19:43:23,200] [main] [INFO] [::] [] Instrumentation Service started.

                  [31 Jul 2013 19:43:23,262] [main] [INFO] [::] [] Starting Database Service...

                  [31 Jul 2013 19:43:23,278] [main] [INFO] [::] [] Loaded C:/Program Files/BMC Software/BladeLogic/NSH/br/deployments/default/sql/sqlmap.properties

                  [31 Jul 2013 19:43:23,340] [main] [INFO] [::] [] Loaded C:/Program Files/BMC Software/BladeLogic/NSH/br/deployments/default/sql/streamable_sqlmap.properties

                  [31 Jul 2013 19:43:23,371] [main] [INFO] [::] [] Database service loaded 2 mapping files.

                  [31 Jul 2013 19:43:23,371] [main] [INFO] [::] [] Database Service started.

                  [31 Jul 2013 19:43:23,606] [main] [INFO] [::] [] Starting Notification Service...

                  [31 Jul 2013 19:43:23,606] [main] [INFO] [::] [] Notification Service started.

                  [31 Jul 2013 19:43:23,606] [main] [INFO] [::] [] Verifying object deleters...

                  [31 Jul 2013 19:43:23,621] [main] [INFO] [::] [] Object deleters verified.

                  [31 Jul 2013 19:43:23,621] [main] [INFO] [::] [] Verifying object soft deleters...

                  [31 Jul 2013 19:43:23,637] [main] [INFO] [::] [] Object soft deleters verified.

                  [31 Jul 2013 19:43:23,637] [main] [INFO] [::] [] Starting SRP Authentication Service...

                  [31 Jul 2013 19:43:23,668] [main] [INFO] [::] [] SRP Authentication Service started.

                  [31 Jul 2013 19:43:23,684] [main] [INFO] [::] [] Starting Job Executor Service...

                  [31 Jul 2013 19:43:23,684] [main] [INFO] [::] [] Job Executor Service started.

                  [31 Jul 2013 19:43:23,684] [main] [INFO] [::] [] Starting Atrium Import Service...

                  [31 Jul 2013 19:43:23,684] [main] [INFO] [::] [] Atrium Import Service started.

                  [31 Jul 2013 19:43:23,684] [main] [INFO] [::] [] Starting App Server Service...

                  [31 Jul 2013 19:43:24,200] [main] [INFO] [::] [] Server: win-dfcevam1yjx; id: 1; RMI Port: 9836

                  [31 Jul 2013 19:43:24,215] [main] [INFO] [::] [] App Server Service started.

                  [31 Jul 2013 19:43:24,231] [main] [INFO] [::] [] Starting Event Service...

                  [31 Jul 2013 19:43:24,246] [Event-Processor-Thread-0] [INFO] [::] [] Event processor thread started.

                  [31 Jul 2013 19:43:24,293] [Event-Transfer-Thread-3] [INFO] [::] [] Event transfer thread started.

                  [31 Jul 2013 19:43:24,293] [Event-Transfer-Thread-2] [INFO] [::] [] Event transfer thread started.

                  [31 Jul 2013 19:43:24,293] [Event-Transfer-Thread-1] [INFO] [::] [] Event transfer thread started.

                  [31 Jul 2013 19:43:24,293] [Event-Processor-Thread-4] [INFO] [::] [] Event processor thread started.

                  [31 Jul 2013 19:43:24,293] [Event-Processor-Thread-1] [INFO] [::] [] Event processor thread started.

                  [31 Jul 2013 19:43:24,278] [Event-Processor-Thread-2] [INFO] [::] [] Event processor thread started.

                  [31 Jul 2013 19:43:24,278] [Event-Dispatcher-Thread] [INFO] [::] [] Event dispatcher thread started.

                  [31 Jul 2013 19:43:24,293] [Event-Transfer-Thread-0] [INFO] [::] [] Event transfer thread started.

                  [31 Jul 2013 19:43:24,278] [Event-Processor-Thread-3] [INFO] [::] [] Event processor thread started.

                  [31 Jul 2013 19:43:24,278] [main] [INFO] [::] [] Event Service started.

                  [31 Jul 2013 19:43:24,293] [main] [INFO] [::] [] Starting Diagnostic Service...

                  [31 Jul 2013 19:43:24,293] [Event-Transfer-Thread-4] [INFO] [::] [] Event transfer thread started.

                  [31 Jul 2013 19:43:24,293] [Diagnostic-Test-Runner-Thread-0] [INFO] [::] [] Diagnostic test execution thread started.

                  [31 Jul 2013 19:43:24,293] [Diagnostic-Test-Runner-Thread-2] [INFO] [::] [] Diagnostic test execution thread started.

                  [31 Jul 2013 19:43:24,293] [Diagnostic-Test-Runner-Thread-1] [INFO] [::] [] Diagnostic test execution thread started.

                  [31 Jul 2013 19:43:24,293] [main] [INFO] [::] [] Diagnostic Service started.

                  [31 Jul 2013 19:43:24,293] [main] [INFO] [::] [] Starting RBAC Role Service...

                  [31 Jul 2013 19:43:24,293] [main] [INFO] [::] [] RBAC Role Service started.

                  [31 Jul 2013 19:43:24,293] [main] [INFO] [::] [] Starting RBAC User Service...

                  [31 Jul 2013 19:43:24,293] [main] [INFO] [::] [] RBAC User Service started.

                  [31 Jul 2013 19:43:24,293] [main] [INFO] [::] [] Starting NshProxyConnection Service...

                  [31 Jul 2013 19:43:24,293] [main] [INFO] [::] [] Nsh-Proxy is reserving the controlport

                  [31 Jul 2013 19:43:24,309] [main] [INFO] [::] [] Nsh-Proxy is establishing control connection...

                  [31 Jul 2013 19:43:24,309] [Thread-7] [INFO] [::] [] Nsh-Proxy is waiting for control socket ...

                  [31 Jul 2013 19:43:24,309] [Thread-7] [INFO] [::] [] Nsh-Proxy accepted the control socket connection

                  [31 Jul 2013 19:43:24,309] [main] [INFO] [::] [] Nsh-Proxy established control connection.

                  [31 Jul 2013 19:43:24,309] [main] [INFO] [::] [] Nsh-Proxy is starting the selector

                  [31 Jul 2013 19:43:24,309] [main] [INFO] [::] [] Nsh-Proxy is starting the acceptor

                  [31 Jul 2013 19:43:24,309] [main] [INFO] [::] [] NshProxyConnection Service started.

                  [31 Jul 2013 19:43:24,325] [main] [INFO] [::] [] Adding method invocation provider: com.bladelogic.om.infra.app.api.manage.APIMethodInvocationProvider

                  [31 Jul 2013 19:43:24,325] [main] [INFO] [::] [] Adding method invocation provider: com.bladelogic.om.infra.app.service.agentservice.AgentMethodInvocationProvider

                  [31 Jul 2013 19:43:24,341] [Bl-Exec-0] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:43:24,341] [Bl-Exec-3] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:43:24,341] [Bl-Exec-1] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:43:24,341] [Bl-Exec-2] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:43:24,341] [Bl-Exec-4] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:43:24,341] [Bl-Exec-5] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:43:24,341] [Bl-Exec-6] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:43:24,341] [Bl-Exec-9] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:43:24,341] [Bl-Exec-7] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:43:24,341] [Bl-Exec-8] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:43:24,341] [Bl-Exec-12] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:43:24,341] [Bl-Exec-19] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:43:24,341] [Bl-Exec-14] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:43:24,341] [Bl-Exec-17] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:43:24,341] [Bl-Exec-15] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:43:24,341] [Bl-Exec-13] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:43:24,341] [Bl-Exec-11] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:43:24,341] [Bl-Exec-16] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:43:24,341] [Bl-Exec-18] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:43:24,341] [Bl-Exec-10] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 19:43:24,341] [main] [INFO] [::] [] BlExec Service started.

                  [31 Jul 2013 19:43:24,341] [main] [INFO] [::] [] Starting Schedule Service...

                  [31 Jul 2013 19:43:24,341] [main] [INFO] [::] [] Schedule Service started.

                  [31 Jul 2013 19:43:24,341] [main] [INFO] [::] [] Starting Routing Service...

                  [31 Jul 2013 19:43:26,669] [main] [INFO] [::] [] Routing Service started.

                  [31 Jul 2013 19:43:26,669] [main] [INFO] [::] [] Starting Job Run Service...

                  [31 Jul 2013 19:43:26,669] [main] [INFO] [::] [] Job Run Service started.

                  [31 Jul 2013 19:43:26,669] [main] [INFO] [::] [] Starting Job Schedule Approval Service...

                  [31 Jul 2013 19:43:26,685] [main] [INFO] [::] [] Starting RBAC Service...

                  [31 Jul 2013 19:43:26,685] [main] [INFO] [::] [] Registering Security checkers...

                  [31 Jul 2013 19:43:26,685] [Approval-0] [INFO] [::] [] Approval processor thread started.

                  [31 Jul 2013 19:43:26,685] [main] [INFO] [::] [] Security checkers registered.

                  [31 Jul 2013 19:43:26,685] [main] [INFO] [::] [] RBAC Service started.

                  [31 Jul 2013 19:43:26,685] [main] [INFO] [::] [] Starting Distribution Manager...

                  [31 Jul 2013 19:43:26,685] [Approval-1] [INFO] [::] [] Approval processor thread started.

                  [31 Jul 2013 19:43:26,700] [Approval-2] [INFO] [::] [] Approval processor thread started.

                  [31 Jul 2013 19:43:26,700] [main] [INFO] [::] [] Distribution Manager started.

                  [31 Jul 2013 19:43:26,700] [main] [INFO] [::] [] Starting RBAC Authentication User Service...

                  [31 Jul 2013 19:43:26,700] [main] [INFO] [::] [] RBAC Authentication User Service started.

                  [31 Jul 2013 19:43:26,700] [main] [INFO] [::] [] Starting SSLConnectionManager Service...

                  [31 Jul 2013 19:43:26,716] [main] [INFO] [::] [] SSL-Connections is starting the worker threads

                  [31 Jul 2013 19:43:26,716] [SSL-Connections-Thread-0] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:43:26,716] [SSL-Connections-Thread-1] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:43:26,716] [SSL-Connections-Thread-2] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:43:26,716] [SSL-Connections-Thread-4] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:43:26,716] [SSL-Connections-Thread-5] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:43:26,716] [main] [INFO] [::] [] SSL-Connections is reserving the controlport

                  [31 Jul 2013 19:43:26,716] [SSL-Connections-Thread-8] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:43:26,716] [SSL-Connections-Thread-7] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:43:26,716] [main] [INFO] [::] [] SSL-Connections is establishing control connection...

                  [31 Jul 2013 19:43:26,732] [SSL-Connections-Thread-6] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:43:26,732] [SSL-Connections-Thread-3] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:43:26,732] [SSL-Connections-Thread-9] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:43:26,732] [Thread-8] [INFO] [::] [] SSL-Connections is waiting for control socket ...

                  [31 Jul 2013 19:43:26,732] [Thread-8] [INFO] [::] [] SSL-Connections accepted the control socket connection

                  [31 Jul 2013 19:43:26,732] [main] [INFO] [::] [] SSL-Connections established control connection.

                  [31 Jul 2013 19:43:26,732] [main] [INFO] [::] [] SSL-Connections is starting the selector

                  [31 Jul 2013 19:43:26,732] [main] [INFO] [::] [] SSL-Connections is starting the acceptor

                  [31 Jul 2013 19:43:26,732] [main] [INFO] [::] [] SSLConnectionManager Service started.

                  [31 Jul 2013 19:43:26,732] [main] [INFO] [::] [] Starting File Manager Service...

                  [31 Jul 2013 19:43:26,748] [main] [INFO] [::] [] Validating file server host (WIN-CXMV8389JIF)...

                  [31 Jul 2013 19:43:28,373] [main] [ERROR] [::] [] File server validation failed because either the file server is not specified, cannot be contacted, or sufficient permissions are not granted on the file server agent to the appserver. Please verify the connectivity between appserver and file server and ensure that the appserver has read write permissions on the file server.

                  [31 Jul 2013 19:43:28,373] [main] [ERROR] [::] [] Error installing to Start: name=bladelogic.service.FileManagerService state=Create

                  com.bladelogic.om.infra.app.service.ServiceInitializationException: com.bladelogic.om.infra.mfw.util.BlException: File server validation failed because either the file server is not specified, cannot be contacted, or sufficient permissions are not granted on the file server agent to the appserver. Please verify the connectivity between appserver and file server and ensure that the appserver has read write permissions on the file server.

                    at com.bladelogic.om.infra.app.service.file.FileManagerServiceImpl.start(FileManagerServiceImpl.java:226)

                    at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)

                    at sun.reflect.NativeMethodAccessorImpl.invoke(Unknown Source)

                    at sun.reflect.DelegatingMethodAccessorImpl.invoke(Unknown Source)

                    at java.lang.reflect.Method.invoke(Unknown Source)

                    at org.jboss.joinpoint.plugins.reflect.ReflectMethodJoinPoint.dispatch(ReflectMethodJoinPoint.java:72)

                    at org.jboss.kernel.plugins.dependency.KernelControllerContextActions$DispatchJoinPoint.run(KernelControllerContextActions.java:631)

                    at java.security.AccessController.doPrivileged(Native Method)

                    at org.jboss.kernel.plugins.dependency.KernelControllerContextActions.dispatchJoinPoint(KernelControllerContextActions.java:99)

                    at org.jboss.kernel.plugins.dependency.KernelControllerContextActions$LifecycleAction.installAction(KernelControllerContextActions.java:452)

                    at org.jboss.kernel.plugins.dependency.KernelControllerContextActions$1.run(KernelControllerContextActions.java:156)

                    at java.security.AccessController.doPrivileged(Native Method)

                    at org.jboss.kernel.plugins.dependency.KernelControllerContextActions$KernelControllerContextAction.install(KernelControllerContextActions.java:179)

                    at org.jboss.dependency.plugins.AbstractControllerContextActions.install(AbstractControllerContextActions.java:51)

                    at org.jboss.dependency.plugins.AbstractControllerContext.install(AbstractControllerContext.java:226)

                    at org.jboss.dependency.plugins.AbstractController.install(AbstractController.java:593)

                    at org.jboss.dependency.plugins.AbstractController.incrementState(AbstractController.java:346)

                    at org.jboss.dependency.plugins.AbstractController.resolveContexts(AbstractController.java:438)

                    at org.jboss.dependency.plugins.AbstractController.resolveContexts(AbstractController.java:379)

                    at org.jboss.dependency.plugins.AbstractController.install(AbstractController.java:225)

                    at org.jboss.dependency.plugins.AbstractController.install(AbstractController.java:151)

                    at org.jboss.kernel.plugins.deployment.AbstractKernelDeployer.deployBean(AbstractKernelDeployer.java:291)

                    at com.bladelogic.om.infra.app.service.bootstrap.ServiceBeanXMLDeployer.deployBean(ServiceBeanXMLDeployer.java:38)

                    at org.jboss.kernel.plugins.deployment.AbstractKernelDeployer.deployBeans(AbstractKernelDeployer.java:261)

                    at org.jboss.kernel.plugins.deployment.AbstractKernelDeployer.deploy(AbstractKernelDeployer.java:117)

                    at org.jboss.kernel.plugins.deployment.xml.BeanXMLDeployer.deploy(BeanXMLDeployer.java:91)

                    at com.bladelogic.om.infra.app.service.bootstrap.ServiceBootstrap.deploy(ServiceBootstrap.java:252)

                    at com.bladelogic.om.infra.app.service.bootstrap.ServiceBootstrap.deployService(ServiceBootstrap.java:199)

                    at com.bladelogic.om.infra.app.service.bootstrap.ServiceBootstrap.bootstrap(ServiceBootstrap.java:153)

                    at org.jboss.kernel.plugins.bootstrap.AbstractBootstrap.run(AbstractBootstrap.java:91)

                    at com.bladelogic.om.infra.app.service.bootstrap.ServiceBootstrap.startup(ServiceBootstrap.java:66)

                    at com.bladelogic.om.infra.mfw.fw.BlManager.start(BlManager.java:883)

                    at com.bladelogic.om.infra.mfw.fw.BlManager.main(BlManager.java:1403)

                  Caused by: com.bladelogic.om.infra.mfw.util.BlException: File server validation failed because either the file server is not specified, cannot be contacted, or sufficient permissions are not granted on the file server agent to the appserver. Please verify the connectivity between appserver and file server and ensure that the appserver has read write permissions on the file server.

                    at com.bladelogic.om.infra.app.service.file.FileManagerServiceImpl.validateCurrentFileServer(FileManagerServiceImpl.java:406)

                    at com.bladelogic.om.infra.app.service.file.FileManagerServiceImpl.start(FileManagerServiceImpl.java:160)

                    ... 32 more

                  [31 Jul 2013 19:43:28,389] [main] [INFO] [::] [] Starting Authentication Service...

                  [31 Jul 2013 19:43:28,389] [main] [INFO] [::] [] Authentication-Service is starting worker threads

                  [31 Jul 2013 19:43:28,405] [Authentication-Service-Thread-0] [INFO] [::] [] Authentication Service thread started

                  [31 Jul 2013 19:43:28,405] [Authentication-Service-Thread-1] [INFO] [::] [] Authentication Service thread started

                  [31 Jul 2013 19:43:28,405] [main] [INFO] [::] [] Authentication Service started.

                  [31 Jul 2013 19:43:28,405] [Authentication-Service-Thread-2] [INFO] [::] [] Authentication Service thread started

                  [31 Jul 2013 19:43:28,405] [main] [INFO] [::] [] Starting ClientConnection Service...

                  [31 Jul 2013 19:43:28,530] [main] [INFO] [::] [] Client-Connections is starting the worker threads

                  [31 Jul 2013 19:43:28,530] [main] [INFO] [::] [] ClientConnection Service started.

                  [31 Jul 2013 19:43:28,530] [Client-Connections-Thread-0] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:43:28,530] [Client-Connections-Thread-8] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:43:28,530] [Client-Connections-Thread-6] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:43:28,530] [Client-Connections-Thread-2] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:43:28,545] [Client-Connections-Thread-1] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:43:28,545] [Client-Connections-Thread-4] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:43:28,545] [Client-Connections-Thread-3] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:43:28,545] [Client-Connections-Thread-5] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:43:28,530] [Client-Connections-Thread-7] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:43:28,530] [Client-Connections-Thread-9] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 19:43:28,545] [main] [INFO] [::] [] Starting Service Lifecycle Service...

                  [31 Jul 2013 19:43:28,545] [main] [INFO] [::] [] Service Lifecycle Service started.

                  [31 Jul 2013 19:43:28,545] [main] [INFO] [::] [] Registering remote services...

                  [31 Jul 2013 19:43:28,545] [main] [INFO] [::] [] Shutdown processes complete

                  [31 Jul 2013 19:43:28,545] [Thread-1] [INFO] [::] [] Undeploying

                  [31 Jul 2013 19:43:28,764] [Thread-1] [ERROR] [::] [] java.rmi.NotBoundException: bladelogic.service.AppServerService

                  [31 Jul 2013 20:04:51,201] [main] [INFO] [::] [] Starting Agent Service...

                  [31 Jul 2013 20:04:51,280] [main] [INFO] [::] [] Agent Service started.

                  [31 Jul 2013 20:04:52,717] [main] [INFO] [::] [] ClientValidation Service started.

                  [31 Jul 2013 20:04:52,733] [main] [INFO] [::] [] Starting Configuration Service...

                  [31 Jul 2013 20:04:52,873] [main] [INFO] [::] [] Configuration Service started.

                  [31 Jul 2013 20:04:52,967] [main] [INFO] [::] [] Starting Content Importer Service...

                  [31 Jul 2013 20:04:52,967] [main] [INFO] [::] [] Content Importer Service started.

                  [31 Jul 2013 20:04:54,186] [main] [INFO] [::] [] Loading JNI libaries...

                  [31 Jul 2013 20:04:54,920] [main] [INFO] [::] [] Loaded JNI library BlAsJni

                  [31 Jul 2013 20:04:54,983] [main] [INFO] [::] [] Loaded JNI library XJNIService

                  [31 Jul 2013 20:04:54,983] [main] [INFO] [::] [] Loaded JNI library Atrium Core

                  [31 Jul 2013 20:04:54,983] [main] [INFO] [::] [] Initializing JNI Configuration...

                  [31 Jul 2013 20:04:54,998] [main] [INFO] [::] [] Initialized JNI library BlAsJni

                  [31 Jul 2013 20:04:55,030] [main] [INFO] [::] [] Initialized JNI library XJNIService

                  [31 Jul 2013 20:04:55,030] [main] [INFO] [::] [] Initialized JNI library Atrium Core

                  [31 Jul 2013 20:04:55,030] [main] [INFO] [::] [] JNI Configuration complete.

                  [31 Jul 2013 20:04:55,123] [main] [INFO] [::] [] Job Infra Manager Service is starting

                  [31 Jul 2013 20:04:55,186] [main] [INFO] [::] [] Starting LDAP Connection Service...

                  [31 Jul 2013 20:04:55,186] [main] [INFO] [::] [] LDAP Connection Service started.

                  [31 Jul 2013 20:04:55,733] [main] [INFO] [::] [] Starting Model Graph Service...

                  [31 Jul 2013 20:05:13,311] [main] [INFO] [::] [] Model Graph Service started.

                  [31 Jul 2013 20:05:13,451] [main] [INFO] [::] [] Starting ObjectExporter Service...

                  [31 Jul 2013 20:05:13,451] [main] [INFO] [::] [] Verifying exporter classes...

                  [31 Jul 2013 20:05:13,561] [main] [INFO] [::] [] Object exporters verified.

                  [31 Jul 2013 20:05:13,561] [main] [INFO] [::] [] ObjectExporter Service started.

                  [31 Jul 2013 20:05:13,608] [main] [INFO] [::] [] Starting PKI Service...

                  [31 Jul 2013 20:05:13,686] [main] [INFO] [::] [] PKI Service started.

                  [31 Jul 2013 20:05:13,701] [main] [INFO] [::] [] Starting LDAP Service...

                  [31 Jul 2013 20:05:13,717] [main] [INFO] [::] [] LDAP service is not configured.

                  [31 Jul 2013 20:05:13,717] [main] [INFO] [::] [] LDAP Service started.

                  [31 Jul 2013 20:05:13,733] [main] [INFO] [::] [] Starting Port Provider...

                  [31 Jul 2013 20:05:13,733] [main] [INFO] [::] [] Port Provider started.

                  [31 Jul 2013 20:05:13,936] [main] [INFO] [::] [] Starting Sizing Service...

                  [31 Jul 2013 20:05:13,936] [main] [INFO] [::] [] Sizing Service started.

                  [31 Jul 2013 20:05:13,936] [main] [INFO] [::] [] Starting Caching Service...

                  [31 Jul 2013 20:05:13,936] [main] [INFO] [::] [] Caching Service started.

                  [31 Jul 2013 20:05:13,951] [main] [INFO] [::] [] Starting Session Service...

                  [31 Jul 2013 20:05:13,967] [main] [INFO] [::] [] Session Service started.

                  [31 Jul 2013 20:05:14,014] [main] [INFO] [::] [] Starting JCIFS Connection Service...

                  [31 Jul 2013 20:05:14,014] [main] [INFO] [::] [] JCIFS Connection Service started.

                  [31 Jul 2013 20:05:14,201] [main] [INFO] [::] [] Starting SSH Connection Service...

                  [31 Jul 2013 20:05:14,217] [main] [INFO] [::] [] SSH Connection Service started.

                  [31 Jul 2013 20:05:14,358] [main] [INFO] [::] [] Starting Task Scheduling Service...

                  [31 Jul 2013 20:05:14,373] [main] [INFO] [::] [] Task Scheduling Service started.

                  [31 Jul 2013 20:05:14,451] [main] [INFO] [::] [] Starting Directory Service...

                  [31 Jul 2013 20:05:14,498] [main] [INFO] [::] [] Starting RMI registry on host: WIN-DFCEVAM1YJX

                  [31 Jul 2013 20:05:15,061] [main] [INFO] [::] [] Directory Service started.

                  [31 Jul 2013 20:05:15,514] [main] [INFO] [::] [] Setting server socket factory: com.bladelogic.om.infra.app.service.client.ServerSocketFactory

                  [31 Jul 2013 20:05:15,530] [main] [INFO] [::] [] Setting authenticator: com.bladelogic.om.infra.app.service.manage.auth.BlSessionServerAuthenticator

                  [31 Jul 2013 20:05:15,545] [main] [INFO] [::] [] Setting client socket factory: com.bladelogic.om.infra.app.service.client.OMClientSocketFactory

                  [31 Jul 2013 20:05:15,842] [main] [INFO] [::] [] Starting Management Service ...

                  [31 Jul 2013 20:05:17,201] [main] [INFO] [::] [] Management Service started.

                  [31 Jul 2013 20:05:17,280] [main] [INFO] [::] [] Starting Instrumentation Service...

                  [31 Jul 2013 20:05:17,342] [main] [INFO] [::] [] Instrumentation Service started.

                  [31 Jul 2013 20:05:17,358] [main] [INFO] [::] [] Starting App Server Data Source...

                  [31 Jul 2013 20:05:19,655] [main] [INFO] [::] [] Initialized connection pool General-Connection-Pool with url = jdbc:sqlserver://WIN-CXMV8389JIF:1433;DatabaseName=Bladelogic_Apps;SelectMethod=cursor and user = sa

                  [31 Jul 2013 20:05:19,686] [main] [INFO] [::] [] Initialized connection pool Job-Connection-Pool with url = jdbc:sqlserver://WIN-CXMV8389JIF:1433;DatabaseName=Bladelogic_Apps;SelectMethod=cursor and user = sa

                  [31 Jul 2013 20:05:19,733] [main] [INFO] [::] [] Initialized connection pool Client-Connection-Pool with url = jdbc:sqlserver://WIN-CXMV8389JIF:1433;DatabaseName=Bladelogic_Apps;SelectMethod=cursor and user = sa

                  [31 Jul 2013 20:05:19,733] [main] [INFO] [::] [] App Server Data Source started.

                  [31 Jul 2013 20:05:19,780] [main] [INFO] [::] [] Starting Database Service...

                  [31 Jul 2013 20:05:19,811] [main] [INFO] [::] [] Loaded C:/Program Files/BMC Software/BladeLogic/NSH/br/deployments/default/sql/sqlmap.properties

                  [31 Jul 2013 20:05:19,936] [main] [INFO] [::] [] Loaded C:/Program Files/BMC Software/BladeLogic/NSH/br/deployments/default/sql/streamable_sqlmap.properties

                  [31 Jul 2013 20:05:20,092] [main] [INFO] [::] [] Database service loaded 2 mapping files.

                  [31 Jul 2013 20:05:20,092] [main] [INFO] [::] [] Database Service started.

                  [31 Jul 2013 20:05:21,998] [main] [INFO] [::] [] Verifying object deleters...

                  [31 Jul 2013 20:05:22,014] [main] [INFO] [::] [] Object deleters verified.

                  [31 Jul 2013 20:05:22,014] [main] [INFO] [::] [] Verifying object soft deleters...

                  [31 Jul 2013 20:05:22,155] [main] [INFO] [::] [] Object soft deleters verified.

                  [31 Jul 2013 20:05:22,155] [main] [INFO] [::] [] Starting App Server Service...

                  [31 Jul 2013 20:05:27,701] [main] [INFO] [::] [] Server: win-dfcevam1yjx; id: 1; RMI Port: 9836

                  [31 Jul 2013 20:05:27,748] [main] [INFO] [::] [] App Server Service started.

                  [31 Jul 2013 20:05:27,748] [main] [INFO] [::] [] Starting Notification Service...

                  [31 Jul 2013 20:05:27,764] [main] [INFO] [::] [] Notification Service started.

                  [31 Jul 2013 20:05:27,764] [main] [INFO] [::] [] Starting Job Executor Service...

                  [31 Jul 2013 20:05:27,764] [main] [INFO] [::] [] Job Executor Service started.

                  [31 Jul 2013 20:05:27,764] [main] [INFO] [::] [] Starting SRP Authentication Service...

                  [31 Jul 2013 20:05:27,858] [main] [INFO] [::] [] SRP Authentication Service started.

                  [31 Jul 2013 20:05:27,858] [main] [INFO] [::] [] Starting Atrium Import Service...

                  [31 Jul 2013 20:05:27,858] [main] [INFO] [::] [] Atrium Import Service started.

                  [31 Jul 2013 20:05:27,967] [main] [INFO] [::] [] Starting RBAC User Service...

                  [31 Jul 2013 20:05:27,967] [main] [INFO] [::] [] RBAC User Service started.

                  [31 Jul 2013 20:05:27,967] [main] [INFO] [::] [] Starting NshProxyConnection Service...

                  [31 Jul 2013 20:05:27,967] [main] [INFO] [::] [] Nsh-Proxy is reserving the controlport

                  [31 Jul 2013 20:05:27,998] [main] [INFO] [::] [] Nsh-Proxy is establishing control connection...

                  [31 Jul 2013 20:05:27,998] [Thread-7] [INFO] [::] [] Nsh-Proxy is waiting for control socket ...

                  [31 Jul 2013 20:05:27,998] [Thread-7] [INFO] [::] [] Nsh-Proxy accepted the control socket connection

                  [31 Jul 2013 20:05:27,998] [main] [INFO] [::] [] Nsh-Proxy established control connection.

                  [31 Jul 2013 20:05:28,045] [main] [INFO] [::] [] Nsh-Proxy is starting the selector

                  [31 Jul 2013 20:05:28,045] [main] [INFO] [::] [] Nsh-Proxy is starting the acceptor

                  [31 Jul 2013 20:05:28,045] [main] [INFO] [::] [] NshProxyConnection Service started.

                  [31 Jul 2013 20:05:28,045] [main] [INFO] [::] [] Starting Event Service...

                  [31 Jul 2013 20:05:28,097] [Event-Processor-Thread-0] [INFO] [::] [] Event processor thread started.

                  [31 Jul 2013 20:05:28,097] [Event-Processor-Thread-1] [INFO] [::] [] Event processor thread started.

                  [31 Jul 2013 20:05:28,097] [Event-Processor-Thread-2] [INFO] [::] [] Event processor thread started.

                  [31 Jul 2013 20:05:28,097] [Event-Processor-Thread-3] [INFO] [::] [] Event processor thread started.

                  [31 Jul 2013 20:05:28,097] [Event-Processor-Thread-4] [INFO] [::] [] Event processor thread started.

                  [31 Jul 2013 20:05:28,113] [Event-Transfer-Thread-0] [INFO] [::] [] Event transfer thread started.

                  [31 Jul 2013 20:05:28,113] [Event-Transfer-Thread-1] [INFO] [::] [] Event transfer thread started.

                  [31 Jul 2013 20:05:28,159] [Event-Transfer-Thread-3] [INFO] [::] [] Event transfer thread started.

                  [31 Jul 2013 20:05:28,159] [Event-Transfer-Thread-2] [INFO] [::] [] Event transfer thread started.

                  [31 Jul 2013 20:05:28,159] [Event-Transfer-Thread-4] [INFO] [::] [] Event transfer thread started.

                  [31 Jul 2013 20:05:28,159] [main] [INFO] [::] [] Event Service started.

                  [31 Jul 2013 20:05:28,159] [main] [INFO] [::] [] Starting Diagnostic Service...

                  [31 Jul 2013 20:05:28,159] [Event-Dispatcher-Thread] [INFO] [::] [] Event dispatcher thread started.

                  [31 Jul 2013 20:05:28,191] [Diagnostic-Test-Runner-Thread-0] [INFO] [::] [] Diagnostic test execution thread started.

                  [31 Jul 2013 20:05:28,206] [Diagnostic-Test-Runner-Thread-2] [INFO] [::] [] Diagnostic test execution thread started.

                  [31 Jul 2013 20:05:28,222] [Diagnostic-Test-Runner-Thread-1] [INFO] [::] [] Diagnostic test execution thread started.

                  [31 Jul 2013 20:05:28,222] [main] [INFO] [::] [] Diagnostic Service started.

                  [31 Jul 2013 20:05:28,222] [main] [INFO] [::] [] Starting RBAC Role Service...

                  [31 Jul 2013 20:05:28,222] [main] [INFO] [::] [] RBAC Role Service started.

                  [31 Jul 2013 20:05:28,222] [main] [INFO] [::] [] Adding method invocation provider: com.bladelogic.om.infra.app.api.manage.APIMethodInvocationProvider

                  [31 Jul 2013 20:05:28,222] [main] [INFO] [::] [] Adding method invocation provider: com.bladelogic.om.infra.app.service.agentservice.AgentMethodInvocationProvider

                  [31 Jul 2013 20:05:28,238] [main] [INFO] [::] [] Starting Schedule Service...

                  [31 Jul 2013 20:05:28,238] [main] [INFO] [::] [] Schedule Service started.

                  [31 Jul 2013 20:05:28,238] [main] [INFO] [::] [] Starting RBAC Service...

                  [31 Jul 2013 20:05:28,238] [main] [INFO] [::] [] Registering Security checkers...

                  [31 Jul 2013 20:05:28,238] [main] [INFO] [::] [] Security checkers registered.

                  [31 Jul 2013 20:05:28,238] [main] [INFO] [::] [] RBAC Service started.

                  [31 Jul 2013 20:05:28,238] [main] [INFO] [::] [] Starting Job Schedule Approval Service...

                  [31 Jul 2013 20:05:28,316] [Approval-0] [INFO] [::] [] Approval processor thread started.

                  [31 Jul 2013 20:05:28,331] [Approval-1] [INFO] [::] [] Approval processor thread started.

                  [31 Jul 2013 20:05:28,331] [Approval-2] [INFO] [::] [] Approval processor thread started.

                  [31 Jul 2013 20:05:28,394] [Bl-Exec-0] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 20:05:28,394] [Bl-Exec-2] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 20:05:28,441] [Bl-Exec-7] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 20:05:28,441] [Bl-Exec-8] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 20:05:28,441] [Bl-Exec-9] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 20:05:28,441] [Bl-Exec-11] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 20:05:28,441] [Bl-Exec-10] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 20:05:28,456] [Bl-Exec-6] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 20:05:28,456] [Bl-Exec-13] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 20:05:28,472] [Bl-Exec-12] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 20:05:28,472] [Bl-Exec-14] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 20:05:28,488] [Bl-Exec-16] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 20:05:28,488] [main] [INFO] [::] [] BlExec Service started.

                  [31 Jul 2013 20:05:28,488] [main] [INFO] [::] [] Starting Routing Service...

                  [31 Jul 2013 20:05:28,488] [Bl-Exec-18] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 20:05:28,503] [Bl-Exec-17] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 20:05:28,503] [Bl-Exec-4] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 20:05:28,503] [Bl-Exec-1] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 20:05:28,503] [Bl-Exec-3] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 20:05:28,534] [Bl-Exec-15] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 20:05:28,534] [Bl-Exec-5] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 20:05:28,675] [Bl-Exec-19] [INFO] [::] [] BlExec worker thread started.

                  [31 Jul 2013 20:05:35,191] [main] [INFO] [::] [] Routing Service started.

                  [31 Jul 2013 20:05:35,191] [main] [INFO] [::] [] Starting Job Run Service...

                  [31 Jul 2013 20:05:35,206] [main] [INFO] [::] [] Job Run Service started.

                  [31 Jul 2013 20:05:35,206] [main] [INFO] [::] [] Starting Distribution Manager...

                  [31 Jul 2013 20:05:35,222] [main] [INFO] [::] [] Distribution Manager started.

                  [31 Jul 2013 20:05:35,238] [main] [INFO] [::] [] Starting SSLConnectionManager Service...

                  [31 Jul 2013 20:05:35,269] [main] [INFO] [::] [] SSL-Connections is starting the worker threads

                  [31 Jul 2013 20:05:35,284] [SSL-Connections-Thread-0] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 20:05:35,284] [SSL-Connections-Thread-1] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 20:05:35,300] [SSL-Connections-Thread-2] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 20:05:35,331] [SSL-Connections-Thread-6] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 20:05:35,331] [SSL-Connections-Thread-5] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 20:05:35,331] [SSL-Connections-Thread-3] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 20:05:35,331] [SSL-Connections-Thread-4] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 20:05:35,363] [SSL-Connections-Thread-8] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 20:05:35,363] [main] [INFO] [::] [] SSL-Connections is reserving the controlport

                  [31 Jul 2013 20:05:35,378] [SSL-Connections-Thread-9] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 20:05:35,378] [main] [INFO] [::] [] SSL-Connections is establishing control connection...

                  [31 Jul 2013 20:05:35,378] [SSL-Connections-Thread-7] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 20:05:35,378] [Thread-8] [INFO] [::] [] SSL-Connections is waiting for control socket ...

                  [31 Jul 2013 20:05:35,378] [Thread-8] [INFO] [::] [] SSL-Connections accepted the control socket connection

                  [31 Jul 2013 20:05:35,378] [main] [INFO] [::] [] SSL-Connections established control connection.

                  [31 Jul 2013 20:05:35,394] [main] [INFO] [::] [] SSL-Connections is starting the selector

                  [31 Jul 2013 20:05:35,409] [main] [INFO] [::] [] SSL-Connections is starting the acceptor

                  [31 Jul 2013 20:05:35,409] [main] [INFO] [::] [] SSLConnectionManager Service started.

                  [31 Jul 2013 20:05:35,409] [main] [INFO] [::] [] Starting File Manager Service...

                  [31 Jul 2013 20:05:35,427] [main] [INFO] [::] [] Validating file server host (WIN-CXMV8389JIF)...

                  [31 Jul 2013 20:05:44,818] [main] [ERROR] [::] [] File server validation failed because either the file server is not specified, cannot be contacted, or sufficient permissions are not granted on the file server agent to the appserver. Please verify the connectivity between appserver and file server and ensure that the appserver has read write permissions on the file server.

                  [31 Jul 2013 20:05:44,818] [main] [ERROR] [::] [] Error installing to Start: name=bladelogic.service.FileManagerService state=Create

                  com.bladelogic.om.infra.app.service.ServiceInitializationException: com.bladelogic.om.infra.mfw.util.BlException: File server validation failed because either the file server is not specified, cannot be contacted, or sufficient permissions are not granted on the file server agent to the appserver. Please verify the connectivity between appserver and file server and ensure that the appserver has read write permissions on the file server.

                    at com.bladelogic.om.infra.app.service.file.FileManagerServiceImpl.start(FileManagerServiceImpl.java:226)

                    at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)

                    at sun.reflect.NativeMethodAccessorImpl.invoke(Unknown Source)

                    at sun.reflect.DelegatingMethodAccessorImpl.invoke(Unknown Source)

                    at java.lang.reflect.Method.invoke(Unknown Source)

                    at org.jboss.joinpoint.plugins.reflect.ReflectMethodJoinPoint.dispatch(ReflectMethodJoinPoint.java:72)

                    at org.jboss.kernel.plugins.dependency.KernelControllerContextActions$DispatchJoinPoint.run(KernelControllerContextActions.java:631)

                    at java.security.AccessController.doPrivileged(Native Method)

                    at org.jboss.kernel.plugins.dependency.KernelControllerContextActions.dispatchJoinPoint(KernelControllerContextActions.java:99)

                    at org.jboss.kernel.plugins.dependency.KernelControllerContextActions$LifecycleAction.installAction(KernelControllerContextActions.java:452)

                    at org.jboss.kernel.plugins.dependency.KernelControllerContextActions$1.run(KernelControllerContextActions.java:156)

                    at java.security.AccessController.doPrivileged(Native Method)

                    at org.jboss.kernel.plugins.dependency.KernelControllerContextActions$KernelControllerContextAction.install(KernelControllerContextActions.java:179)

                    at org.jboss.dependency.plugins.AbstractControllerContextActions.install(AbstractControllerContextActions.java:51)

                    at org.jboss.dependency.plugins.AbstractControllerContext.install(AbstractControllerContext.java:226)

                    at org.jboss.dependency.plugins.AbstractController.install(AbstractController.java:593)

                    at org.jboss.dependency.plugins.AbstractController.incrementState(AbstractController.java:346)

                    at org.jboss.dependency.plugins.AbstractController.resolveContexts(AbstractController.java:438)

                    at org.jboss.dependency.plugins.AbstractController.resolveContexts(AbstractController.java:379)

                    at org.jboss.dependency.plugins.AbstractController.install(AbstractController.java:225)

                    at org.jboss.dependency.plugins.AbstractController.install(AbstractController.java:151)

                    at org.jboss.kernel.plugins.deployment.AbstractKernelDeployer.deployBean(AbstractKernelDeployer.java:291)

                    at com.bladelogic.om.infra.app.service.bootstrap.ServiceBeanXMLDeployer.deployBean(ServiceBeanXMLDeployer.java:38)

                    at org.jboss.kernel.plugins.deployment.AbstractKernelDeployer.deployBeans(AbstractKernelDeployer.java:261)

                    at org.jboss.kernel.plugins.deployment.AbstractKernelDeployer.deploy(AbstractKernelDeployer.java:117)

                    at org.jboss.kernel.plugins.deployment.xml.BeanXMLDeployer.deploy(BeanXMLDeployer.java:91)

                    at com.bladelogic.om.infra.app.service.bootstrap.ServiceBootstrap.deploy(ServiceBootstrap.java:252)

                    at com.bladelogic.om.infra.app.service.bootstrap.ServiceBootstrap.deployService(ServiceBootstrap.java:199)

                    at com.bladelogic.om.infra.app.service.bootstrap.ServiceBootstrap.bootstrap(ServiceBootstrap.java:153)

                    at org.jboss.kernel.plugins.bootstrap.AbstractBootstrap.run(AbstractBootstrap.java:91)

                    at com.bladelogic.om.infra.app.service.bootstrap.ServiceBootstrap.startup(ServiceBootstrap.java:66)

                    at com.bladelogic.om.infra.mfw.fw.BlManager.start(BlManager.java:883)

                    at com.bladelogic.om.infra.mfw.fw.BlManager.main(BlManager.java:1403)

                  Caused by: com.bladelogic.om.infra.mfw.util.BlException: File server validation failed because either the file server is not specified, cannot be contacted, or sufficient permissions are not granted on the file server agent to the appserver. Please verify the connectivity between appserver and file server and ensure that the appserver has read write permissions on the file server.

                    at com.bladelogic.om.infra.app.service.file.FileManagerServiceImpl.validateCurrentFileServer(FileManagerServiceImpl.java:406)

                    at com.bladelogic.om.infra.app.service.file.FileManagerServiceImpl.start(FileManagerServiceImpl.java:160)

                    ... 32 more

                  [31 Jul 2013 20:05:44,833] [main] [INFO] [::] [] Starting RBAC Authentication User Service...

                  [31 Jul 2013 20:05:44,833] [main] [INFO] [::] [] RBAC Authentication User Service started.

                  [31 Jul 2013 20:05:44,849] [main] [INFO] [::] [] Starting Authentication Service...

                  [31 Jul 2013 20:05:44,849] [main] [INFO] [::] [] Authentication-Service is starting worker threads

                  [31 Jul 2013 20:05:44,849] [main] [INFO] [::] [] Authentication Service started.

                  [31 Jul 2013 20:05:44,849] [Authentication-Service-Thread-1] [INFO] [::] [] Authentication Service thread started

                  [31 Jul 2013 20:05:44,849] [Authentication-Service-Thread-0] [INFO] [::] [] Authentication Service thread started

                  [31 Jul 2013 20:05:44,849] [Authentication-Service-Thread-2] [INFO] [::] [] Authentication Service thread started

                  [31 Jul 2013 20:05:44,849] [main] [INFO] [::] [] Starting ClientConnection Service...

                  [31 Jul 2013 20:05:45,505] [main] [INFO] [::] [] Client-Connections is starting the worker threads

                  [31 Jul 2013 20:05:45,505] [Client-Connections-Thread-0] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 20:05:45,568] [Client-Connections-Thread-3] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 20:05:45,583] [Client-Connections-Thread-1] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 20:05:45,583] [Client-Connections-Thread-4] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 20:05:45,599] [Client-Connections-Thread-5] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 20:05:45,599] [Client-Connections-Thread-7] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 20:05:45,599] [Client-Connections-Thread-6] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 20:05:45,599] [main] [INFO] [::] [] ClientConnection Service started.

                  [31 Jul 2013 20:05:45,615] [Client-Connections-Thread-8] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 20:05:45,615] [Client-Connections-Thread-9] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 20:05:45,615] [Client-Connections-Thread-2] [INFO] [::] [] Client worker thread started.

                  [31 Jul 2013 20:05:45,646] [main] [INFO] [::] [] Starting Service Lifecycle Service...

                  [31 Jul 2013 20:05:45,646] [main] [INFO] [::] [] Service Lifecycle Service started.

                  [31 Jul 2013 20:05:45,646] [main] [INFO] [::] [] Registering remote services...

                  [31 Jul 2013 20:05:45,646] [main] [INFO] [::] [] Shutdown processes complete

                  [31 Jul 2013 20:05:45,646] [Thread-1] [INFO] [::] [] Undeploying

                  [31 Jul 2013 20:05:45,661] [Thread-1] [ERROR] [::] [] java.rmi.NotBoundException: bladelogic.service.AppServerService

                  • 6. Re: BBSA Application server service is not starting
                    Aryan Anantwar

                    Hi James,

                     

                    The Error in logs:

                    "File server validation failed because either the file server is not specified, cannot be contacted, or sufficient permissions are not granted on the file server agent to the appserver. Please verify the connectivity between appserver and file server and ensure that the appserver has read write permissions on the file server."

                     

                    Clearly specifies that there is an permission issue.

                    Execute "agentinfo" command against the Fileserver from AppServer's NSH prompt.

                    Share the result of it.

                    Also it would be easy to provide you the correct solution,

                    if you share the contents of exports, users, users.local file.

                     

                    Regards,

                    Aryan Anantwar

                    • 7. Re: BBSA Application server service is not starting
                      Alan Nakashian-Holsberg

                      Your fileserver ACLs are not set properly.

                       

                      Please add the following to users.local:

                       

                      System:System rw,map=(administrator for windows or root for unix based)

                       

                      If you still see

                       

                      Caused by: com.bladelogic.om.infra.mfw.util.BlException: File server validation failed because either the file server is not specified, cannot be contacted, or sufficient permissions are not granted on the file server agent to the appserver. Please verify the connectivity between appserver and file server and ensure that the appserver has read write permissions on the file server.

                       

                      in the appserver.log change the entry to "System:system rw,map=(administrator for windows or root for unix based)", there are certain scenarios where the second "system" needs to be lowercase.

                       

                      Alan

                      • 8. Re: BBSA Application server service is not starting

                        Exports file

                        "rw,user=Administrators"

                         

                         

                        User.local

                        BLADmins:BLAdmin rw,map=Administrator”

                        RBACAdmins:RBACAdmin rw,map=Administrator”

                        • 9. Re: BBSA Application server service is not starting
                          Steffen Kreis
                          You need to add:

                          System: System rw,map=Administrator

                           

                          In your users.local file.

                           

                          Steffen

                          • 10. Re: BBSA Application server service is not starting
                            Steffen Kreis

                            Oh and there is a capital D in BLAdmin which is probably also not correct.

                             

                            Just have a look at the rscd.log on your file server. This will tell you in detail, who is trying to access it and why it is not working.

                            • 11. Re: BBSA Application server service is not starting
                              Aryan Anantwar

                              Hey James,

                               

                              The entries are wrong.

                               

                              Please correct as below:

                               

                              Exports:

                              * rw          or  rw=Hostname of AppServer

                               

                              User.local:

                              BLAdmins:BLAdmin      rw,map=Administrator     (Uppercase/lowercase typo in your entry)


                              no need to map RBACAdmin, because RBACAdmin performs operations on only BLAppServer regarding Access Control only.

                              So, it won't need any permissions on target agents.


                              Please go through the BSA documentation:


                              https://docs.bmc.com/docs/display/public/bsa83/Setting+up+configuration+files


                              Regards,

                              Aryan Anantwar



                              • 12. Re: BBSA Application server service is not starting
                                Alan Nakashian-Holsberg

                                James,

                                 

                                Please see my last post. 

                                 

                                Alan

                                • 13. Re: BBSA Application server service is not starting

                                  Hi All,

                                   

                                  I tried Every thing i.e

                                   

                                  In Export file

                                  *rw

                                  rw,user=Administrator

                                   

                                  and In user.local file

                                  BLAdmins:BLAdmin rw, map=Administrator

                                  System:system rw,map=Administrator

                                   

                                  still no success.

                                  • 14. Re: BBSA Application server service is not starting

                                    Hi James,

                                     

                                    Are you using Windows 2008R2 SP1 enterprise to install BladeLogic Application Server?

                                     

                                    Thank you,

                                    Nandkumar

                                    1 2 3 Previous Next