[ovirt-users] Issues while deploying

Budur Nagaraju nbudoor at gmail.com
Thu Sep 10 03:18:36 UTC 2015


HI

Installed ovirt3.5 and wile adding ovirt-node its getting stuck at
"non-responsive" state ,as shown in the sreenshot.

Below are the the ovirt-Engine logs,





[root at 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 at 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 at 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 at 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 at 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.7
2015-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.7
2015-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.7
2015-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 at cstlb2 ~]#
-------------- next part --------------
An HTML attachment was scrubbed...
URL: <http://lists.ovirt.org/pipermail/users/attachments/20150910/c50f92ce/attachment-0001.html>
-------------- next part --------------
A non-text attachment was scrubbed...
Name: screenshot.png
Type: image/png
Size: 120222 bytes
Desc: not available
URL: <http://lists.ovirt.org/pipermail/users/attachments/20150910/c50f92ce/attachment-0001.png>


More information about the Users mailing list