[root@cstlb2 ~]# tail -f /var/log/ovirt-engine/engine.log
2015-09-10 02:43:40,516 INFO [org.ovirt.engine.core.bll.OvfDataUpdater] (DefaultQuartzScheduler_Worker-30) Attempting to update VMs/Templates Ovf.
2015-09-10 03:35:35,000 INFO [org.ovirt.engine.core.bll.AuditLogCleanupManager] (DefaultQuartzScheduler_Worker-12) Start deleteAgedOutAuditLogs
2015-09-10 03:35:35,000 INFO [org.ovirt.engine.core.bll.AuditLogCleanupManager] (DefaultQuartzScheduler_Worker-91) Start deleteAgedOutCommandEntities
2015-09-10 03:35:35,002 INFO [org.ovirt.engine.core.bll.AuditLogCleanupManager] (DefaultQuartzScheduler_Worker-12) Finished deleteAgedOutAuditLogs
2015-09-10 03:35:35,003 INFO [org.ovirt.engine.core.bll.AuditLogCleanupManager] (DefaultQuartzScheduler_Worker-91) Finished deleteAgedOutCommandEntities
2015-09-10 03:43:40,517 INFO [org.ovirt.engine.core.bll.OvfDataUpdater] (DefaultQuartzScheduler_Worker-39) Attempting to update VMs/Templates Ovf.
2015-09-10 04:43:40,518 INFO [org.ovirt.engine.core.bll.OvfDataUpdater] (DefaultQuartzScheduler_Worker-74) Attempting to update VMs/Templates Ovf.
2015-09-10 05:43:40,519 INFO [org.ovirt.engine.core.bll.OvfDataUpdater] (DefaultQuartzScheduler_Worker-39) Attempting to update VMs/Templates Ovf.
2015-09-10 06:43:40,518 INFO [org.ovirt.engine.core.bll.OvfDataUpdater] (DefaultQuartzScheduler_Worker-26) Attempting to update VMs/Templates Ovf.
2015-09-10 07:43:40,519 INFO [org.ovirt.engine.core.bll.OvfDataUpdater] (DefaultQuartzScheduler_Worker-41) Attempting to update VMs/Templates Ovf.
2015-09-10 08:42:53,870 INFO [org.ovirt.engine.core.bll.aaa.LoginAdminUserCommand] (ajp--127.0.0.1-8702-8) Running command: LoginAdminUserCommand internal: false.
2015-09-10 08:42:53,876 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (ajp--127.0.0.1-8702-8) Correlation ID: null, Call Stack: null, Custom Event ID: -1, Message: User admin@internal logged in.
2015-09-10 08:43:20,267 ERROR [org.ovirt.engine.core.bll.AddVdsCommand] (ajp--127.0.0.1-8702-1) [639ed9cc] Failed to establish session with host test: org.apache.sshd.common.RuntimeSshException: Failed to get the session.
at org.apache.sshd.client.future.DefaultConnectFuture.getSession(DefaultConnectFuture.java:43)
at org.ovirt.engine.core.uutils.ssh.SSHClient.connect(SSHClient.java:294) [uutils.jar:]
at org.ovirt.engine.core.bll.utils.EngineSSHClient.connect(EngineSSHClient.java:59) [bll.jar:]
at org.ovirt.engine.core.bll.AddVdsCommand.canConnect(AddVdsCommand.java:465) [bll.jar:]
at org.ovirt.engine.core.bll.AddVdsCommand.canDoAction(AddVdsCommand.java:364) [bll.jar:]
at org.ovirt.engine.core.bll.CommandBase.internalCanDoAction(CommandBase.java:768) [bll.jar:]
at org.ovirt.engine.core.bll.CommandBase.executeAction(CommandBase.java:347) [bll.jar:]
at org.ovirt.engine.core.bll.Backend.runAction(Backend.java:435) [bll.jar:]
at org.ovirt.engine.core.bll.Backend.runActionImpl(Backend.java:416) [bll.jar:]
at org.ovirt.engine.core.bll.Backend.runAction(Backend.java:374) [bll.jar:]
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method) [rt.jar:1.7.0_85]
at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57) [rt.jar:1.7.0_85]
at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) [rt.jar:1.7.0_85]
at java.lang.reflect.Method.invoke(Method.java:606) [rt.jar:1.7.0_85]
at org.jboss.as.ee.component.ManagedReferenceMethodInterceptorFactory$ManagedReferenceMethodInterceptor.processInvocation(ManagedReferenceMethodInterceptorFactory.java:72) [jboss-as-ee-7.1.1.Final.jar:7.1.1.Final]
at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation-1.1.1.Final.jar:1.1.1.Final]
at org.jboss.invocation.InterceptorContext$Invocation.proceed(InterceptorContext.java:374) [jboss-invocation-1.1.1.Final.jar:1.1.1.Final]
at org.jboss.as.weld.ejb.Jsr299BindingsInterceptor.delegateInterception(Jsr299BindingsInterceptor.java:114) [jboss-as-weld-7.1.1.Final.jar:7.1.1.Final]
at org.jboss.as.weld.ejb.Jsr299BindingsInterceptor.doMethodInterception(Jsr299BindingsInterceptor.java:125) [jboss-as-weld-7.1.1.Final.jar:7.1.1.Final]
at org.jboss.as.weld.ejb.Jsr299BindingsInterceptor.processInvocation(Jsr299BindingsInterceptor.java:135) [jboss-as-weld-7.1.1.Final.jar:7.1.1.Final]
at org.jboss.as.ee.component.interceptors.UserInterceptorFactory$1.processInvocation(UserInterceptorFactory.java:36) [jboss-as-ee-7.1.1.Final.jar:7.1.1.Final]
at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation-1.1.1.Final.jar:1.1.1.Final]
at org.jboss.invocation.InterceptorContext$Invocation.proceed(InterceptorContext.java:374) [jboss-invocation-1.1.1.Final.jar:1.1.1.Final]
at org.ovirt.engine.core.bll.interceptors.ThreadLocalSessionCleanerInterceptor.injectWebContextToThreadLocal(ThreadLocalSessionCleanerInterceptor.java:13) [bll.jar:]
at sun.reflect.GeneratedMethodAccessor16.invoke(Unknown Source) [:1.7.0_85]
at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) [rt.jar:1.7.0_85]
at java.lang.reflect.Method.invoke(Method.java:606) [rt.jar:1.7.0_85]
at org.jboss.as.ee.component.ManagedReferenceLifecycleMethodInterceptorFactory$ManagedReferenceLifecycleMethodInterceptor.processInvocation(ManagedReferenceLifecycleMethodInterceptorFactory.java:123) [jboss-as-ee-7.1.1.Final.jar:7.1.1.Final]
at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation-1.1.1.Final.jar:1.1.1.Final]
at org.jboss.invocation.WeavedInterceptor.processInvocation(WeavedInterceptor.java:53) [jboss-invocation-1.1.1.Final.jar:1.1.1.Final]
at org.jboss.as.ee.component.interceptors.UserInterceptorFactory$1.processInvocation(UserInterceptorFactory.java:36) [jboss-as-ee-7.1.1.Final.jar:7.1.1.Final]
at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation-1.1.1.Final.jar:1.1.1.Final]
at org.jboss.as.weld.ejb.EjbRequestScopeActivationInterceptor.processInvocation(EjbRequestScopeActivationInterceptor.java:82) [jboss-as-weld-7.1.1.Final.jar:7.1.1.Final]
at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation-1.1.1.Final.jar:1.1.1.Final]
at org.jboss.invocation.InitialInterceptor.processInvocation(InitialInterceptor.java:21) [jboss-invocation-1.1.1.Final.jar:1.1.1.Final]
at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation-1.1.1.Final.jar:1.1.1.Final]
at org.jboss.invocation.ChainedInterceptor.processInvocation(ChainedInterceptor.java:61) [jboss-invocation-1.1.1.Final.jar:1.1.1.Final]
at org.jboss.as.ee.component.interceptors.ComponentDispatcherInterceptor.processInvocation(ComponentDispatcherInterceptor.java:53) [jboss-as-ee-7.1.1.Final.jar:7.1.1.Final]
at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation-1.1.1.Final.jar:1.1.1.Final]
at org.jboss.as.ejb3.component.singleton.SingletonComponentInstanceAssociationInterceptor.processInvocation(SingletonComponentInstanceAssociationInterceptor.java:53) [jboss-as-ejb3-7.1.1.Final.jar:7.1.1.Final]
at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation-1.1.1.Final.jar:1.1.1.Final]
at org.jboss.as.ejb3.tx.CMTTxInterceptor.invokeInNoTx(CMTTxInterceptor.java:211) [jboss-as-ejb3-7.1.1.Final.jar:7.1.1.Final]
at org.jboss.as.ejb3.tx.CMTTxInterceptor.supports(CMTTxInterceptor.java:363) [jboss-as-ejb3-7.1.1.Final.jar:7.1.1.Final]
at org.jboss.as.ejb3.tx.CMTTxInterceptor.processInvocation(CMTTxInterceptor.java:194) [jboss-as-ejb3-7.1.1.Final.jar:7.1.1.Final]
at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation-1.1.1.Final.jar:1.1.1.Final]
at org.jboss.as.ejb3.component.interceptors.CurrentInvocationContextInterceptor.processInvocation(CurrentInvocationContextInterceptor.java:41) [jboss-as-ejb3-7.1.1.Final.jar:7.1.1.Final]
at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation-1.1.1.Final.jar:1.1.1.Final]
at org.jboss.as.ejb3.component.interceptors.LoggingInterceptor.processInvocation(LoggingInterceptor.java:59) [jboss-as-ejb3-7.1.1.Final.jar:7.1.1.Final]
at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation-1.1.1.Final.jar:1.1.1.Final]
at org.jboss.as.ee.component.NamespaceContextInterceptor.processInvocation(NamespaceContextInterceptor.java:50) [jboss-as-ee-7.1.1.Final.jar:7.1.1.Final]
at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation-1.1.1.Final.jar:1.1.1.Final]
at org.jboss.as.ee.component.TCCLInterceptor.processInvocation(TCCLInterceptor.java:45) [jboss-as-ee-7.1.1.Final.jar:7.1.1.Final]
at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation-1.1.1.Final.jar:1.1.1.Final]
at org.jboss.invocation.ChainedInterceptor.processInvocation(ChainedInterceptor.java:61) [jboss-invocation-1.1.1.Final.jar:1.1.1.Final]
at org.jboss.as.ee.component.ViewService$View.invoke(ViewService.java:165) [jboss-as-ee-7.1.1.Final.jar:7.1.1.Final]
at org.jboss.as.ee.component.ViewDescription$1.processInvocation(ViewDescription.java:173) [jboss-as-ee-7.1.1.Final.jar:7.1.1.Final]
at org.jboss.invocation.InterceptorContext.proceed(InterceptorContext.java:288) [jboss-invocation-1.1.1.Final.jar:1.1.1.Final]
at org.jboss.invocation.ChainedInterceptor.processInvocation(ChainedInterceptor.java:61) [jboss-invocation-1.1.1.Final.jar:1.1.1.Final]
at org.jboss.as.ee.component.ProxyInvocationHandler.invoke(ProxyInvocationHandler.java:72) [jboss-as-ee-7.1.1.Final.jar:7.1.1.Final]
at org.ovirt.engine.core.common.interfaces.BackendLocal$$$view8.runAction(Unknown Source) [common.jar:]
at org.ovirt.engine.ui.frontend.server.gwt.GenericApiGWTServiceImpl.runAction(GenericApiGWTServiceImpl.java:134)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method) [rt.jar:1.7.0_85]
at sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57) [rt.jar:1.7.0_85]
at sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl.java:43) [rt.jar:1.7.0_85]
at java.lang.reflect.Method.invoke(Method.java:606) [rt.jar:1.7.0_85]
at com.google.gwt.rpc.server.RPC.invokeAndStreamResponse(RPC.java:196)
at com.google.gwt.rpc.server.RpcServlet.processCall(RpcServlet.java:172)
at com.google.gwt.rpc.server.RpcServlet.processPost(RpcServlet.java:233)
at com.google.gwt.user.server.rpc.AbstractRemoteServiceServlet.doPost(AbstractRemoteServiceServlet.java:62)
at javax.servlet.http.HttpServlet.service(HttpServlet.java:754) [jboss-servlet-api_3.0_spec-1.0.0.Final.jar:1.0.0.Final]
at javax.servlet.http.HttpServlet.service(HttpServlet.java:847) [jboss-servlet-api_3.0_spec-1.0.0.Final.jar:1.0.0.Final]
at org.apache.catalina.core.ApplicationFilterChain.internalDoFilter(ApplicationFilterChain.java:329)
at org.apache.catalina.core.ApplicationFilterChain.doFilter(ApplicationFilterChain.java:248)
at org.ovirt.engine.core.utils.servlet.HeaderFilter.doFilter(HeaderFilter.java:94) [utils.jar:]
at org.apache.catalina.core.ApplicationFilterChain.internalDoFilter(ApplicationFilterChain.java:280)
at org.apache.catalina.core.ApplicationFilterChain.doFilter(ApplicationFilterChain.java:248)
at org.ovirt.engine.ui.frontend.server.gwt.GwtCachingFilter.doFilter(GwtCachingFilter.java:132)
at org.apache.catalina.core.ApplicationFilterChain.internalDoFilter(ApplicationFilterChain.java:280)
at org.apache.catalina.core.ApplicationFilterChain.doFilter(ApplicationFilterChain.java:248)
at org.ovirt.engine.core.branding.BrandingFilter.doFilter(BrandingFilter.java:72)
at org.apache.catalina.core.ApplicationFilterChain.internalDoFilter(ApplicationFilterChain.java:280)
at org.apache.catalina.core.ApplicationFilterChain.doFilter(ApplicationFilterChain.java:248)
at org.ovirt.engine.core.utils.servlet.LocaleFilter.doFilter(LocaleFilter.java:64) [utils.jar:]
at org.apache.catalina.core.ApplicationFilterChain.internalDoFilter(ApplicationFilterChain.java:280)
at org.apache.catalina.core.ApplicationFilterChain.doFilter(ApplicationFilterChain.java:248)
at org.ovirt.engine.core.aaa.filters.SessionMgmtFilter.doFilter(SessionMgmtFilter.java:31) [aaa.jar:]
at org.apache.catalina.core.ApplicationFilterChain.internalDoFilter(ApplicationFilterChain.java:280)
at org.apache.catalina.core.ApplicationFilterChain.doFilter(ApplicationFilterChain.java:248)
at org.ovirt.engine.core.aaa.filters.LoginFilter.doFilter(LoginFilter.java:74) [aaa.jar:]
at org.apache.catalina.core.ApplicationFilterChain.internalDoFilter(ApplicationFilterChain.java:280)
at org.apache.catalina.core.ApplicationFilterChain.doFilter(ApplicationFilterChain.java:248)
at org.ovirt.engine.core.aaa.filters.NegotiationFilter.doFilter(NegotiationFilter.java:113) [aaa.jar:]
at org.apache.catalina.core.ApplicationFilterChain.internalDoFilter(ApplicationFilterChain.java:280)
at org.apache.catalina.core.ApplicationFilterChain.doFilter(ApplicationFilterChain.java:248)
at org.ovirt.engine.core.aaa.filters.BasicAuthenticationFilter.doFilter(BasicAuthenticationFilter.java:90) [aaa.jar:]
at org.apache.catalina.core.ApplicationFilterChain.internalDoFilter(ApplicationFilterChain.java:280)
at org.apache.catalina.core.ApplicationFilterChain.doFilter(ApplicationFilterChain.java:248)
at org.ovirt.engine.core.aaa.filters.SessionValidationFilter.doFilter(SessionValidationFilter.java:73) [aaa.jar:]
at org.apache.catalina.core.ApplicationFilterChain.internalDoFilter(ApplicationFilterChain.java:280)
at org.apache.catalina.core.ApplicationFilterChain.doFilter(ApplicationFilterChain.java:248)
at org.apache.catalina.core.StandardWrapperValve.invoke(StandardWrapperValve.java:275)
at org.apache.catalina.core.StandardContextValve.invoke(StandardContextValve.java:161)
at org.apache.catalina.authenticator.AuthenticatorBase.invoke(AuthenticatorBase.java:489)
at org.jboss.as.web.security.SecurityContextAssociationValve.invoke(SecurityContextAssociationValve.java:153)
at org.apache.catalina.core.StandardHostValve.invoke(StandardHostValve.java:155)
at org.apache.catalina.valves.ErrorReportValve.invoke(ErrorReportValve.java:102)
at org.jboss.web.rewrite.RewriteValve.invoke(RewriteValve.java:466)
at org.apache.catalina.core.StandardEngineValve.invoke(StandardEngineValve.java:109)
at org.apache.catalina.connector.CoyoteAdapter.service(CoyoteAdapter.java:368)
at org.apache.coyote.ajp.AjpProcessor.process(AjpProcessor.java:505)
at org.apache.coyote.ajp.AjpProtocol$AjpConnectionHandler.process(AjpProtocol.java:445)
at org.apache.tomcat.util.net.JIoEndpoint$Worker.run(JIoEndpoint.java:930)
at java.lang.Thread.run(Thread.java:745) [rt.jar:1.7.0_85]
Caused by: java.net.NoRouteToHostException: No route to host
at sun.nio.ch.UnixAsynchronousSocketChannelImpl.checkConnect(Native Method) [rt.jar:1.7.0_85]
at sun.nio.ch.UnixAsynchronousSocketChannelImpl.finishConnect(UnixAsynchronousSocketChannelImpl.java:252) [rt.jar:1.7.0_85]
at sun.nio.ch.UnixAsynchronousSocketChannelImpl.finish(UnixAsynchronousSocketChannelImpl.java:198) [rt.jar:1.7.0_85]
at sun.nio.ch.UnixAsynchronousSocketChannelImpl.onEvent(UnixAsynchronousSocketChannelImpl.java:213) [rt.jar:1.7.0_85]
at sun.nio.ch.EPollPort$EventHandlerTask.run(EPollPort.java:293) [rt.jar:1.7.0_85]
... 1 more
2015-09-10 08:43:20,302 WARN [org.ovirt.engine.core.bll.AddVdsCommand] (ajp--127.0.0.1-8702-1) [639ed9cc] CanDoAction of action AddVds failed for user admin@internal. Reasons: VAR__ACTION__ADD,VAR__TYPE__HOST,$server 10.204.206.67,VDS_CANNOT_CONNECT_TO_SERVER
2015-09-10 08:43:40,519 INFO [org.ovirt.engine.core.bll.OvfDataUpdater] (DefaultQuartzScheduler_Worker-58) Attempting to update VMs/Templates Ovf.
2015-09-10 08:44:51,214 INFO [org.ovirt.engine.core.bll.AddVdsCommand] (ajp--127.0.0.1-8702-5) [39434608] Running command: AddVdsCommand internal: false. Entities affected : ID: 00000001-0001-0001-0001-00000000023b Type: VdsGroupsAction group CREATE_HOST with role type ADMIN
2015-09-10 08:44:51,296 INFO [org.ovirt.engine.core.bll.AddVdsSpmIdCommand] (ajp--127.0.0.1-8702-5) [39c13d87] Running command: AddVdsSpmIdCommand internal: true. Entities affected : ID: 400e5335-5e1c-4d7c-8470-d13b5438ad4a Type: VDS
2015-09-10 08:44:51,316 INFO [org.ovirt.engine.core.bll.AddVdsSpmIdCommand] (ajp--127.0.0.1-8702-5) [39c13d87] Lock freed to object EngineLock [exclusiveLocks= key: 00000002-0002-0002-0002-000000000285 value: REGISTER_VDS
, sharedLocks= ]
2015-09-10 08:44:51,318 INFO [org.ovirt.engine.core.vdsbroker.RemoveVdsVDSCommand] (ajp--127.0.0.1-8702-5) [39c13d87] START, RemoveVdsVDSCommand(HostName = test, HostId = 400e5335-5e1c-4d7c-8470-d13b5438ad4a), log id: 5b5ee0c8
2015-09-10 08:44:51,319 INFO [org.ovirt.engine.core.vdsbroker.RemoveVdsVDSCommand] (ajp--127.0.0.1-8702-5) [39c13d87] FINISH, RemoveVdsVDSCommand, log id: 5b5ee0c8
2015-09-10 08:44:51,321 INFO [org.ovirt.engine.core.vdsbroker.AddVdsVDSCommand] (ajp--127.0.0.1-8702-5) [39c13d87] START, AddVdsVDSCommand(HostName = test, HostId = 400e5335-5e1c-4d7c-8470-d13b5438ad4a), log id: 4b963499
2015-09-10 08:44:51,322 INFO [org.ovirt.engine.core.vdsbroker.AddVdsVDSCommand] (ajp--127.0.0.1-8702-5) [39c13d87] AddVds - entered , starting logic to add VDS 400e5335-5e1c-4d7c-8470-d13b5438ad4a
2015-09-10 08:44:51,323 INFO [org.ovirt.engine.core.vdsbroker.AddVdsVDSCommand] (ajp--127.0.0.1-8702-5) [39c13d87] AddVds - VDS 400e5335-5e1c-4d7c-8470-d13b5438ad4a was added, will try to add it to the resource manager
2015-09-10 08:44:51,324 INFO [org.ovirt.engine.core.vdsbroker.VdsManager] (ajp--127.0.0.1-8702-5) [39c13d87] Entered VdsManager constructor
2015-09-10 08:44:51,335 INFO [org.ovirt.engine.core.vdsbroker.VdsManager] (ajp--127.0.0.1-8702-5) [39c13d87] Initialize vdsBroker (10.204.206.7,54,321)
2015-09-10 08:44:51,372 INFO [org.ovirt.engine.core.vdsbroker.ResourceManager] (ajp--127.0.0.1-8702-5) [39c13d87] VDS 400e5335-5e1c-4d7c-8470-d13b5438ad4a was added to the Resource Manager
2015-09-10 08:44:51,373 INFO [org.ovirt.engine.core.vdsbroker.AddVdsVDSCommand] (ajp--127.0.0.1-8702-5) [39c13d87] FINISH, AddVdsVDSCommand, log id: 4b963499
2015-09-10 08:44:51,378 WARN [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (ajp--127.0.0.1-8702-5) [39c13d87] Correlation ID: null, Call Stack: null, Custom Event ID: -1, Message: Failed to verify Power Management configuration for Host test.
2015-09-10 08:44:51,391 INFO [org.ovirt.engine.core.bll.InstallVdsInternalCommand] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] Lock Acquired to object EngineLock [exclusiveLocks= key: 400e5335-5e1c-4d7c-8470-d13b5438ad4a value: VDS
, sharedLocks= ]
2015-09-10 08:44:51,392 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (ajp--127.0.0.1-8702-5) [39c13d87] Correlation ID: 39434608, Job ID: eccf94b7-3176-422f-a8a7-12d86de4be9a, Call Stack: null, Custom Event ID: -1, Message: Host test was added by admin@internal.
2015-09-10 08:44:51,394 INFO [org.ovirt.engine.core.bll.InstallVdsInternalCommand] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] Running command: InstallVdsInternalCommand internal: true. Entities affected : ID: 400e5335-5e1c-4d7c-8470-d13b5438ad4a Type: VDS
2015-09-10 08:44:51,398 INFO [org.ovirt.engine.core.bll.InstallVdsInternalCommand] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] Before Installation host 400e5335-5e1c-4d7c-8470-d13b5438ad4a, test
2015-09-10 08:44:51,402 INFO [org.ovirt.engine.core.vdsbroker.SetVdsStatusVDSCommand] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] START, SetVdsStatusVDSCommand(HostName = test, HostId = 400e5335-5e1c-4d7c-8470-d13b5438ad4a, status=Installing, nonOperationalReason=NONE, stopSpmFailureLogged=false), log id: 4ec4632
2015-09-10 08:44:51,406 INFO [org.ovirt.engine.core.vdsbroker.SetVdsStatusVDSCommand] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] FINISH, SetVdsStatusVDSCommand, log id: 4ec4632
2015-09-10 08:44:51,486 INFO [org.ovirt.engine.core.bll.InstallerMessages] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] Installation
10.204.206.7: Connected to host 10.204.206.7 with SSH key fingerprint: a9:03:96:25:3e:2b:5f:e0:bc:3c:5f:15:92:b8:dd:52
2015-09-10 08:44:51,490 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] Correlation ID: 39ef0cd1, Call Stack: null, Custom Event ID: -1, Message: Installing Host test. Connected to host 10.204.206.7 with SSH key fingerprint: a9:03:96:25:3e:2b:5f:e0:bc:3c:5f:15:92:b8:dd:52.
2015-09-10 08:44:51,564 INFO [org.ovirt.engine.core.bll.VdsDeploy] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] Installation of 10.204.206.7. Executing command via SSH umask 0077; MYTMP="$(TMPDIR="${OVIRT_TMPDIR}" mktemp -d -t ovirt-XXXXXXXXXX)"; trap "chmod -R u+rwX \"${MYTMP}\" > /dev/null 2>&1; rm -fr \"${MYTMP}\" > /dev/null 2>&1" 0; tar --warning=no-timestamp -C "${MYTMP}" -x && "${MYTMP}"/setup DIALOG/dialect=str:machine DIALOG/customization=bool:True < /var/cache/ovirt-engine/ovirt-host-deploy.tar
2015-09-10 08:44:51,636 INFO [org.ovirt.engine.core.uutils.ssh.SSHDialog] (org.ovirt.thread.pool-8-thread-26) SSH execute
root@10.204.206.7 'umask 0077; MYTMP="$(TMPDIR="${OVIRT_TMPDIR}" mktemp -d -t ovirt-XXXXXXXXXX)"; trap "chmod -R u+rwX \"${MYTMP}\" > /dev/null 2>&1; rm -fr \"${MYTMP}\" > /dev/null 2>&1" 0; tar --warning=no-timestamp -C "${MYTMP}" -x && "${MYTMP}"/setup DIALOG/dialect=str:machine DIALOG/customization=bool:True'
2015-09-10 08:44:52,150 INFO [org.ovirt.engine.core.bll.InstallerMessages] (VdsDeploy) Installation
10.204.206.7: Stage: Initializing
2015-09-10 08:44:52,155 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (VdsDeploy) Correlation ID: 39ef0cd1, Call Stack: null, Custom Event ID: -1, Message: Installing Host test. Stage: Initializing.
2015-09-10 08:44:52,165 INFO [org.ovirt.engine.core.bll.InstallerMessages] (VdsDeploy) Installation
10.204.206.7: Stage: Environment setup
2015-09-10 08:44:52,168 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (VdsDeploy) Correlation ID: 39ef0cd1, Call Stack: null, Custom Event ID: -1, Message: Installing Host test. Stage: Environment setup.
2015-09-10 08:44:52,171 INFO [org.ovirt.engine.core.bll.InstallerMessages] (VdsDeploy) Installation
10.204.206.7: Stage: Environment packages setup
2015-09-10 08:44:52,187 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (VdsDeploy) Correlation ID: 39ef0cd1, Call Stack: null, Custom Event ID: -1, Message: Installing Host test. Stage: Environment packages setup.
2015-09-10 08:44:52,187 INFO [org.ovirt.engine.core.bll.InstallerMessages] (VdsDeploy) Installation
10.204.206.7: Stage: Programs detection
2015-09-10 08:44:52,190 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (VdsDeploy) Correlation ID: 39ef0cd1, Call Stack: null, Custom Event ID: -1, Message: Installing Host test. Stage: Programs detection.
2015-09-10 08:44:52,190 INFO [org.ovirt.engine.core.bll.InstallerMessages] (VdsDeploy) Installation
10.204.206.7: Stage: Environment customization
2015-09-10 08:44:52,193 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (VdsDeploy) Correlation ID: 39ef0cd1, Call Stack: null, Custom Event ID: -1, Message: Installing Host test. Stage: Environment customization.
2015-09-10 08:44:52,199 INFO [org.ovirt.engine.core.bll.InstallerMessages] (VdsDeploy) Installation
10.204.206.7: Kdump unsupported
2015-09-10 08:44:52,202 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (VdsDeploy) Correlation ID: 39ef0cd1, Call Stack: null, Custom Event ID: -1, Message: Installing Host test. Kdump unsupported.
2015-09-10 08:44:52,207 INFO [org.ovirt.engine.core.bll.InstallerMessages] (VdsDeploy) Installation
10.204.206.7: Host is hypervisor
2015-09-10 08:44:52,209 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (VdsDeploy) Correlation ID: 39ef0cd1, Call Stack: null, Custom Event ID: -1, Message: Installing Host test. Host is hypervisor.
2015-09-10 08:44:52,215 INFO [org.ovirt.engine.core.bll.InstallerMessages] (VdsDeploy) Installation
10.204.206.7: Logs at host located at: '/tmp/ovirt-host-deploy-20150910031451-vnguvk.log'
2015-09-10 08:44:52,217 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (VdsDeploy) Correlation ID: 39ef0cd1, Call Stack: null, Custom Event ID: -1, Message: Installing Host test. Logs at host located at: '/tmp/ovirt-host-deploy-20150910031451-vnguvk.log'.
2015-09-10 08:44:52,283 INFO [org.ovirt.engine.core.bll.VdsDeploy] (VdsDeploy) Host 10.204.206.7 reports unique id 4C4C4544-0037-3410-8052-B8C04F353432
2015-09-10 08:44:52,298 INFO [org.ovirt.engine.core.bll.VdsDeploy] (VdsDeploy) Assigning unique id 4C4C4544-0037-3410-8052-B8C04F353432 to Host 10.204.206.7
2015-09-10 08:44:52,330 INFO [org.ovirt.engine.core.bll.InstallerMessages] (VdsDeploy) Installation
10.204.206.7: Disabling Kdump integration
2015-09-10 08:44:52,332 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (VdsDeploy) Correlation ID: 39ef0cd1, Call Stack: null, Custom Event ID: -1, Message: Installing Host test. Disabling Kdump integration.
2015-09-10 08:44:52,341 INFO [org.ovirt.engine.core.bll.InstallerMessages] (VdsDeploy) Installation
10.204.206.7: Stage: Setup validation
2015-09-10 08:44:52,343 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (VdsDeploy) Correlation ID: 39ef0cd1, Call Stack: null, Custom Event ID: -1, Message: Installing Host test. Stage: Setup validation.
2015-09-10 08:44:52,359 WARN [org.ovirt.engine.core.bll.InstallerMessages] (VdsDeploy) Installation
10.204.206.7: Cannot validate host name settings, reason: resolved host does not match any of the local addresses
2015-09-10 08:44:52,361 WARN [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (VdsDeploy) Correlation ID: 39ef0cd1, Call Stack: null, Custom Event ID: -1, Message: Host test installation in progress . Cannot validate host name settings, reason: resolved host does not match any of the local addresses.
2015-09-10 08:44:52,468 INFO [org.ovirt.engine.core.bll.InstallerMessages] (VdsDeploy) Installation
10.204.206.7: Hardware supports virtualization
2015-09-10 08:44:52,471 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (VdsDeploy) Correlation ID: 39ef0cd1, Call Stack: null, Custom Event ID: -1, Message: Installing Host test. Hardware supports virtualization.
2015-09-10 08:44:52,472 INFO [org.ovirt.engine.core.bll.InstallerMessages] (VdsDeploy) Installation
10.204.206.7: Stage: Transaction setup
2015-09-10 08:44:52,474 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (VdsDeploy) Correlation ID: 39ef0cd1, Call Stack: null, Custom Event ID: -1, Message: Installing Host test. Stage: Transaction setup.
2015-09-10 08:44:52,474 INFO [org.ovirt.engine.core.bll.InstallerMessages] (VdsDeploy) Installation
10.204.206.7: Stage: Misc configuration
2015-09-10 08:44:52,476 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (VdsDeploy) Correlation ID: 39ef0cd1, Call Stack: null, Custom Event ID: -1, Message: Installing Host test. Stage: Misc configuration.
2015-09-10 08:44:52,477 INFO [org.ovirt.engine.core.bll.InstallerMessages] (VdsDeploy) Installation
10.204.206.7: Stage: Package installation
2015-09-10 08:44:52,479 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (VdsDeploy) Correlation ID: 39ef0cd1, Call Stack: null, Custom Event ID: -1, Message: Installing Host test. Stage: Package installation.
2015-09-10 08:44:54,374 INFO [org.ovirt.engine.core.vdsbroker.VdsManager] (DefaultQuartzScheduler_Worker-90) Initializing Host: test
2015-09-10 08:44:55,131 INFO [org.ovirt.engine.core.bll.InstallerMessages] (VdsDeploy) Installation
10.204.206.7: Stage: Misc configuration
2015-09-10 08:44:55,135 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (VdsDeploy) Correlation ID: 39ef0cd1, Call Stack: null, Custom Event ID: -1, Message: Installing Host test. Stage: Misc configuration.
2015-09-10 08:44:55,266 INFO [org.ovirt.engine.core.bll.InstallerMessages] (VdsDeploy) Installation
10.204.206.7: Enrolling certificate
2015-09-10 08:44:55,269 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (VdsDeploy) Correlation ID: 39ef0cd1, Call Stack: null, Custom Event ID: -1, Message: Installing Host test. Enrolling certificate.
2015-09-10 08:44:56,337 INFO [org.ovirt.engine.core.bll.InstallerMessages] (VdsDeploy) Installation
10.204.206.7: Stage: Transaction commit
2015-09-10 08:44:56,339 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (VdsDeploy) Correlation ID: 39ef0cd1, Call Stack: null, Custom Event ID: -1, Message: Installing Host test. Stage: Transaction commit.
2015-09-10 08:44:57,023 INFO [org.ovirt.engine.core.bll.InstallerMessages] (VdsDeploy) Installation
10.204.206.7: Stage: Closing up
2015-09-10 08:44:57,026 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (VdsDeploy) Correlation ID: 39ef0cd1, Call Stack: null, Custom Event ID: -1, Message: Installing Host test. Stage: Closing up.
2015-09-10 08:45:04,317 INFO [org.ovirt.engine.core.bll.InstallerMessages] (VdsDeploy) Installation
10.204.206.7: Stopping libvirtd
2015-09-10 08:45:04,320 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (VdsDeploy) Correlation ID: 39ef0cd1, Call Stack: null, Custom Event ID: -1, Message: Installing Host test. Stopping libvirtd.
2015-09-10 08:45:04,570 INFO [org.ovirt.engine.core.bll.InstallerMessages] (VdsDeploy) Installation
10.204.206.7: Starting vdsm
2015-09-10 08:45:04,574 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (VdsDeploy) Correlation ID: 39ef0cd1, Call Stack: null, Custom Event ID: -1, Message: Installing Host test. Starting vdsm.
2015-09-10 08:45:13,820 INFO [org.ovirt.engine.core.bll.InstallerMessages] (VdsDeploy) Installation
10.204.206.7: Retrieving installation logs to: '/var/log/ovirt-engine/host-deploy/ovirt-20150910084513-10.204.206.7-39ef0cd1.log'
2015-09-10 08:45:13,824 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (VdsDeploy) Correlation ID: 39ef0cd1, Call Stack: null, Custom Event ID: -1, Message: Installing Host test. Retrieving installation logs to: '/var/log/ovirt-engine/host-deploy/ovirt-20150910084513-10.204.206.7-39ef0cd1.log'.
2015-09-10 08:45:13,968 INFO [org.ovirt.vdsm.jsonrpc.client.reactors.ReactorClient] (SSL Stomp Reactor) Connecting to /
10.204.206.72015-09-10 08:45:13,981 WARN [org.ovirt.vdsm.jsonrpc.client.utils.retry.Retryable] (SSL Stomp Reactor) Retry failed
2015-09-10 08:45:13,982 ERROR [org.ovirt.vdsm.jsonrpc.client.reactors.ReactorClient] (org.ovirt.thread.pool-8-thread-27) Exception during connection
2015-09-10 08:45:13,983 ERROR [org.ovirt.engine.core.vdsbroker.vdsbroker.TimeBoundPollVDSCommand] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] java.util.concurrent.ExecutionException: org.ovirt.engine.core.vdsbroker.xmlrpc.XmlRpcRunTimeException: Connection issues during send request
2015-09-10 08:45:13,990 ERROR [org.ovirt.engine.core.vdsbroker.vdsbroker.TimeBoundPollVDSCommand] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] Command TimeBoundPollVDSCommand(HostName = test, HostId = 400e5335-5e1c-4d7c-8470-d13b5438ad4a) execution failed. Exception: RuntimeException: java.util.concurrent.ExecutionException: org.ovirt.engine.core.vdsbroker.xmlrpc.XmlRpcRunTimeException: Connection issues during send request
2015-09-10 08:45:18,992 INFO [org.ovirt.vdsm.jsonrpc.client.reactors.ReactorClient] (SSL Stomp Reactor) Connecting to /
10.204.206.72015-09-10 08:45:19,024 ERROR [org.ovirt.vdsm.jsonrpc.client.reactors.Reactor] (SSL Stomp Reactor) Unable to process messages
2015-09-10 08:45:23,998 WARN [org.ovirt.engine.core.vdsbroker.vdsbroker.TimeBoundPollVDSCommand] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] Unexpected return value: StatusForXmlRpc [mCode=-1, mMessage=Internal timeout occured]
2015-09-10 08:45:23,999 ERROR [org.ovirt.engine.core.vdsbroker.vdsbroker.TimeBoundPollVDSCommand] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] Failed in TimeBoundPollVDS method
2015-09-10 08:45:24,000 ERROR [org.ovirt.engine.core.vdsbroker.vdsbroker.TimeBoundPollVDSCommand] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] org.ovirt.engine.core.vdsbroker.vdsbroker.VDSErrorException: VDSGenericException: VDSErrorException: Failed to TimeBoundPollVDS, error = Internal timeout occured, code = -1
2015-09-10 08:45:24,002 ERROR [org.ovirt.engine.core.vdsbroker.vdsbroker.TimeBoundPollVDSCommand] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] Command TimeBoundPollVDSCommand(HostName = test, HostId = 400e5335-5e1c-4d7c-8470-d13b5438ad4a) execution failed. Exception: VDSErrorException: VDSGenericException: VDSErrorException: Failed to TimeBoundPollVDS, error = Internal timeout occured, code = -1
2015-09-10 08:45:29,004 INFO [org.ovirt.vdsm.jsonrpc.client.reactors.ReactorClient] (SSL Stomp Reactor) Connecting to /
10.204.206.72015-09-10 08:45:34,008 WARN [org.ovirt.engine.core.vdsbroker.vdsbroker.TimeBoundPollVDSCommand] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] Unexpected return value: StatusForXmlRpc [mCode=-1, mMessage=Internal timeout occured]
2015-09-10 08:45:34,008 ERROR [org.ovirt.engine.core.vdsbroker.vdsbroker.TimeBoundPollVDSCommand] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] Failed in TimeBoundPollVDS method
2015-09-10 08:45:34,009 ERROR [org.ovirt.engine.core.vdsbroker.vdsbroker.TimeBoundPollVDSCommand] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] org.ovirt.engine.core.vdsbroker.vdsbroker.VDSErrorException: VDSGenericException: VDSErrorException: Failed to TimeBoundPollVDS, error = Internal timeout occured, code = -1
2015-09-10 08:45:34,010 ERROR [org.ovirt.engine.core.vdsbroker.vdsbroker.TimeBoundPollVDSCommand] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] Command TimeBoundPollVDSCommand(HostName = test, HostId = 400e5335-5e1c-4d7c-8470-d13b5438ad4a) execution failed. Exception: VDSErrorException: VDSGenericException: VDSErrorException: Failed to TimeBoundPollVDS, error = Internal timeout occured, code = -1
2015-09-10 08:45:39,011 INFO [org.ovirt.engine.core.vdsbroker.VdsManager] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] vdsManager::disposing
2015-09-10 08:45:39,012 INFO [org.ovirt.engine.core.vdsbroker.VdsManager] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] Entered VdsManager constructor
2015-09-10 08:45:39,020 INFO [org.ovirt.engine.core.vdsbroker.VdsManager] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] Initialize vdsBroker (10.204.206.7,54,321)
2015-09-10 08:45:39,021 INFO [org.ovirt.engine.core.vdsbroker.ResourceManager] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] VDS 400e5335-5e1c-4d7c-8470-d13b5438ad4a was added to the Resource Manager
2015-09-10 08:45:39,129 INFO [org.ovirt.engine.core.bll.network.NetworkConfigurator] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] Engine managed to communicate with VDSM agent on host test
2015-09-10 08:45:39,310 INFO [org.ovirt.engine.core.bll.network.NetworkConfigurator] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] The management network ovirtmgmt is already configured on host test
2015-09-10 08:45:39,312 INFO [org.ovirt.engine.core.vdsbroker.SetVdsStatusVDSCommand] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] START, SetVdsStatusVDSCommand(HostName = test, HostId = 400e5335-5e1c-4d7c-8470-d13b5438ad4a, status=Initializing, nonOperationalReason=NONE, stopSpmFailureLogged=false), log id: 34afb457
2015-09-10 08:45:39,314 INFO [org.ovirt.engine.core.vdsbroker.SetVdsStatusVDSCommand] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] FINISH, SetVdsStatusVDSCommand, log id: 34afb457
2015-09-10 08:45:39,315 INFO [org.ovirt.engine.core.bll.InstallVdsInternalCommand] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] After Installation host test, oVirtNode
2015-09-10 08:45:39,319 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] Correlation ID: 39ef0cd1, Job ID: eccf94b7-3176-422f-a8a7-12d86de4be9a, Call Stack: null, Custom Event ID: -1, Message: Host test installed
2015-09-10 08:45:39,322 INFO [org.ovirt.engine.core.bll.InstallVdsInternalCommand] (org.ovirt.thread.pool-8-thread-26) [39ef0cd1] Lock freed to object EngineLock [exclusiveLocks= key: 400e5335-5e1c-4d7c-8470-d13b5438ad4a value: VDS
, sharedLocks= ]
2015-09-10 08:45:42,113 WARN [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (DefaultQuartzScheduler_Worker-74) Correlation ID: null, Call Stack: null, Custom Event ID: -1, Message: Host test does not enforce SELinux.
2015-09-10 08:45:42,113 WARN [org.ovirt.engine.core.vdsbroker.VdsManager] (DefaultQuartzScheduler_Worker-74) Host test does not report SELinux enforcement information.
2015-09-10 08:45:42,133 INFO [org.ovirt.engine.core.bll.HandleVdsCpuFlagsOrClusterChangedCommand] (DefaultQuartzScheduler_Worker-74) [5bfc1060] Running command: HandleVdsCpuFlagsOrClusterChangedCommand internal: true. Entities affected : ID: 400e5335-5e1c-4d7c-8470-d13b5438ad4a Type: VDS
2015-09-10 08:45:42,207 WARN [org.ovirt.engine.core.vdsbroker.VdsManager] (DefaultQuartzScheduler_Worker-74) [5bfc1060] Host test does not report SELinux enforcement information.
2015-09-10 08:45:42,267 INFO [org.ovirt.engine.core.bll.InitVdsOnUpCommand] (DefaultQuartzScheduler_Worker-74) [5aa1098b] Running command: InitVdsOnUpCommand internal: true. Entities affected : ID: 00000002-0002-0002-0002-000000000285 Type: StoragePool
2015-09-10 08:45:42,271 INFO [org.ovirt.engine.core.vdsbroker.vdsbroker.SetMOMPolicyParametersVDSCommand] (DefaultQuartzScheduler_Worker-74) [5aa1098b] START, SetMOMPolicyParametersVDSCommand(HostName = test, HostId = 400e5335-5e1c-4d7c-8470-d13b5438ad4a), log id: 6cf32f93
2015-09-10 08:45:42,359 INFO [org.ovirt.engine.core.vdsbroker.vdsbroker.SetMOMPolicyParametersVDSCommand] (DefaultQuartzScheduler_Worker-74) [5aa1098b] FINISH, SetMOMPolicyParametersVDSCommand, log id: 6cf32f93
2015-09-10 08:45:42,361 INFO [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (DefaultQuartzScheduler_Worker-74) [5aa1098b] Correlation ID: null, Call Stack: null, Custom Event ID: -1, Message: Status of host test was set to Up.
2015-09-10 08:45:42,364 WARN [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (DefaultQuartzScheduler_Worker-74) [5aa1098b] Correlation ID: null, Call Stack: null, Custom Event ID: -1, Message: Failed to verify Power Management configuration for Host test.
2015-09-10 08:45:42,367 INFO [org.ovirt.engine.core.vdsbroker.VdsManager] (DefaultQuartzScheduler_Worker-74) [5aa1098b] Initializing Host: test
2015-09-10 08:45:42,369 INFO [org.ovirt.engine.core.bll.HandleVdsCpuFlagsOrClusterChangedCommand] (DefaultQuartzScheduler_Worker-74) [16fcb157] Running command: HandleVdsCpuFlagsOrClusterChangedCommand internal: true. Entities affected : ID: 400e5335-5e1c-4d7c-8470-d13b5438ad4a Type: VDS
2015-09-10 08:45:42,372 INFO [org.ovirt.engine.core.bll.HandleVdsVersionCommand] (DefaultQuartzScheduler_Worker-74) [1c9fbe61] Running command: HandleVdsVersionCommand internal: true. Entities affected : ID: 400e5335-5e1c-4d7c-8470-d13b5438ad4a Type: VDS
2015-09-10 08:45:42,381 INFO [org.ovirt.engine.core.bll.SetNonOperationalVdsCommand] (DefaultQuartzScheduler_Worker-74) [41a02af3] Running command: SetNonOperationalVdsCommand internal: true. Entities affected : ID: 400e5335-5e1c-4d7c-8470-d13b5438ad4a Type: VDS
2015-09-10 08:45:42,384 INFO [org.ovirt.engine.core.vdsbroker.SetVdsStatusVDSCommand] (DefaultQuartzScheduler_Worker-74) [41a02af3] START, SetVdsStatusVDSCommand(HostName = test, HostId = 400e5335-5e1c-4d7c-8470-d13b5438ad4a, status=NonOperational, nonOperationalReason=CLUSTER_VERSION_INCOMPATIBLE_WITH_CLUSTER, stopSpmFailureLogged=false), log id: 4d27a1fe
2015-09-10 08:45:42,390 INFO [org.ovirt.engine.core.vdsbroker.SetVdsStatusVDSCommand] (DefaultQuartzScheduler_Worker-74) [41a02af3] FINISH, SetVdsStatusVDSCommand, log id: 4d27a1fe
2015-09-10 08:45:42,396 ERROR [org.ovirt.engine.core.dal.dbbroker.auditloghandling.AuditLogDirector] (DefaultQuartzScheduler_Worker-74) [41a02af3] Correlation ID: 41a02af3, Job ID: 64618ef9-97f9-4d27-bcd7-62671933795c, Call Stack: null, Custom Event ID: -1, Message: Host test is compatible with versions (3.0,3.1,3.2,3.3,3.4) and cannot join Cluster Default which is set to version 3.5.
2015-09-10 08:45:42,399 INFO [org.ovirt.engine.core.vdsbroker.VdsUpdateRunTimeInfo] (DefaultQuartzScheduler_Worker-74) [41a02af3] Host 400e5335-5e1c-4d7c-8470-d13b5438ad4a : test is already in NonOperational status for reason CLUSTER_VERSION_INCOMPATIBLE_WITH_CLUSTER. SetNonOperationalVds command is skipped.
^C
[root@cstlb2 ~]#