You are viewing a plain text version of this content. The canonical link for it is here.
Posted to users-cn@cloudstack.apache.org by 许叁征 <xu...@chinanetcenter.com> on 2014/03/26 04:42:19 UTC
cloudstack平台无法打开
HI ALL
昨天虚拟机平台机器宕机后，重启发现平台无法打开，cloudstack 4.0.1 以及
mysql日志报错如下：
请教 这个要如何处理，谢谢！
[root@manager ~]# tailf /usr/share/cloud/management/logs/management-server.
log
at
org.apache.catalina.core.StandardEngine.start(StandardEngine.java:443)
at
org.apache.catalina.core.StandardService.start(StandardService.java:516)
at
org.apache.catalina.core.StandardServer.start(StandardServer.java:710)
at org.apache.catalina.startup.Catalina.start(Catalina.java:593)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57
)
at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl
.java:43)
at java.lang.reflect.Method.invoke(Method.java:616)
at org.apache.catalina.startup.Bootstrap.start(Bootstrap.java:289)
at org.apache.catalina.startup.Bootstrap.main(Bootstrap.java:414)
2014-03-26 10:56:26,367 INFO [utils.component.ComponentLocator] (main:null)
Config file found at /etc/cloud/management/components.xml. Configuring
system-integrity-checker
2014-03-26 10:56:26,372 DEBUG [utils.component.ComponentLocator] (main:null)
Looking for class com.cloud.cluster.ManagementServerNode
2014-03-26 10:56:26,391 INFO [utils.component.ComponentLocator] (main:null)
Found component: com.cloud.utils.component.SystemIntegrityChecker in
com.cloud.cluster.ManagementServerNode - ManagementServerNode
2014-03-26 10:56:26,391 INFO [utils.component.ComponentLocator] (main:null)
Adding system integrity checker: ManagementServerNode
2014-03-26 10:56:26,391 DEBUG [utils.component.ComponentLocator] (main:null)
Looking for class com.cloud.utils.crypt.EncryptionSecretKeyChecker
2014-03-26 10:56:26,400 INFO [utils.component.ComponentLocator] (main:null)
Found component: com.cloud.utils.component.SystemIntegrityChecker in
com.cloud.utils.crypt.EncryptionSecretKeyChecker -
EncryptionSecretKeyChecker
2014-03-26 10:56:26,400 INFO [utils.component.ComponentLocator] (main:null)
Adding system integrity checker: EncryptionSecretKeyChecker
2014-03-26 10:56:26,400 DEBUG [utils.component.ComponentLocator] (main:null)
Looking for class com.cloud.upgrade.DatabaseIntegrityChecker
2014-03-26 10:56:26,401 INFO [utils.component.ComponentLocator] (main:null)
Found component: com.cloud.utils.component.SystemIntegrityChecker in
com.cloud.upgrade.DatabaseIntegrityChecker - DatabaseIntegrityChecker
2014-03-26 10:56:26,402 INFO [utils.component.ComponentLocator] (main:null)
Adding system integrity checker: DatabaseIntegrityChecker
2014-03-26 10:56:26,402 DEBUG [utils.component.ComponentLocator] (main:null)
Looking for class com.cloud.upgrade.PremiumDatabaseUpgradeChecker
2014-03-26 10:56:26,403 INFO [utils.component.ComponentLocator] (main:null)
Found component: com.cloud.utils.component.SystemIntegrityChecker in
com.cloud.upgrade.PremiumDatabaseUpgradeChecker - DatabaseUpgradeChecker
2014-03-26 10:56:26,403 INFO [utils.component.ComponentLocator] (main:null)
Adding system integrity checker: DatabaseUpgradeChecker
2014-03-26 10:56:26,474 DEBUG [utils.crypt.EncryptionSecretKeyChecker]
(main:null) Encryption Type: file
2014-03-26 10:56:26,557 INFO [cloud.upgrade.DatabaseIntegrityChecker]
(main:null) Grabbing lock to check for database integrity.
2014-03-26 10:56:30,774 ERROR [db.Transaction.Transaction] (main:null)
Unexpected exception:
com.mysql.jdbc.exceptions.jdbc4.MySQLNonTransientConnectionException: Could
not create connection to database server. Attempted reconnect 3 times.
Giving up.
at sun.reflect.NativeConstructorAccessorImpl.newInstance0(Native
Method)
at
sun.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAcces
sorImpl.java:57)
at
sun.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstruc
torAccessorImpl.java:45)
at java.lang.reflect.Constructor.newInstance(Constructor.java:532)
at com.mysql.jdbc.Util.handleNewInstance(Util.java:411)
at com.mysql.jdbc.Util.getInstance(Util.java:386)
at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:1013)
at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:987)
at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:982)
at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:927)
at
com.mysql.jdbc.ConnectionImpl.connectWithRetries(ConnectionImpl.java:2238)
at
com.mysql.jdbc.ConnectionImpl.createNewIO(ConnectionImpl.java:2159)
at com.mysql.jdbc.ConnectionImpl.<init>(ConnectionImpl.java:792)
at com.mysql.jdbc.JDBC4Connection.<init>(JDBC4Connection.java:49)
at sun.reflect.NativeConstructorAccessorImpl.newInstance0(Native
Method)
at
sun.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAcces
sorImpl.java:57)
at
sun.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstruc
torAccessorImpl.java:45)
at java.lang.reflect.Constructor.newInstance(Constructor.java:532)
at com.mysql.jdbc.Util.handleNewInstance(Util.java:411)
at
com.mysql.jdbc.ConnectionImpl.getInstance(ConnectionImpl.java:381)
at com.mysql.jdbc.NonRegisteringDriver.connect(NonRegisteringDriver.
java:305)
at java.sql.DriverManager.getConnection(DriverManager.java:620)
at java.sql.DriverManager.getConnection(DriverManager.java:200)
at
org.apache.commons.dbcp.DriverManagerConnectionFactory.createConnection(Driv
erManagerConnectionFactory.java:48)
at
org.apache.commons.dbcp.PoolableConnectionFactory.makeObject(PoolableConnect
ionFactory.java:290)
at
org.apache.commons.pool.impl.GenericObjectPool.borrowObject(GenericObjectPoo
l.java:840)
at
org.apache.commons.dbcp.PoolingDataSource.getConnection(PoolingDataSource.ja
va:95)
at
com.cloud.utils.db.Transaction.getStandaloneConnectionWithException(Transact
ion.java:200)
at
com.cloud.utils.db.Transaction.getStandaloneConnection(Transaction.java:209)
at
com.cloud.utils.db.DbUtil.getConnectionForGlobalLocks(DbUtil.java:58)
at com.cloud.utils.db.DbUtil.getGlobalLock(DbUtil.java:203)
at com.cloud.utils.db.GlobalLock.lock(GlobalLock.java:151)
at
com.cloud.upgrade.DatabaseIntegrityChecker.check(DatabaseIntegrityChecker.ja
va:228)
at
com.cloud.utils.component.ComponentLocator.runCheckers(ComponentLocator.java
:273)
at
com.cloud.utils.component.ComponentLocator.parse(ComponentLocator.java:245)
at
com.cloud.utils.component.ComponentLocator.getLocatorInternal(ComponentLocat
or.java:836)
at
com.cloud.utils.component.ComponentLocator.getLocator(ComponentLocator.java:
874)
at
com.cloud.utils.component.ComponentLocator.getComponent(ComponentLocator.jav
a:416)
at
com.cloud.utils.component.ComponentLocator.getComponent(ComponentLocator.jav
a:409)
at
com.cloud.servlet.CloudStartupServlet.init(CloudStartupServlet.java:44)
at javax.servlet.GenericServlet.init(GenericServlet.java:212)
at
org.apache.catalina.core.StandardWrapper.loadServlet(StandardWrapper.java:11
73)
at
org.apache.catalina.core.StandardWrapper.load(StandardWrapper.java:993)
at
org.apache.catalina.core.StandardContext.loadOnStartup(StandardContext.java:
4187)
at
org.apache.catalina.core.StandardContext.start(StandardContext.java:4496)
at
org.apache.catalina.core.ContainerBase.addChildInternal(ContainerBase.java:7
91)
at
org.apache.catalina.core.ContainerBase.addChild(ContainerBase.java:771)
at
org.apache.catalina.core.StandardHost.addChild(StandardHost.java:526)
at
org.apache.catalina.startup.HostConfig.deployDirectory(HostConfig.java:1041)
at
org.apache.catalina.startup.HostConfig.deployDirectories(HostConfig.java:964
)
at
org.apache.catalina.startup.HostConfig.deployApps(HostConfig.java:502)
at
org.apache.catalina.startup.HostConfig.start(HostConfig.java:1277)
at org.apache.catalina.startup.HostConfig.lifecycleEvent(HostConfig.
java:321)
at
org.apache.catalina.util.LifecycleSupport.fireLifecycleEvent(LifecycleSuppor
t.java:119)
at
org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1053)
at
org.apache.catalina.core.StandardHost.start(StandardHost.java:722)
at
org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1045)
at
org.apache.catalina.core.StandardEngine.start(StandardEngine.java:443)
at
org.apache.catalina.core.StandardService.start(StandardService.java:516)
at
org.apache.catalina.core.StandardServer.start(StandardServer.java:710)
at org.apache.catalina.startup.Catalina.start(Catalina.java:593)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57
)
at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl
.java:43)
at java.lang.reflect.Method.invoke(Method.java:616)
at org.apache.catalina.startup.Bootstrap.start(Bootstrap.java:289)
at org.apache.catalina.startup.Bootstrap.main(Bootstrap.java:414)
Caused by: java.sql.SQLException: Access denied for user 'cloud'@'localhost'
(using password: YES)
... 66 more
2014-03-26 10:56:30,778 ERROR [utils.db.DbUtil] (main:null) Unable to
acquire DB connection for global lock system
2014-03-26 10:56:30,778 ERROR [utils.db.DbUtil] (main:null) Unable to
acquire DB connection for global lock system
2014-03-26 10:56:30,779 ERROR [utils.component.ComponentLocator] (main:null)
Problems with running checker:DatabaseIntegrityChecker
com.cloud.utils.exception.CloudRuntimeException: Unable to acquire lock to
check for database integrity.
at
com.cloud.upgrade.DatabaseIntegrityChecker.check(DatabaseIntegrityChecker.ja
va:229)
at
com.cloud.utils.component.ComponentLocator.runCheckers(ComponentLocator.java
:273)
at
com.cloud.utils.component.ComponentLocator.parse(ComponentLocator.java:245)
at
com.cloud.utils.component.ComponentLocator.getLocatorInternal(ComponentLocat
or.java:836)
at
com.cloud.utils.component.ComponentLocator.getLocator(ComponentLocator.java:
874)
at
com.cloud.utils.component.ComponentLocator.getComponent(ComponentLocator.jav
a:416)
at
com.cloud.utils.component.ComponentLocator.getComponent(ComponentLocator.jav
a:409)
at
com.cloud.servlet.CloudStartupServlet.init(CloudStartupServlet.java:44)
at javax.servlet.GenericServlet.init(GenericServlet.java:212)
at
org.apache.catalina.core.StandardWrapper.loadServlet(StandardWrapper.java:11
73)
at
org.apache.catalina.core.StandardWrapper.load(StandardWrapper.java:993)
at
org.apache.catalina.core.StandardContext.loadOnStartup(StandardContext.java:
4187)
at
org.apache.catalina.core.StandardContext.start(StandardContext.java:4496)
at
org.apache.catalina.core.ContainerBase.addChildInternal(ContainerBase.java:7
91)
at
org.apache.catalina.core.ContainerBase.addChild(ContainerBase.java:771)
at
org.apache.catalina.core.StandardHost.addChild(StandardHost.java:526)
at
org.apache.catalina.startup.HostConfig.deployDirectory(HostConfig.java:1041)
at
org.apache.catalina.startup.HostConfig.deployDirectories(HostConfig.java:964
)
at
org.apache.catalina.startup.HostConfig.deployApps(HostConfig.java:502)
at
org.apache.catalina.startup.HostConfig.start(HostConfig.java:1277)
at org.apache.catalina.startup.HostConfig.lifecycleEvent(HostConfig.
java:321)
at
org.apache.catalina.util.LifecycleSupport.fireLifecycleEvent(LifecycleSuppor
t.java:119)
at
org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1053)
at
org.apache.catalina.core.StandardHost.start(StandardHost.java:722)
at
org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1045)
at
org.apache.catalina.core.StandardEngine.start(StandardEngine.java:443)
at
org.apache.catalina.core.StandardService.start(StandardService.java:516)
at
org.apache.catalina.core.StandardServer.start(StandardServer.java:710)
at org.apache.catalina.startup.Catalina.start(Catalina.java:593)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57
)
at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl
.java:43)
at java.lang.reflect.Method.invoke(Method.java:616)
at org.apache.catalina.startup.Bootstrap.start(Bootstrap.java:289)
at org.apache.catalina.startup.Bootstrap.main(Bootstrap.java:414)
――――――――――――――――――――――――――――――――――――――
――――――――――――――
MYSQL 日志情况
140113 14:27:04 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
InnoDB: The first specified data file ./ibdata1 did not exist:
InnoDB: a new database to be created!
140113 14:27:04 InnoDB: Setting file ./ibdata1 size to 10 MB
InnoDB: Database physically writes the file full: wait...
140113 14:27:04 InnoDB: Log file ./ib_logfile0 did not exist: new to be
created
InnoDB: Setting log file ./ib_logfile0 size to 5 MB
InnoDB: Database physically writes the file full: wait...
140113 14:27:04 InnoDB: Log file ./ib_logfile1 did not exist: new to be
created
InnoDB: Setting log file ./ib_logfile1 size to 5 MB
InnoDB: Database physically writes the file full: wait...
InnoDB: Doublewrite buffer not found: creating new
InnoDB: Doublewrite buffer created
InnoDB: Creating foreign key constraint system tables
InnoDB: Foreign key constraint system tables created
140113 14:27:05 InnoDB: Started; log sequence number 0 0
140113 14:27:05 [Note] Event Scheduler: Loaded 0 events
140113 14:27:05 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52' socket: '/var/lib/mysql/mysql.sock' port: 3306 Source
distribution
140113 14:31:34 [Note] /usr/libexec/mysqld: Normal shutdown
140113 14:31:34 [Note] Event Scheduler: Purging the queue. 0 events
140113 14:31:36 InnoDB: Starting shutdown...
140113 14:31:40 InnoDB: Shutdown completed; log sequence number 0 44233
140113 14:31:40 [Note] /usr/libexec/mysqld: Shutdown complete
140113 14:31:40 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140113 14:31:40 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140113 14:31:40 InnoDB: Started; log sequence number 0 44233
140113 14:31:41 [Note] Event Scheduler: Loaded 0 events
140113 14:31:41 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140113 15:00:00 [Note] /usr/libexec/mysqld: Normal shutdown
140113 15:00:00 [Note] Event Scheduler: Purging the queue. 0 events
140113 15:00:02 InnoDB: Starting shutdown...
140113 15:00:03 InnoDB: Shutdown completed; log sequence number 0 272572978
140113 15:00:03 [Note] /usr/libexec/mysqld: Shutdown complete
140113 15:00:03 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140113 15:00:03 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140113 15:00:03 InnoDB: Started; log sequence number 0 272572978
140113 15:00:04 [Note] Event Scheduler: Loaded 0 events
140113 15:00:04 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140113 16:07:27 [Note] /usr/libexec/mysqld: Normal shutdown
140113 16:07:27 [Note] Event Scheduler: Purging the queue. 0 events
140113 16:07:29 InnoDB: Starting shutdown...
140113 16:07:33 InnoDB: Shutdown completed; log sequence number 0 276001744
140113 16:07:33 [Note] /usr/libexec/mysqld: Shutdown complete
140113 16:07:33 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140113 16:15:10 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140113 16:15:10 InnoDB: Started; log sequence number 0 276001744
140113 16:15:10 [Note] Event Scheduler: Loaded 0 events
140113 16:15:10 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140113 16:40:49 [Note] /usr/libexec/mysqld: Normal shutdown
140113 16:40:49 [Note] Event Scheduler: Purging the queue. 0 events
140113 16:40:51 InnoDB: Starting shutdown...
140113 16:40:53 InnoDB: Shutdown completed; log sequence number 0
1611724675
140113 16:40:53 [Note] /usr/libexec/mysqld: Shutdown complete
140113 16:40:53 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140113 16:43:53 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140113 16:43:54 InnoDB: Started; log sequence number 0 1611724675
140113 16:43:54 [Note] Event Scheduler: Loaded 0 events
140113 16:43:54 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140113 16:46:41 [Note] /usr/libexec/mysqld: Normal shutdown
140113 16:46:41 [Note] Event Scheduler: Purging the queue. 0 events
140113 16:46:43 InnoDB: Starting shutdown...
140113 16:46:46 InnoDB: Shutdown completed; log sequence number 0
1611727339
140113 16:46:46 [Note] /usr/libexec/mysqld: Shutdown complete
140113 16:46:46 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140113 16:46:46 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140113 16:46:47 InnoDB: Started; log sequence number 0 1611727339
140113 16:46:47 [Note] Event Scheduler: Loaded 0 events
140113 16:46:47 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140120 15:03:43 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
InnoDB: Log scan progressed past the checkpoint lsn 0 2652244913
140120 15:03:43 InnoDB: Database was not shut down normally!
InnoDB: Starting crash recovery.
InnoDB: Reading tablespace information from the .ibd files...
InnoDB: Restoring possible half-written data pages from the doublewrite
InnoDB: buffer...
InnoDB: Doing recovery: scanned up to log sequence number 0 2652246897
140120 15:03:44 InnoDB: Starting an apply batch of log records to the
database...
InnoDB: Progress in percents: 0 1 2 3 4 5 6 7 8 9 10 11 12 13 14 15 16 17 18
19 20 21 22 23 24 25 26 27 28 29 30 31 32 33 34 35 36 37 38 39 40 41 42 43
44 45 46 47 48 49 50 51 52 53 54 55 56 57 58 59 60 61 62 63 64 65 66 67 68
69 70 71 72 73 74 75 76 77 78 79 80 81 82 83 84 85 86 87 88 89 90 91 92 93
94 95 96 97 98 99
InnoDB: Apply batch completed
InnoDB: Last MySQL binlog file position 0 425635668, file name
./mysql-bin.000005
140120 15:03:45 InnoDB: Started; log sequence number 0 2652246897
140120 15:03:45 [Note] Recovering after a crash using mysql-bin
140120 15:03:47 [Note] Starting crash recovery...
140120 15:03:47 [Note] Crash recovery finished.
140120 15:03:47 [Note] Event Scheduler: Loaded 0 events
140120 15:03:47 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140227 18:23:19 [Note] /usr/libexec/mysqld: Normal shutdown
140227 18:23:19 [Note] Event Scheduler: Purging the queue. 0 events
140227 18:23:19 InnoDB: Starting shutdown...
140227 18:23:21 InnoDB: Shutdown completed; log sequence number 1 247642825
140227 18:23:21 [Note] /usr/libexec/mysqld: Shutdown complete
140227 18:23:21 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140227 18:26:28 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140227 18:26:28 InnoDB: Started; log sequence number 1 247642825
140227 18:26:29 [Note] Event Scheduler: Loaded 0 events
140227 18:26:29 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140227 19:51:32 [Note] /usr/libexec/mysqld: Normal shutdown
140227 19:51:32 [Note] Event Scheduler: Purging the queue. 0 events
140227 19:51:34 InnoDB: Starting shutdown...
140227 19:51:35 InnoDB: Shutdown completed; log sequence number 1 531142952
140227 19:51:35 [Note] /usr/libexec/mysqld: Shutdown complete
140227 19:51:35 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140227 19:51:36 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140227 19:51:36 InnoDB: Started; log sequence number 1 531142952
140227 19:51:36 [Note] Event Scheduler: Loaded 0 events
140227 19:51:36 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140227 21:22:56 [Note] /usr/libexec/mysqld: Normal shutdown
140227 21:22:56 [Note] Event Scheduler: Purging the queue. 0 events
140227 21:22:56 InnoDB: Starting shutdown...
140227 21:22:58 InnoDB: Shutdown completed; log sequence number 1 818066929
140227 21:22:58 [Note] /usr/libexec/mysqld: Shutdown complete
140227 21:22:58 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140227 21:23:02 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140227 21:23:02 InnoDB: Started; log sequence number 1 818066929
140227 21:23:02 [Note] Event Scheduler: Loaded 0 events
140227 21:23:02 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140228 17:15:26 [Note] /usr/libexec/mysqld: Normal shutdown
140228 17:15:26 [Note] Event Scheduler: Purging the queue. 0 events
140228 17:15:28 InnoDB: Starting shutdown...
140228 17:15:31 InnoDB: Shutdown completed; log sequence number 1
1030287660
140228 17:15:31 [Note] /usr/libexec/mysqld: Shutdown complete
140228 17:15:31 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140228 17:15:31 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140228 17:15:32 InnoDB: Started; log sequence number 1 1030287660
140228 17:15:32 [Note] Event Scheduler: Loaded 0 events
140228 17:15:32 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140304 13:41:07 [Note] /usr/libexec/mysqld: Normal shutdown
140304 13:41:07 [Note] Event Scheduler: Purging the queue. 0 events
140304 13:41:10 InnoDB: Starting shutdown...
140304 13:41:14 InnoDB: Shutdown completed; log sequence number 1
2183881397
140304 13:41:14 [Note] /usr/libexec/mysqld: Shutdown complete
140304 13:41:14 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140304 13:44:55 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140304 13:44:55 InnoDB: Started; log sequence number 1 2183881397
140304 13:44:56 [Note] Event Scheduler: Loaded 0 events
140304 13:44:56 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140321 11:52:22 [Note] /usr/libexec/mysqld: Normal shutdown
140321 11:52:22 [Note] Event Scheduler: Purging the queue. 0 events
140321 11:52:22 InnoDB: Starting shutdown...
140321 11:52:25 InnoDB: Shutdown completed; log sequence number 1
4023808129
140321 11:52:25 [Note] /usr/libexec/mysqld: Shutdown complete
140321 11:52:25 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140321 11:52:25 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140321 11:52:26 InnoDB: Started; log sequence number 1 4023808129
140321 11:52:26 [Note] Event Scheduler: Loaded 0 events
140321 11:52:26 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140321 12:02:44 [Note] /usr/libexec/mysqld: Normal shutdown
140321 12:02:44 [Note] Event Scheduler: Purging the queue. 0 events
140321 12:02:44 InnoDB: Starting shutdown...
140321 12:02:47 InnoDB: Shutdown completed; log sequence number 1
4023808129
140321 12:02:47 [Note] /usr/libexec/mysqld: Shutdown complete
140321 12:02:47 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140321 12:06:06 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140321 12:06:07 InnoDB: Started; log sequence number 1 4023808129
140321 12:06:07 [Note] Event Scheduler: Loaded 0 events
140321 12:06:07 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140321 15:54:18 [Note] /usr/libexec/mysqld: Normal shutdown
140321 15:54:18 [Note] Event Scheduler: Purging the queue. 0 events
140321 15:54:20 InnoDB: Starting shutdown...
140321 15:54:22 InnoDB: Shutdown completed; log sequence number 1
4023808129
140321 15:54:22 [Note] /usr/libexec/mysqld: Shutdown complete
140321 15:54:22 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140321 15:54:26 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140321 15:54:26 InnoDB: Started; log sequence number 1 4023808129
140321 15:54:26 [Note] Event Scheduler: Loaded 0 events
140321 15:54:26 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140321 16:09:57 [Note] /usr/libexec/mysqld: Normal shutdown
140321 16:09:57 [Note] Event Scheduler: Purging the queue. 0 events
140321 16:09:59 InnoDB: Starting shutdown...
140321 16:10:02 InnoDB: Shutdown completed; log sequence number 1
4222382720
140321 16:10:02 [Note] /usr/libexec/mysqld: Shutdown complete
140321 16:10:02 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140321 16:10:02 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140321 16:10:03 InnoDB: Started; log sequence number 1 4222382720
140321 16:10:03 [Note] Event Scheduler: Loaded 0 events
140321 16:10:03 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140325 10:48:26 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
InnoDB: Log scan progressed past the checkpoint lsn 2 40199498
140325 10:48:26 InnoDB: Database was not shut down normally!
InnoDB: Starting crash recovery.
InnoDB: Reading tablespace information from the .ibd files...
InnoDB: Restoring possible half-written data pages from the doublewrite
InnoDB: buffer...
InnoDB: Doing recovery: scanned up to log sequence number 2 40202963
140325 10:48:26 InnoDB: Starting an apply batch of log records to the
database...
InnoDB: Progress in percents: 38 39 40 41 42 43 44 45 46 47 48 49 50 51 52
53 54 55 56 57 58 59 60 61 62 63 64 65 66 67 68 69 70 71 72 73 74 75 76 77
78 79 80 81 82 83 84 85 86 87 88 89 90 91 92 93 94 95 96 97 98 99
InnoDB: Apply batch completed
InnoDB: Last MySQL binlog file position 0 80960371, file name
./mysql-bin.000016
140325 10:48:27 InnoDB: Started; log sequence number 2 40202963
140325 10:48:27 [Note] Recovering after a crash using mysql-bin
140325 10:48:28 [Note] Starting crash recovery...
140325 10:48:28 [Note] Crash recovery finished.
140325 10:48:28 [Note] Event Scheduler: Loaded 0 events
140325 10:48:28 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140325 10:54:18 [Note] /usr/libexec/mysqld: Normal shutdown
140325 10:54:18 [Note] Event Scheduler: Purging the queue. 0 events
140325 10:54:18 InnoDB: Starting shutdown...
140325 10:54:23 InnoDB: Shutdown completed; log sequence number 2 40203100
140325 10:54:23 [Note] /usr/libexec/mysqld: Shutdown complete
140325 10:54:23 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140325 10:54:23 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140325 10:54:23 InnoDB: Started; log sequence number 2 40203100
140325 10:54:24 [Note] Event Scheduler: Loaded 0 events
140325 10:54:24 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140325 10:55:45 [Note] /usr/libexec/mysqld: Normal shutdown
140325 10:55:45 [Note] Event Scheduler: Purging the queue. 0 events
140325 10:55:45 InnoDB: Starting shutdown...
140325 10:55:49 InnoDB: Shutdown completed; log sequence number 2 40203100
140325 10:55:49 [Note] /usr/libexec/mysqld: Shutdown complete
140325 10:55:49 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140325 10:55:50 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140325 10:55:50 InnoDB: Started; log sequence number 2 40203100
140325 10:55:50 [Note] Event Scheduler: Loaded 0 events
140325 10:55:50 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140325 10:58:09 [Note] /usr/libexec/mysqld: Normal shutdown
140325 10:58:09 [Note] Event Scheduler: Purging the queue. 0 events
140325 10:58:09 InnoDB: Starting shutdown...
140325 10:58:10 InnoDB: Shutdown completed; log sequence number 2 40203100
140325 10:58:10 [Note] /usr/libexec/mysqld: Shutdown complete
140325 10:58:10 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140325 10:58:11 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140325 10:58:12 InnoDB: Started; log sequence number 2 40203100
140325 10:58:12 [Note] Event Scheduler: Loaded 0 events
140325 10:58:12 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140325 11:10:15 [Note] /usr/libexec/mysqld: Normal shutdown
140325 11:10:15 [Note] Event Scheduler: Purging the queue. 0 events
140325 11:10:15 InnoDB: Starting shutdown...
140325 11:10:21 InnoDB: Shutdown completed; log sequence number 2 349169511
140325 11:10:21 [Note] /usr/libexec/mysqld: Shutdown complete
140325 11:10:21 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140325 11:10:22 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140325 11:10:22 InnoDB: Started; log sequence number 2 349169511
140325 11:10:22 [Note] Event Scheduler: Loaded 0 events
140325 11:10:22 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140325 11:13:10 [Note] /usr/libexec/mysqld: Normal shutdown
140325 11:13:10 [Note] Event Scheduler: Purging the queue. 0 events
140325 11:13:10 InnoDB: Starting shutdown...
140325 11:13:12 InnoDB: Shutdown completed; log sequence number 2 349169511
140325 11:13:12 [Note] /usr/libexec/mysqld: Shutdown complete
140325 11:13:12 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140325 11:13:12 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140325 11:13:13 InnoDB: Started; log sequence number 2 349169511
140325 11:13:13 [Note] Event Scheduler: Loaded 0 events
140325 11:13:13 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140325 19:57:40 [Note] /usr/libexec/mysqld: Normal shutdown
140325 19:57:40 [Note] Event Scheduler: Purging the queue. 0 events
140325 19:57:40 InnoDB: Starting shutdown...
140325 19:57:43 InnoDB: Shutdown completed; log sequence number 2 349169511
140325 19:57:43 [Note] /usr/libexec/mysqld: Shutdown complete
140325 19:57:43 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140325 19:57:43 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140325 19:57:44 InnoDB: Started; log sequence number 2 349169511
140325 19:57:44 [Note] Event Scheduler: Loaded 0 events
140325 19:57:44 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
^C
Re: cloudstack平台无法打开
Posted by 风南 <wi...@gmail.com>.
是不是mysql重启导致的？
2014-03-26 13:58 GMT+08:00 ganglin_lan <ga...@tcloudcomputing.com>:
> cloudstack的日志给的不全，mysql的日志只显示到昨晚八点？
>
>
>
>
> ganglin_lan
>
> 发件人： 许叁征
> 发送时间： 2014-03-26 11:42
> 收件人： users-cn@cloudstack.apache.org
> 主题： cloudstack平台无法打开
> HI ALL
> 昨天虚拟机平台机器宕机后，重启发现平台无法打开，cloudstack 4.0.1 以及
> mysql日志报错如下：
> 请教 这个要如何处理，谢谢！
>
>
>
> [root@manager ~]# tailf
> /usr/share/cloud/management/logs/management-server.
> log
> at
> org.apache.catalina.core.StandardEngine.start(StandardEngine.java:443)
> at
> org.apache.catalina.core.StandardService.start(StandardService.java:516)
> at
> org.apache.catalina.core.StandardServer.start(StandardServer.java:710)
> at org.apache.catalina.startup.Catalina.start(Catalina.java:593)
> at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
> at
>
> sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57
> )
> at
>
> sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl
> .java:43)
> at java.lang.reflect.Method.invoke(Method.java:616)
> at org.apache.catalina.startup.Bootstrap.start(Bootstrap.java:289)
> at org.apache.catalina.startup.Bootstrap.main(Bootstrap.java:414)
> 2014-03-26 10:56:26,367 INFO [utils.component.ComponentLocator]
> (main:null)
> Config file found at /etc/cloud/management/components.xml. Configuring
> system-integrity-checker
> 2014-03-26 10:56:26,372 DEBUG [utils.component.ComponentLocator]
> (main:null)
> Looking for class com.cloud.cluster.ManagementServerNode
> 2014-03-26 10:56:26,391 INFO [utils.component.ComponentLocator]
> (main:null)
> Found component: com.cloud.utils.component.SystemIntegrityChecker in
> com.cloud.cluster.ManagementServerNode - ManagementServerNode
> 2014-03-26 10:56:26,391 INFO [utils.component.ComponentLocator]
> (main:null)
> Adding system integrity checker: ManagementServerNode
> 2014-03-26 10:56:26,391 DEBUG [utils.component.ComponentLocator]
> (main:null)
> Looking for class com.cloud.utils.crypt.EncryptionSecretKeyChecker
> 2014-03-26 10:56:26,400 INFO [utils.component.ComponentLocator]
> (main:null)
> Found component: com.cloud.utils.component.SystemIntegrityChecker in
> com.cloud.utils.crypt.EncryptionSecretKeyChecker -
> EncryptionSecretKeyChecker
> 2014-03-26 10:56:26,400 INFO [utils.component.ComponentLocator]
> (main:null)
> Adding system integrity checker: EncryptionSecretKeyChecker
> 2014-03-26 10:56:26,400 DEBUG [utils.component.ComponentLocator]
> (main:null)
> Looking for class com.cloud.upgrade.DatabaseIntegrityChecker
> 2014-03-26 10:56:26,401 INFO [utils.component.ComponentLocator]
> (main:null)
> Found component: com.cloud.utils.component.SystemIntegrityChecker in
> com.cloud.upgrade.DatabaseIntegrityChecker - DatabaseIntegrityChecker
> 2014-03-26 10:56:26,402 INFO [utils.component.ComponentLocator]
> (main:null)
> Adding system integrity checker: DatabaseIntegrityChecker
> 2014-03-26 10:56:26,402 DEBUG [utils.component.ComponentLocator]
> (main:null)
> Looking for class com.cloud.upgrade.PremiumDatabaseUpgradeChecker
> 2014-03-26 10:56:26,403 INFO [utils.component.ComponentLocator]
> (main:null)
> Found component: com.cloud.utils.component.SystemIntegrityChecker in
> com.cloud.upgrade.PremiumDatabaseUpgradeChecker - DatabaseUpgradeChecker
> 2014-03-26 10:56:26,403 INFO [utils.component.ComponentLocator]
> (main:null)
> Adding system integrity checker: DatabaseUpgradeChecker
> 2014-03-26 10:56:26,474 DEBUG [utils.crypt.EncryptionSecretKeyChecker]
> (main:null) Encryption Type: file
> 2014-03-26 10:56:26,557 INFO [cloud.upgrade.DatabaseIntegrityChecker]
> (main:null) Grabbing lock to check for database integrity.
> 2014-03-26 10:56:30,774 ERROR [db.Transaction.Transaction] (main:null)
> Unexpected exception:
> com.mysql.jdbc.exceptions.jdbc4.MySQLNonTransientConnectionException: Could
> not create connection to database server. Attempted reconnect 3 times.
> Giving up.
> at sun.reflect.NativeConstructorAccessorImpl.newInstance0(Native
> Method)
> at
>
> sun.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAcces
> sorImpl.java:57)
> at
>
> sun.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstruc
> torAccessorImpl.java:45)
> at java.lang.reflect.Constructor.newInstance(Constructor.java:532)
> at com.mysql.jdbc.Util.handleNewInstance(Util.java:411)
> at com.mysql.jdbc.Util.getInstance(Util.java:386)
> at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:1013)
> at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:987)
> at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:982)
> at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:927)
> at
> com.mysql.jdbc.ConnectionImpl.connectWithRetries(ConnectionImpl.java:2238)
> at
> com.mysql.jdbc.ConnectionImpl.createNewIO(ConnectionImpl.java:2159)
> at com.mysql.jdbc.ConnectionImpl.<init>(ConnectionImpl.java:792)
> at com.mysql.jdbc.JDBC4Connection.<init>(JDBC4Connection.java:49)
> at sun.reflect.NativeConstructorAccessorImpl.newInstance0(Native
> Method)
> at
>
> sun.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAcces
> sorImpl.java:57)
> at
>
> sun.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstruc
> torAccessorImpl.java:45)
> at java.lang.reflect.Constructor.newInstance(Constructor.java:532)
> at com.mysql.jdbc.Util.handleNewInstance(Util.java:411)
> at
> com.mysql.jdbc.ConnectionImpl.getInstance(ConnectionImpl.java:381)
> at com.mysql.jdbc.NonRegisteringDriver.connect(NonRegisteringDriver.
> java:305)
> at java.sql.DriverManager.getConnection(DriverManager.java:620)
> at java.sql.DriverManager.getConnection(DriverManager.java:200)
> at
>
> org.apache.commons.dbcp.DriverManagerConnectionFactory.createConnection(Driv
> erManagerConnectionFactory.java:48)
> at
>
> org.apache.commons.dbcp.PoolableConnectionFactory.makeObject(PoolableConnect
> ionFactory.java:290)
> at
>
> org.apache.commons.pool.impl.GenericObjectPool.borrowObject(GenericObjectPoo
> l.java:840)
> at
>
> org.apache.commons.dbcp.PoolingDataSource.getConnection(PoolingDataSource.ja
> va:95)
> at
>
> com.cloud.utils.db.Transaction.getStandaloneConnectionWithException(Transact
> ion.java:200)
> at
>
> com.cloud.utils.db.Transaction.getStandaloneConnection(Transaction.java:209)
> at
> com.cloud.utils.db.DbUtil.getConnectionForGlobalLocks(DbUtil.java:58)
> at com.cloud.utils.db.DbUtil.getGlobalLock(DbUtil.java:203)
> at com.cloud.utils.db.GlobalLock.lock(GlobalLock.java:151)
> at
>
> com.cloud.upgrade.DatabaseIntegrityChecker.check(DatabaseIntegrityChecker.ja
> va:228)
> at
>
> com.cloud.utils.component.ComponentLocator.runCheckers(ComponentLocator.java
> :273)
> at
> com.cloud.utils.component.ComponentLocator.parse(ComponentLocator.java:245)
> at
>
> com.cloud.utils.component.ComponentLocator.getLocatorInternal(ComponentLocat
> or.java:836)
> at
>
> com.cloud.utils.component.ComponentLocator.getLocator(ComponentLocator.java:
> 874)
> at
>
> com.cloud.utils.component.ComponentLocator.getComponent(ComponentLocator.jav
> a:416)
> at
>
> com.cloud.utils.component.ComponentLocator.getComponent(ComponentLocator.jav
> a:409)
> at
> com.cloud.servlet.CloudStartupServlet.init(CloudStartupServlet.java:44)
> at javax.servlet.GenericServlet.init(GenericServlet.java:212)
> at
>
> org.apache.catalina.core.StandardWrapper.loadServlet(StandardWrapper.java:11
> 73)
> at
> org.apache.catalina.core.StandardWrapper.load(StandardWrapper.java:993)
> at
>
> org.apache.catalina.core.StandardContext.loadOnStartup(StandardContext.java:
> 4187)
> at
> org.apache.catalina.core.StandardContext.start(StandardContext.java:4496)
> at
>
> org.apache.catalina.core.ContainerBase.addChildInternal(ContainerBase.java:7
> 91)
> at
> org.apache.catalina.core.ContainerBase.addChild(ContainerBase.java:771)
> at
> org.apache.catalina.core.StandardHost.addChild(StandardHost.java:526)
> at
>
> org.apache.catalina.startup.HostConfig.deployDirectory(HostConfig.java:1041)
> at
>
> org.apache.catalina.startup.HostConfig.deployDirectories(HostConfig.java:964
> )
> at
> org.apache.catalina.startup.HostConfig.deployApps(HostConfig.java:502)
> at
> org.apache.catalina.startup.HostConfig.start(HostConfig.java:1277)
> at org.apache.catalina.startup.HostConfig.lifecycleEvent(HostConfig.
> java:321)
> at
>
> org.apache.catalina.util.LifecycleSupport.fireLifecycleEvent(LifecycleSuppor
> t.java:119)
> at
> org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1053)
> at
> org.apache.catalina.core.StandardHost.start(StandardHost.java:722)
> at
> org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1045)
> at
> org.apache.catalina.core.StandardEngine.start(StandardEngine.java:443)
> at
> org.apache.catalina.core.StandardService.start(StandardService.java:516)
> at
> org.apache.catalina.core.StandardServer.start(StandardServer.java:710)
> at org.apache.catalina.startup.Catalina.start(Catalina.java:593)
> at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
> at
>
> sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57
> )
> at
>
> sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl
> .java:43)
> at java.lang.reflect.Method.invoke(Method.java:616)
> at org.apache.catalina.startup.Bootstrap.start(Bootstrap.java:289)
> at org.apache.catalina.startup.Bootstrap.main(Bootstrap.java:414)
> Caused by: java.sql.SQLException: Access denied for user 'cloud'@
> 'localhost'
> (using password: YES)
> ... 66 more
> 2014-03-26 10:56:30,778 ERROR [utils.db.DbUtil] (main:null) Unable to
> acquire DB connection for global lock system
> 2014-03-26 10:56:30,778 ERROR [utils.db.DbUtil] (main:null) Unable to
> acquire DB connection for global lock system
> 2014-03-26 10:56:30,779 ERROR [utils.component.ComponentLocator]
> (main:null)
> Problems with running checker:DatabaseIntegrityChecker
> com.cloud.utils.exception.CloudRuntimeException: Unable to acquire lock to
> check for database integrity.
> at
>
> com.cloud.upgrade.DatabaseIntegrityChecker.check(DatabaseIntegrityChecker.ja
> va:229)
> at
>
> com.cloud.utils.component.ComponentLocator.runCheckers(ComponentLocator.java
> :273)
> at
> com.cloud.utils.component.ComponentLocator.parse(ComponentLocator.java:245)
> at
>
> com.cloud.utils.component.ComponentLocator.getLocatorInternal(ComponentLocat
> or.java:836)
> at
>
> com.cloud.utils.component.ComponentLocator.getLocator(ComponentLocator.java:
> 874)
> at
>
> com.cloud.utils.component.ComponentLocator.getComponent(ComponentLocator.jav
> a:416)
> at
>
> com.cloud.utils.component.ComponentLocator.getComponent(ComponentLocator.jav
> a:409)
> at
> com.cloud.servlet.CloudStartupServlet.init(CloudStartupServlet.java:44)
> at javax.servlet.GenericServlet.init(GenericServlet.java:212)
> at
>
> org.apache.catalina.core.StandardWrapper.loadServlet(StandardWrapper.java:11
> 73)
> at
> org.apache.catalina.core.StandardWrapper.load(StandardWrapper.java:993)
> at
>
> org.apache.catalina.core.StandardContext.loadOnStartup(StandardContext.java:
> 4187)
> at
> org.apache.catalina.core.StandardContext.start(StandardContext.java:4496)
> at
>
> org.apache.catalina.core.ContainerBase.addChildInternal(ContainerBase.java:7
> 91)
> at
> org.apache.catalina.core.ContainerBase.addChild(ContainerBase.java:771)
> at
> org.apache.catalina.core.StandardHost.addChild(StandardHost.java:526)
> at
>
> org.apache.catalina.startup.HostConfig.deployDirectory(HostConfig.java:1041)
> at
>
> org.apache.catalina.startup.HostConfig.deployDirectories(HostConfig.java:964
> )
> at
> org.apache.catalina.startup.HostConfig.deployApps(HostConfig.java:502)
> at
> org.apache.catalina.startup.HostConfig.start(HostConfig.java:1277)
> at org.apache.catalina.startup.HostConfig.lifecycleEvent(HostConfig.
> java:321)
> at
>
> org.apache.catalina.util.LifecycleSupport.fireLifecycleEvent(LifecycleSuppor
> t.java:119)
> at
> org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1053)
> at
> org.apache.catalina.core.StandardHost.start(StandardHost.java:722)
> at
> org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1045)
> at
> org.apache.catalina.core.StandardEngine.start(StandardEngine.java:443)
> at
> org.apache.catalina.core.StandardService.start(StandardService.java:516)
> at
> org.apache.catalina.core.StandardServer.start(StandardServer.java:710)
> at org.apache.catalina.startup.Catalina.start(Catalina.java:593)
> at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
> at
>
> sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57
> )
> at
>
> sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl
> .java:43)
> at java.lang.reflect.Method.invoke(Method.java:616)
> at org.apache.catalina.startup.Bootstrap.start(Bootstrap.java:289)
> at org.apache.catalina.startup.Bootstrap.main(Bootstrap.java:414)
>
>
>
>
>
>
>
>
>
> ——————————————————————————————————————
> ——————————————
> MYSQL 日志情况
>
>
>
> 140113 14:27:04 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> InnoDB: The first specified data file ./ibdata1 did not exist:
> InnoDB: a new database to be created!
> 140113 14:27:04 InnoDB: Setting file ./ibdata1 size to 10 MB
> InnoDB: Database physically writes the file full: wait...
> 140113 14:27:04 InnoDB: Log file ./ib_logfile0 did not exist: new to be
> created
> InnoDB: Setting log file ./ib_logfile0 size to 5 MB
> InnoDB: Database physically writes the file full: wait...
> 140113 14:27:04 InnoDB: Log file ./ib_logfile1 did not exist: new to be
> created
> InnoDB: Setting log file ./ib_logfile1 size to 5 MB
> InnoDB: Database physically writes the file full: wait...
> InnoDB: Doublewrite buffer not found: creating new
> InnoDB: Doublewrite buffer created
> InnoDB: Creating foreign key constraint system tables
> InnoDB: Foreign key constraint system tables created
> 140113 14:27:05 InnoDB: Started; log sequence number 0 0
> 140113 14:27:05 [Note] Event Scheduler: Loaded 0 events
> 140113 14:27:05 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52' socket: '/var/lib/mysql/mysql.sock' port: 3306 Source
> distribution
> 140113 14:31:34 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140113 14:31:34 [Note] Event Scheduler: Purging the queue. 0 events
> 140113 14:31:36 InnoDB: Starting shutdown...
> 140113 14:31:40 InnoDB: Shutdown completed; log sequence number 0 44233
> 140113 14:31:40 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140113 14:31:40 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140113 14:31:40 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140113 14:31:40 InnoDB: Started; log sequence number 0 44233
> 140113 14:31:41 [Note] Event Scheduler: Loaded 0 events
> 140113 14:31:41 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140113 15:00:00 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140113 15:00:00 [Note] Event Scheduler: Purging the queue. 0 events
> 140113 15:00:02 InnoDB: Starting shutdown...
> 140113 15:00:03 InnoDB: Shutdown completed; log sequence number 0
> 272572978
> 140113 15:00:03 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140113 15:00:03 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140113 15:00:03 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140113 15:00:03 InnoDB: Started; log sequence number 0 272572978
> 140113 15:00:04 [Note] Event Scheduler: Loaded 0 events
> 140113 15:00:04 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140113 16:07:27 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140113 16:07:27 [Note] Event Scheduler: Purging the queue. 0 events
> 140113 16:07:29 InnoDB: Starting shutdown...
> 140113 16:07:33 InnoDB: Shutdown completed; log sequence number 0
> 276001744
> 140113 16:07:33 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140113 16:07:33 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140113 16:15:10 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140113 16:15:10 InnoDB: Started; log sequence number 0 276001744
> 140113 16:15:10 [Note] Event Scheduler: Loaded 0 events
> 140113 16:15:10 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140113 16:40:49 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140113 16:40:49 [Note] Event Scheduler: Purging the queue. 0 events
> 140113 16:40:51 InnoDB: Starting shutdown...
> 140113 16:40:53 InnoDB: Shutdown completed; log sequence number 0
> 1611724675
> 140113 16:40:53 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140113 16:40:53 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140113 16:43:53 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140113 16:43:54 InnoDB: Started; log sequence number 0 1611724675
> 140113 16:43:54 [Note] Event Scheduler: Loaded 0 events
> 140113 16:43:54 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140113 16:46:41 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140113 16:46:41 [Note] Event Scheduler: Purging the queue. 0 events
> 140113 16:46:43 InnoDB: Starting shutdown...
> 140113 16:46:46 InnoDB: Shutdown completed; log sequence number 0
> 1611727339
> 140113 16:46:46 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140113 16:46:46 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140113 16:46:46 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140113 16:46:47 InnoDB: Started; log sequence number 0 1611727339
> 140113 16:46:47 [Note] Event Scheduler: Loaded 0 events
> 140113 16:46:47 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140120 15:03:43 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> InnoDB: Log scan progressed past the checkpoint lsn 0 2652244913
> 140120 15:03:43 InnoDB: Database was not shut down normally!
> InnoDB: Starting crash recovery.
> InnoDB: Reading tablespace information from the .ibd files...
> InnoDB: Restoring possible half-written data pages from the doublewrite
> InnoDB: buffer...
> InnoDB: Doing recovery: scanned up to log sequence number 0 2652246897
> 140120 15:03:44 InnoDB: Starting an apply batch of log records to the
> database...
> InnoDB: Progress in percents: 0 1 2 3 4 5 6 7 8 9 10 11 12 13 14 15 16 17
> 18
> 19 20 21 22 23 24 25 26 27 28 29 30 31 32 33 34 35 36 37 38 39 40 41 42 43
> 44 45 46 47 48 49 50 51 52 53 54 55 56 57 58 59 60 61 62 63 64 65 66 67 68
> 69 70 71 72 73 74 75 76 77 78 79 80 81 82 83 84 85 86 87 88 89 90 91 92 93
> 94 95 96 97 98 99
> InnoDB: Apply batch completed
> InnoDB: Last MySQL binlog file position 0 425635668, file name
> ./mysql-bin.000005
> 140120 15:03:45 InnoDB: Started; log sequence number 0 2652246897
> 140120 15:03:45 [Note] Recovering after a crash using mysql-bin
> 140120 15:03:47 [Note] Starting crash recovery...
> 140120 15:03:47 [Note] Crash recovery finished.
> 140120 15:03:47 [Note] Event Scheduler: Loaded 0 events
> 140120 15:03:47 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140227 18:23:19 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140227 18:23:19 [Note] Event Scheduler: Purging the queue. 0 events
> 140227 18:23:19 InnoDB: Starting shutdown...
> 140227 18:23:21 InnoDB: Shutdown completed; log sequence number 1
> 247642825
> 140227 18:23:21 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140227 18:23:21 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140227 18:26:28 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140227 18:26:28 InnoDB: Started; log sequence number 1 247642825
> 140227 18:26:29 [Note] Event Scheduler: Loaded 0 events
> 140227 18:26:29 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140227 19:51:32 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140227 19:51:32 [Note] Event Scheduler: Purging the queue. 0 events
> 140227 19:51:34 InnoDB: Starting shutdown...
> 140227 19:51:35 InnoDB: Shutdown completed; log sequence number 1
> 531142952
> 140227 19:51:35 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140227 19:51:35 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140227 19:51:36 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140227 19:51:36 InnoDB: Started; log sequence number 1 531142952
> 140227 19:51:36 [Note] Event Scheduler: Loaded 0 events
> 140227 19:51:36 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140227 21:22:56 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140227 21:22:56 [Note] Event Scheduler: Purging the queue. 0 events
> 140227 21:22:56 InnoDB: Starting shutdown...
> 140227 21:22:58 InnoDB: Shutdown completed; log sequence number 1
> 818066929
> 140227 21:22:58 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140227 21:22:58 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140227 21:23:02 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140227 21:23:02 InnoDB: Started; log sequence number 1 818066929
> 140227 21:23:02 [Note] Event Scheduler: Loaded 0 events
> 140227 21:23:02 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140228 17:15:26 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140228 17:15:26 [Note] Event Scheduler: Purging the queue. 0 events
> 140228 17:15:28 InnoDB: Starting shutdown...
> 140228 17:15:31 InnoDB: Shutdown completed; log sequence number 1
> 1030287660
> 140228 17:15:31 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140228 17:15:31 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140228 17:15:31 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140228 17:15:32 InnoDB: Started; log sequence number 1 1030287660
> 140228 17:15:32 [Note] Event Scheduler: Loaded 0 events
> 140228 17:15:32 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140304 13:41:07 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140304 13:41:07 [Note] Event Scheduler: Purging the queue. 0 events
> 140304 13:41:10 InnoDB: Starting shutdown...
> 140304 13:41:14 InnoDB: Shutdown completed; log sequence number 1
> 2183881397
> 140304 13:41:14 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140304 13:41:14 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140304 13:44:55 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140304 13:44:55 InnoDB: Started; log sequence number 1 2183881397
> 140304 13:44:56 [Note] Event Scheduler: Loaded 0 events
> 140304 13:44:56 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140321 11:52:22 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140321 11:52:22 [Note] Event Scheduler: Purging the queue. 0 events
> 140321 11:52:22 InnoDB: Starting shutdown...
> 140321 11:52:25 InnoDB: Shutdown completed; log sequence number 1
> 4023808129
> 140321 11:52:25 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140321 11:52:25 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140321 11:52:25 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140321 11:52:26 InnoDB: Started; log sequence number 1 4023808129
> 140321 11:52:26 [Note] Event Scheduler: Loaded 0 events
> 140321 11:52:26 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140321 12:02:44 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140321 12:02:44 [Note] Event Scheduler: Purging the queue. 0 events
> 140321 12:02:44 InnoDB: Starting shutdown...
> 140321 12:02:47 InnoDB: Shutdown completed; log sequence number 1
> 4023808129
> 140321 12:02:47 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140321 12:02:47 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140321 12:06:06 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140321 12:06:07 InnoDB: Started; log sequence number 1 4023808129
> 140321 12:06:07 [Note] Event Scheduler: Loaded 0 events
> 140321 12:06:07 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140321 15:54:18 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140321 15:54:18 [Note] Event Scheduler: Purging the queue. 0 events
> 140321 15:54:20 InnoDB: Starting shutdown...
> 140321 15:54:22 InnoDB: Shutdown completed; log sequence number 1
> 4023808129
> 140321 15:54:22 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140321 15:54:22 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140321 15:54:26 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140321 15:54:26 InnoDB: Started; log sequence number 1 4023808129
> 140321 15:54:26 [Note] Event Scheduler: Loaded 0 events
> 140321 15:54:26 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140321 16:09:57 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140321 16:09:57 [Note] Event Scheduler: Purging the queue. 0 events
> 140321 16:09:59 InnoDB: Starting shutdown...
> 140321 16:10:02 InnoDB: Shutdown completed; log sequence number 1
> 4222382720
> 140321 16:10:02 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140321 16:10:02 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140321 16:10:02 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140321 16:10:03 InnoDB: Started; log sequence number 1 4222382720
> 140321 16:10:03 [Note] Event Scheduler: Loaded 0 events
> 140321 16:10:03 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140325 10:48:26 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> InnoDB: Log scan progressed past the checkpoint lsn 2 40199498
> 140325 10:48:26 InnoDB: Database was not shut down normally!
> InnoDB: Starting crash recovery.
> InnoDB: Reading tablespace information from the .ibd files...
> InnoDB: Restoring possible half-written data pages from the doublewrite
> InnoDB: buffer...
> InnoDB: Doing recovery: scanned up to log sequence number 2 40202963
> 140325 10:48:26 InnoDB: Starting an apply batch of log records to the
> database...
> InnoDB: Progress in percents: 38 39 40 41 42 43 44 45 46 47 48 49 50 51 52
> 53 54 55 56 57 58 59 60 61 62 63 64 65 66 67 68 69 70 71 72 73 74 75 76 77
> 78 79 80 81 82 83 84 85 86 87 88 89 90 91 92 93 94 95 96 97 98 99
> InnoDB: Apply batch completed
> InnoDB: Last MySQL binlog file position 0 80960371, file name
> ./mysql-bin.000016
> 140325 10:48:27 InnoDB: Started; log sequence number 2 40202963
> 140325 10:48:27 [Note] Recovering after a crash using mysql-bin
> 140325 10:48:28 [Note] Starting crash recovery...
> 140325 10:48:28 [Note] Crash recovery finished.
> 140325 10:48:28 [Note] Event Scheduler: Loaded 0 events
> 140325 10:48:28 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140325 10:54:18 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140325 10:54:18 [Note] Event Scheduler: Purging the queue. 0 events
> 140325 10:54:18 InnoDB: Starting shutdown...
> 140325 10:54:23 InnoDB: Shutdown completed; log sequence number 2 40203100
> 140325 10:54:23 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140325 10:54:23 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140325 10:54:23 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140325 10:54:23 InnoDB: Started; log sequence number 2 40203100
> 140325 10:54:24 [Note] Event Scheduler: Loaded 0 events
> 140325 10:54:24 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140325 10:55:45 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140325 10:55:45 [Note] Event Scheduler: Purging the queue. 0 events
> 140325 10:55:45 InnoDB: Starting shutdown...
> 140325 10:55:49 InnoDB: Shutdown completed; log sequence number 2 40203100
> 140325 10:55:49 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140325 10:55:49 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140325 10:55:50 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140325 10:55:50 InnoDB: Started; log sequence number 2 40203100
> 140325 10:55:50 [Note] Event Scheduler: Loaded 0 events
> 140325 10:55:50 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140325 10:58:09 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140325 10:58:09 [Note] Event Scheduler: Purging the queue. 0 events
> 140325 10:58:09 InnoDB: Starting shutdown...
> 140325 10:58:10 InnoDB: Shutdown completed; log sequence number 2 40203100
> 140325 10:58:10 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140325 10:58:10 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140325 10:58:11 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140325 10:58:12 InnoDB: Started; log sequence number 2 40203100
> 140325 10:58:12 [Note] Event Scheduler: Loaded 0 events
> 140325 10:58:12 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140325 11:10:15 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140325 11:10:15 [Note] Event Scheduler: Purging the queue. 0 events
> 140325 11:10:15 InnoDB: Starting shutdown...
> 140325 11:10:21 InnoDB: Shutdown completed; log sequence number 2
> 349169511
> 140325 11:10:21 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140325 11:10:21 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140325 11:10:22 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140325 11:10:22 InnoDB: Started; log sequence number 2 349169511
> 140325 11:10:22 [Note] Event Scheduler: Loaded 0 events
> 140325 11:10:22 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140325 11:13:10 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140325 11:13:10 [Note] Event Scheduler: Purging the queue. 0 events
> 140325 11:13:10 InnoDB: Starting shutdown...
> 140325 11:13:12 InnoDB: Shutdown completed; log sequence number 2
> 349169511
> 140325 11:13:12 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140325 11:13:12 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140325 11:13:12 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140325 11:13:13 InnoDB: Started; log sequence number 2 349169511
> 140325 11:13:13 [Note] Event Scheduler: Loaded 0 events
> 140325 11:13:13 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140325 19:57:40 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140325 19:57:40 [Note] Event Scheduler: Purging the queue. 0 events
> 140325 19:57:40 InnoDB: Starting shutdown...
> 140325 19:57:43 InnoDB: Shutdown completed; log sequence number 2
> 349169511
> 140325 19:57:43 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140325 19:57:43 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140325 19:57:43 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140325 19:57:44 InnoDB: Started; log sequence number 2 349169511
> 140325 19:57:44 [Note] Event Scheduler: Loaded 0 events
> 140325 19:57:44 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> ^C
>
--
Best Regards
回复: cloudstack平台无法打开
Posted by ganglin_lan <ga...@tcloudcomputing.com>.
cloudstack的日志给的不全，mysql的日志只显示到昨晚八点？
ganglin_lan
发件人： 许叁征
发送时间： 2014-03-26 11:42
收件人： users-cn@cloudstack.apache.org
主题： cloudstack平台无法打开
HI ALL
昨天虚拟机平台机器宕机后，重启发现平台无法打开，cloudstack 4.0.1 以及
mysql日志报错如下：
请教 这个要如何处理，谢谢！
[root@manager ~]# tailf /usr/share/cloud/management/logs/management-server.
log
at
org.apache.catalina.core.StandardEngine.start(StandardEngine.java:443)
at
org.apache.catalina.core.StandardService.start(StandardService.java:516)
at
org.apache.catalina.core.StandardServer.start(StandardServer.java:710)
at org.apache.catalina.startup.Catalina.start(Catalina.java:593)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57
)
at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl
.java:43)
at java.lang.reflect.Method.invoke(Method.java:616)
at org.apache.catalina.startup.Bootstrap.start(Bootstrap.java:289)
at org.apache.catalina.startup.Bootstrap.main(Bootstrap.java:414)
2014-03-26 10:56:26,367 INFO [utils.component.ComponentLocator] (main:null)
Config file found at /etc/cloud/management/components.xml. Configuring
system-integrity-checker
2014-03-26 10:56:26,372 DEBUG [utils.component.ComponentLocator] (main:null)
Looking for class com.cloud.cluster.ManagementServerNode
2014-03-26 10:56:26,391 INFO [utils.component.ComponentLocator] (main:null)
Found component: com.cloud.utils.component.SystemIntegrityChecker in
com.cloud.cluster.ManagementServerNode - ManagementServerNode
2014-03-26 10:56:26,391 INFO [utils.component.ComponentLocator] (main:null)
Adding system integrity checker: ManagementServerNode
2014-03-26 10:56:26,391 DEBUG [utils.component.ComponentLocator] (main:null)
Looking for class com.cloud.utils.crypt.EncryptionSecretKeyChecker
2014-03-26 10:56:26,400 INFO [utils.component.ComponentLocator] (main:null)
Found component: com.cloud.utils.component.SystemIntegrityChecker in
com.cloud.utils.crypt.EncryptionSecretKeyChecker -
EncryptionSecretKeyChecker
2014-03-26 10:56:26,400 INFO [utils.component.ComponentLocator] (main:null)
Adding system integrity checker: EncryptionSecretKeyChecker
2014-03-26 10:56:26,400 DEBUG [utils.component.ComponentLocator] (main:null)
Looking for class com.cloud.upgrade.DatabaseIntegrityChecker
2014-03-26 10:56:26,401 INFO [utils.component.ComponentLocator] (main:null)
Found component: com.cloud.utils.component.SystemIntegrityChecker in
com.cloud.upgrade.DatabaseIntegrityChecker - DatabaseIntegrityChecker
2014-03-26 10:56:26,402 INFO [utils.component.ComponentLocator] (main:null)
Adding system integrity checker: DatabaseIntegrityChecker
2014-03-26 10:56:26,402 DEBUG [utils.component.ComponentLocator] (main:null)
Looking for class com.cloud.upgrade.PremiumDatabaseUpgradeChecker
2014-03-26 10:56:26,403 INFO [utils.component.ComponentLocator] (main:null)
Found component: com.cloud.utils.component.SystemIntegrityChecker in
com.cloud.upgrade.PremiumDatabaseUpgradeChecker - DatabaseUpgradeChecker
2014-03-26 10:56:26,403 INFO [utils.component.ComponentLocator] (main:null)
Adding system integrity checker: DatabaseUpgradeChecker
2014-03-26 10:56:26,474 DEBUG [utils.crypt.EncryptionSecretKeyChecker]
(main:null) Encryption Type: file
2014-03-26 10:56:26,557 INFO [cloud.upgrade.DatabaseIntegrityChecker]
(main:null) Grabbing lock to check for database integrity.
2014-03-26 10:56:30,774 ERROR [db.Transaction.Transaction] (main:null)
Unexpected exception:
com.mysql.jdbc.exceptions.jdbc4.MySQLNonTransientConnectionException: Could
not create connection to database server. Attempted reconnect 3 times.
Giving up.
at sun.reflect.NativeConstructorAccessorImpl.newInstance0(Native
Method)
at
sun.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAcces
sorImpl.java:57)
at
sun.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstruc
torAccessorImpl.java:45)
at java.lang.reflect.Constructor.newInstance(Constructor.java:532)
at com.mysql.jdbc.Util.handleNewInstance(Util.java:411)
at com.mysql.jdbc.Util.getInstance(Util.java:386)
at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:1013)
at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:987)
at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:982)
at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:927)
at
com.mysql.jdbc.ConnectionImpl.connectWithRetries(ConnectionImpl.java:2238)
at
com.mysql.jdbc.ConnectionImpl.createNewIO(ConnectionImpl.java:2159)
at com.mysql.jdbc.ConnectionImpl.<init>(ConnectionImpl.java:792)
at com.mysql.jdbc.JDBC4Connection.<init>(JDBC4Connection.java:49)
at sun.reflect.NativeConstructorAccessorImpl.newInstance0(Native
Method)
at
sun.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAcces
sorImpl.java:57)
at
sun.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstruc
torAccessorImpl.java:45)
at java.lang.reflect.Constructor.newInstance(Constructor.java:532)
at com.mysql.jdbc.Util.handleNewInstance(Util.java:411)
at
com.mysql.jdbc.ConnectionImpl.getInstance(ConnectionImpl.java:381)
at com.mysql.jdbc.NonRegisteringDriver.connect(NonRegisteringDriver.
java:305)
at java.sql.DriverManager.getConnection(DriverManager.java:620)
at java.sql.DriverManager.getConnection(DriverManager.java:200)
at
org.apache.commons.dbcp.DriverManagerConnectionFactory.createConnection(Driv
erManagerConnectionFactory.java:48)
at
org.apache.commons.dbcp.PoolableConnectionFactory.makeObject(PoolableConnect
ionFactory.java:290)
at
org.apache.commons.pool.impl.GenericObjectPool.borrowObject(GenericObjectPoo
l.java:840)
at
org.apache.commons.dbcp.PoolingDataSource.getConnection(PoolingDataSource.ja
va:95)
at
com.cloud.utils.db.Transaction.getStandaloneConnectionWithException(Transact
ion.java:200)
at
com.cloud.utils.db.Transaction.getStandaloneConnection(Transaction.java:209)
at
com.cloud.utils.db.DbUtil.getConnectionForGlobalLocks(DbUtil.java:58)
at com.cloud.utils.db.DbUtil.getGlobalLock(DbUtil.java:203)
at com.cloud.utils.db.GlobalLock.lock(GlobalLock.java:151)
at
com.cloud.upgrade.DatabaseIntegrityChecker.check(DatabaseIntegrityChecker.ja
va:228)
at
com.cloud.utils.component.ComponentLocator.runCheckers(ComponentLocator.java
:273)
at
com.cloud.utils.component.ComponentLocator.parse(ComponentLocator.java:245)
at
com.cloud.utils.component.ComponentLocator.getLocatorInternal(ComponentLocat
or.java:836)
at
com.cloud.utils.component.ComponentLocator.getLocator(ComponentLocator.java:
874)
at
com.cloud.utils.component.ComponentLocator.getComponent(ComponentLocator.jav
a:416)
at
com.cloud.utils.component.ComponentLocator.getComponent(ComponentLocator.jav
a:409)
at
com.cloud.servlet.CloudStartupServlet.init(CloudStartupServlet.java:44)
at javax.servlet.GenericServlet.init(GenericServlet.java:212)
at
org.apache.catalina.core.StandardWrapper.loadServlet(StandardWrapper.java:11
73)
at
org.apache.catalina.core.StandardWrapper.load(StandardWrapper.java:993)
at
org.apache.catalina.core.StandardContext.loadOnStartup(StandardContext.java:
4187)
at
org.apache.catalina.core.StandardContext.start(StandardContext.java:4496)
at
org.apache.catalina.core.ContainerBase.addChildInternal(ContainerBase.java:7
91)
at
org.apache.catalina.core.ContainerBase.addChild(ContainerBase.java:771)
at
org.apache.catalina.core.StandardHost.addChild(StandardHost.java:526)
at
org.apache.catalina.startup.HostConfig.deployDirectory(HostConfig.java:1041)
at
org.apache.catalina.startup.HostConfig.deployDirectories(HostConfig.java:964
)
at
org.apache.catalina.startup.HostConfig.deployApps(HostConfig.java:502)
at
org.apache.catalina.startup.HostConfig.start(HostConfig.java:1277)
at org.apache.catalina.startup.HostConfig.lifecycleEvent(HostConfig.
java:321)
at
org.apache.catalina.util.LifecycleSupport.fireLifecycleEvent(LifecycleSuppor
t.java:119)
at
org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1053)
at
org.apache.catalina.core.StandardHost.start(StandardHost.java:722)
at
org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1045)
at
org.apache.catalina.core.StandardEngine.start(StandardEngine.java:443)
at
org.apache.catalina.core.StandardService.start(StandardService.java:516)
at
org.apache.catalina.core.StandardServer.start(StandardServer.java:710)
at org.apache.catalina.startup.Catalina.start(Catalina.java:593)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57
)
at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl
.java:43)
at java.lang.reflect.Method.invoke(Method.java:616)
at org.apache.catalina.startup.Bootstrap.start(Bootstrap.java:289)
at org.apache.catalina.startup.Bootstrap.main(Bootstrap.java:414)
Caused by: java.sql.SQLException: Access denied for user 'cloud'@'localhost'
(using password: YES)
... 66 more
2014-03-26 10:56:30,778 ERROR [utils.db.DbUtil] (main:null) Unable to
acquire DB connection for global lock system
2014-03-26 10:56:30,778 ERROR [utils.db.DbUtil] (main:null) Unable to
acquire DB connection for global lock system
2014-03-26 10:56:30,779 ERROR [utils.component.ComponentLocator] (main:null)
Problems with running checker:DatabaseIntegrityChecker
com.cloud.utils.exception.CloudRuntimeException: Unable to acquire lock to
check for database integrity.
at
com.cloud.upgrade.DatabaseIntegrityChecker.check(DatabaseIntegrityChecker.ja
va:229)
at
com.cloud.utils.component.ComponentLocator.runCheckers(ComponentLocator.java
:273)
at
com.cloud.utils.component.ComponentLocator.parse(ComponentLocator.java:245)
at
com.cloud.utils.component.ComponentLocator.getLocatorInternal(ComponentLocat
or.java:836)
at
com.cloud.utils.component.ComponentLocator.getLocator(ComponentLocator.java:
874)
at
com.cloud.utils.component.ComponentLocator.getComponent(ComponentLocator.jav
a:416)
at
com.cloud.utils.component.ComponentLocator.getComponent(ComponentLocator.jav
a:409)
at
com.cloud.servlet.CloudStartupServlet.init(CloudStartupServlet.java:44)
at javax.servlet.GenericServlet.init(GenericServlet.java:212)
at
org.apache.catalina.core.StandardWrapper.loadServlet(StandardWrapper.java:11
73)
at
org.apache.catalina.core.StandardWrapper.load(StandardWrapper.java:993)
at
org.apache.catalina.core.StandardContext.loadOnStartup(StandardContext.java:
4187)
at
org.apache.catalina.core.StandardContext.start(StandardContext.java:4496)
at
org.apache.catalina.core.ContainerBase.addChildInternal(ContainerBase.java:7
91)
at
org.apache.catalina.core.ContainerBase.addChild(ContainerBase.java:771)
at
org.apache.catalina.core.StandardHost.addChild(StandardHost.java:526)
at
org.apache.catalina.startup.HostConfig.deployDirectory(HostConfig.java:1041)
at
org.apache.catalina.startup.HostConfig.deployDirectories(HostConfig.java:964
)
at
org.apache.catalina.startup.HostConfig.deployApps(HostConfig.java:502)
at
org.apache.catalina.startup.HostConfig.start(HostConfig.java:1277)
at org.apache.catalina.startup.HostConfig.lifecycleEvent(HostConfig.
java:321)
at
org.apache.catalina.util.LifecycleSupport.fireLifecycleEvent(LifecycleSuppor
t.java:119)
at
org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1053)
at
org.apache.catalina.core.StandardHost.start(StandardHost.java:722)
at
org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1045)
at
org.apache.catalina.core.StandardEngine.start(StandardEngine.java:443)
at
org.apache.catalina.core.StandardService.start(StandardService.java:516)
at
org.apache.catalina.core.StandardServer.start(StandardServer.java:710)
at org.apache.catalina.startup.Catalina.start(Catalina.java:593)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57
)
at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl
.java:43)
at java.lang.reflect.Method.invoke(Method.java:616)
at org.apache.catalina.startup.Bootstrap.start(Bootstrap.java:289)
at org.apache.catalina.startup.Bootstrap.main(Bootstrap.java:414)
――――――――――――――――――――――――――――――――――――――
――――――――――――――
MYSQL 日志情况
140113 14:27:04 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
InnoDB: The first specified data file ./ibdata1 did not exist:
InnoDB: a new database to be created!
140113 14:27:04 InnoDB: Setting file ./ibdata1 size to 10 MB
InnoDB: Database physically writes the file full: wait...
140113 14:27:04 InnoDB: Log file ./ib_logfile0 did not exist: new to be
created
InnoDB: Setting log file ./ib_logfile0 size to 5 MB
InnoDB: Database physically writes the file full: wait...
140113 14:27:04 InnoDB: Log file ./ib_logfile1 did not exist: new to be
created
InnoDB: Setting log file ./ib_logfile1 size to 5 MB
InnoDB: Database physically writes the file full: wait...
InnoDB: Doublewrite buffer not found: creating new
InnoDB: Doublewrite buffer created
InnoDB: Creating foreign key constraint system tables
InnoDB: Foreign key constraint system tables created
140113 14:27:05 InnoDB: Started; log sequence number 0 0
140113 14:27:05 [Note] Event Scheduler: Loaded 0 events
140113 14:27:05 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52' socket: '/var/lib/mysql/mysql.sock' port: 3306 Source
distribution
140113 14:31:34 [Note] /usr/libexec/mysqld: Normal shutdown
140113 14:31:34 [Note] Event Scheduler: Purging the queue. 0 events
140113 14:31:36 InnoDB: Starting shutdown...
140113 14:31:40 InnoDB: Shutdown completed; log sequence number 0 44233
140113 14:31:40 [Note] /usr/libexec/mysqld: Shutdown complete
140113 14:31:40 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140113 14:31:40 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140113 14:31:40 InnoDB: Started; log sequence number 0 44233
140113 14:31:41 [Note] Event Scheduler: Loaded 0 events
140113 14:31:41 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140113 15:00:00 [Note] /usr/libexec/mysqld: Normal shutdown
140113 15:00:00 [Note] Event Scheduler: Purging the queue. 0 events
140113 15:00:02 InnoDB: Starting shutdown...
140113 15:00:03 InnoDB: Shutdown completed; log sequence number 0 272572978
140113 15:00:03 [Note] /usr/libexec/mysqld: Shutdown complete
140113 15:00:03 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140113 15:00:03 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140113 15:00:03 InnoDB: Started; log sequence number 0 272572978
140113 15:00:04 [Note] Event Scheduler: Loaded 0 events
140113 15:00:04 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140113 16:07:27 [Note] /usr/libexec/mysqld: Normal shutdown
140113 16:07:27 [Note] Event Scheduler: Purging the queue. 0 events
140113 16:07:29 InnoDB: Starting shutdown...
140113 16:07:33 InnoDB: Shutdown completed; log sequence number 0 276001744
140113 16:07:33 [Note] /usr/libexec/mysqld: Shutdown complete
140113 16:07:33 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140113 16:15:10 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140113 16:15:10 InnoDB: Started; log sequence number 0 276001744
140113 16:15:10 [Note] Event Scheduler: Loaded 0 events
140113 16:15:10 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140113 16:40:49 [Note] /usr/libexec/mysqld: Normal shutdown
140113 16:40:49 [Note] Event Scheduler: Purging the queue. 0 events
140113 16:40:51 InnoDB: Starting shutdown...
140113 16:40:53 InnoDB: Shutdown completed; log sequence number 0
1611724675
140113 16:40:53 [Note] /usr/libexec/mysqld: Shutdown complete
140113 16:40:53 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140113 16:43:53 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140113 16:43:54 InnoDB: Started; log sequence number 0 1611724675
140113 16:43:54 [Note] Event Scheduler: Loaded 0 events
140113 16:43:54 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140113 16:46:41 [Note] /usr/libexec/mysqld: Normal shutdown
140113 16:46:41 [Note] Event Scheduler: Purging the queue. 0 events
140113 16:46:43 InnoDB: Starting shutdown...
140113 16:46:46 InnoDB: Shutdown completed; log sequence number 0
1611727339
140113 16:46:46 [Note] /usr/libexec/mysqld: Shutdown complete
140113 16:46:46 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140113 16:46:46 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140113 16:46:47 InnoDB: Started; log sequence number 0 1611727339
140113 16:46:47 [Note] Event Scheduler: Loaded 0 events
140113 16:46:47 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140120 15:03:43 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
InnoDB: Log scan progressed past the checkpoint lsn 0 2652244913
140120 15:03:43 InnoDB: Database was not shut down normally!
InnoDB: Starting crash recovery.
InnoDB: Reading tablespace information from the .ibd files...
InnoDB: Restoring possible half-written data pages from the doublewrite
InnoDB: buffer...
InnoDB: Doing recovery: scanned up to log sequence number 0 2652246897
140120 15:03:44 InnoDB: Starting an apply batch of log records to the
database...
InnoDB: Progress in percents: 0 1 2 3 4 5 6 7 8 9 10 11 12 13 14 15 16 17 18
19 20 21 22 23 24 25 26 27 28 29 30 31 32 33 34 35 36 37 38 39 40 41 42 43
44 45 46 47 48 49 50 51 52 53 54 55 56 57 58 59 60 61 62 63 64 65 66 67 68
69 70 71 72 73 74 75 76 77 78 79 80 81 82 83 84 85 86 87 88 89 90 91 92 93
94 95 96 97 98 99
InnoDB: Apply batch completed
InnoDB: Last MySQL binlog file position 0 425635668, file name
./mysql-bin.000005
140120 15:03:45 InnoDB: Started; log sequence number 0 2652246897
140120 15:03:45 [Note] Recovering after a crash using mysql-bin
140120 15:03:47 [Note] Starting crash recovery...
140120 15:03:47 [Note] Crash recovery finished.
140120 15:03:47 [Note] Event Scheduler: Loaded 0 events
140120 15:03:47 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140227 18:23:19 [Note] /usr/libexec/mysqld: Normal shutdown
140227 18:23:19 [Note] Event Scheduler: Purging the queue. 0 events
140227 18:23:19 InnoDB: Starting shutdown...
140227 18:23:21 InnoDB: Shutdown completed; log sequence number 1 247642825
140227 18:23:21 [Note] /usr/libexec/mysqld: Shutdown complete
140227 18:23:21 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140227 18:26:28 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140227 18:26:28 InnoDB: Started; log sequence number 1 247642825
140227 18:26:29 [Note] Event Scheduler: Loaded 0 events
140227 18:26:29 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140227 19:51:32 [Note] /usr/libexec/mysqld: Normal shutdown
140227 19:51:32 [Note] Event Scheduler: Purging the queue. 0 events
140227 19:51:34 InnoDB: Starting shutdown...
140227 19:51:35 InnoDB: Shutdown completed; log sequence number 1 531142952
140227 19:51:35 [Note] /usr/libexec/mysqld: Shutdown complete
140227 19:51:35 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140227 19:51:36 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140227 19:51:36 InnoDB: Started; log sequence number 1 531142952
140227 19:51:36 [Note] Event Scheduler: Loaded 0 events
140227 19:51:36 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140227 21:22:56 [Note] /usr/libexec/mysqld: Normal shutdown
140227 21:22:56 [Note] Event Scheduler: Purging the queue. 0 events
140227 21:22:56 InnoDB: Starting shutdown...
140227 21:22:58 InnoDB: Shutdown completed; log sequence number 1 818066929
140227 21:22:58 [Note] /usr/libexec/mysqld: Shutdown complete
140227 21:22:58 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140227 21:23:02 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140227 21:23:02 InnoDB: Started; log sequence number 1 818066929
140227 21:23:02 [Note] Event Scheduler: Loaded 0 events
140227 21:23:02 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140228 17:15:26 [Note] /usr/libexec/mysqld: Normal shutdown
140228 17:15:26 [Note] Event Scheduler: Purging the queue. 0 events
140228 17:15:28 InnoDB: Starting shutdown...
140228 17:15:31 InnoDB: Shutdown completed; log sequence number 1
1030287660
140228 17:15:31 [Note] /usr/libexec/mysqld: Shutdown complete
140228 17:15:31 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140228 17:15:31 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140228 17:15:32 InnoDB: Started; log sequence number 1 1030287660
140228 17:15:32 [Note] Event Scheduler: Loaded 0 events
140228 17:15:32 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140304 13:41:07 [Note] /usr/libexec/mysqld: Normal shutdown
140304 13:41:07 [Note] Event Scheduler: Purging the queue. 0 events
140304 13:41:10 InnoDB: Starting shutdown...
140304 13:41:14 InnoDB: Shutdown completed; log sequence number 1
2183881397
140304 13:41:14 [Note] /usr/libexec/mysqld: Shutdown complete
140304 13:41:14 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140304 13:44:55 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140304 13:44:55 InnoDB: Started; log sequence number 1 2183881397
140304 13:44:56 [Note] Event Scheduler: Loaded 0 events
140304 13:44:56 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140321 11:52:22 [Note] /usr/libexec/mysqld: Normal shutdown
140321 11:52:22 [Note] Event Scheduler: Purging the queue. 0 events
140321 11:52:22 InnoDB: Starting shutdown...
140321 11:52:25 InnoDB: Shutdown completed; log sequence number 1
4023808129
140321 11:52:25 [Note] /usr/libexec/mysqld: Shutdown complete
140321 11:52:25 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140321 11:52:25 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140321 11:52:26 InnoDB: Started; log sequence number 1 4023808129
140321 11:52:26 [Note] Event Scheduler: Loaded 0 events
140321 11:52:26 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140321 12:02:44 [Note] /usr/libexec/mysqld: Normal shutdown
140321 12:02:44 [Note] Event Scheduler: Purging the queue. 0 events
140321 12:02:44 InnoDB: Starting shutdown...
140321 12:02:47 InnoDB: Shutdown completed; log sequence number 1
4023808129
140321 12:02:47 [Note] /usr/libexec/mysqld: Shutdown complete
140321 12:02:47 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140321 12:06:06 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140321 12:06:07 InnoDB: Started; log sequence number 1 4023808129
140321 12:06:07 [Note] Event Scheduler: Loaded 0 events
140321 12:06:07 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140321 15:54:18 [Note] /usr/libexec/mysqld: Normal shutdown
140321 15:54:18 [Note] Event Scheduler: Purging the queue. 0 events
140321 15:54:20 InnoDB: Starting shutdown...
140321 15:54:22 InnoDB: Shutdown completed; log sequence number 1
4023808129
140321 15:54:22 [Note] /usr/libexec/mysqld: Shutdown complete
140321 15:54:22 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140321 15:54:26 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140321 15:54:26 InnoDB: Started; log sequence number 1 4023808129
140321 15:54:26 [Note] Event Scheduler: Loaded 0 events
140321 15:54:26 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140321 16:09:57 [Note] /usr/libexec/mysqld: Normal shutdown
140321 16:09:57 [Note] Event Scheduler: Purging the queue. 0 events
140321 16:09:59 InnoDB: Starting shutdown...
140321 16:10:02 InnoDB: Shutdown completed; log sequence number 1
4222382720
140321 16:10:02 [Note] /usr/libexec/mysqld: Shutdown complete
140321 16:10:02 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140321 16:10:02 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140321 16:10:03 InnoDB: Started; log sequence number 1 4222382720
140321 16:10:03 [Note] Event Scheduler: Loaded 0 events
140321 16:10:03 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140325 10:48:26 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
InnoDB: Log scan progressed past the checkpoint lsn 2 40199498
140325 10:48:26 InnoDB: Database was not shut down normally!
InnoDB: Starting crash recovery.
InnoDB: Reading tablespace information from the .ibd files...
InnoDB: Restoring possible half-written data pages from the doublewrite
InnoDB: buffer...
InnoDB: Doing recovery: scanned up to log sequence number 2 40202963
140325 10:48:26 InnoDB: Starting an apply batch of log records to the
database...
InnoDB: Progress in percents: 38 39 40 41 42 43 44 45 46 47 48 49 50 51 52
53 54 55 56 57 58 59 60 61 62 63 64 65 66 67 68 69 70 71 72 73 74 75 76 77
78 79 80 81 82 83 84 85 86 87 88 89 90 91 92 93 94 95 96 97 98 99
InnoDB: Apply batch completed
InnoDB: Last MySQL binlog file position 0 80960371, file name
./mysql-bin.000016
140325 10:48:27 InnoDB: Started; log sequence number 2 40202963
140325 10:48:27 [Note] Recovering after a crash using mysql-bin
140325 10:48:28 [Note] Starting crash recovery...
140325 10:48:28 [Note] Crash recovery finished.
140325 10:48:28 [Note] Event Scheduler: Loaded 0 events
140325 10:48:28 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140325 10:54:18 [Note] /usr/libexec/mysqld: Normal shutdown
140325 10:54:18 [Note] Event Scheduler: Purging the queue. 0 events
140325 10:54:18 InnoDB: Starting shutdown...
140325 10:54:23 InnoDB: Shutdown completed; log sequence number 2 40203100
140325 10:54:23 [Note] /usr/libexec/mysqld: Shutdown complete
140325 10:54:23 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140325 10:54:23 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140325 10:54:23 InnoDB: Started; log sequence number 2 40203100
140325 10:54:24 [Note] Event Scheduler: Loaded 0 events
140325 10:54:24 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140325 10:55:45 [Note] /usr/libexec/mysqld: Normal shutdown
140325 10:55:45 [Note] Event Scheduler: Purging the queue. 0 events
140325 10:55:45 InnoDB: Starting shutdown...
140325 10:55:49 InnoDB: Shutdown completed; log sequence number 2 40203100
140325 10:55:49 [Note] /usr/libexec/mysqld: Shutdown complete
140325 10:55:49 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140325 10:55:50 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140325 10:55:50 InnoDB: Started; log sequence number 2 40203100
140325 10:55:50 [Note] Event Scheduler: Loaded 0 events
140325 10:55:50 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140325 10:58:09 [Note] /usr/libexec/mysqld: Normal shutdown
140325 10:58:09 [Note] Event Scheduler: Purging the queue. 0 events
140325 10:58:09 InnoDB: Starting shutdown...
140325 10:58:10 InnoDB: Shutdown completed; log sequence number 2 40203100
140325 10:58:10 [Note] /usr/libexec/mysqld: Shutdown complete
140325 10:58:10 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140325 10:58:11 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140325 10:58:12 InnoDB: Started; log sequence number 2 40203100
140325 10:58:12 [Note] Event Scheduler: Loaded 0 events
140325 10:58:12 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140325 11:10:15 [Note] /usr/libexec/mysqld: Normal shutdown
140325 11:10:15 [Note] Event Scheduler: Purging the queue. 0 events
140325 11:10:15 InnoDB: Starting shutdown...
140325 11:10:21 InnoDB: Shutdown completed; log sequence number 2 349169511
140325 11:10:21 [Note] /usr/libexec/mysqld: Shutdown complete
140325 11:10:21 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140325 11:10:22 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140325 11:10:22 InnoDB: Started; log sequence number 2 349169511
140325 11:10:22 [Note] Event Scheduler: Loaded 0 events
140325 11:10:22 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140325 11:13:10 [Note] /usr/libexec/mysqld: Normal shutdown
140325 11:13:10 [Note] Event Scheduler: Purging the queue. 0 events
140325 11:13:10 InnoDB: Starting shutdown...
140325 11:13:12 InnoDB: Shutdown completed; log sequence number 2 349169511
140325 11:13:12 [Note] /usr/libexec/mysqld: Shutdown complete
140325 11:13:12 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140325 11:13:12 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140325 11:13:13 InnoDB: Started; log sequence number 2 349169511
140325 11:13:13 [Note] Event Scheduler: Loaded 0 events
140325 11:13:13 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
140325 19:57:40 [Note] /usr/libexec/mysqld: Normal shutdown
140325 19:57:40 [Note] Event Scheduler: Purging the queue. 0 events
140325 19:57:40 InnoDB: Starting shutdown...
140325 19:57:43 InnoDB: Shutdown completed; log sequence number 2 349169511
140325 19:57:43 [Note] /usr/libexec/mysqld: Shutdown complete
140325 19:57:43 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140325 19:57:43 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140325 19:57:44 InnoDB: Started; log sequence number 2 349169511
140325 19:57:44 [Note] Event Scheduler: Loaded 0 events
140325 19:57:44 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
Source distribution
^C
Re: cloudstack平台无法打开
Posted by "linuxbqj@gmail.com" <li...@gmail.com>.
.jdbc.exceptions.jdbc4.MySQLNonTransientConnectionException: Could
not create connection to database server. Attempted reconnect 3 times.
检查下mysql数据库是不是可以正常启动，使用数据库的帐号登陆进去看看，是不是可以登陆
估计是数据库出现了故障
2014-03-26 11:42 GMT+08:00 许叁征 <xu...@chinanetcenter.com>:
> HI ALL
> 昨天虚拟机平台机器宕机后，重启发现平台无法打开，cloudstack 4.0.1 以及
> mysql日志报错如下：
> 请教 这个要如何处理，谢谢！
>
>
>
> [root@manager ~]# tailf /usr/share/cloud/management/logs/management-server.
> log
> at
> org.apache.catalina.core.StandardEngine.start(StandardEngine.java:443)
> at
> org.apache.catalina.core.StandardService.start(StandardService.java:516)
> at
> org.apache.catalina.core.StandardServer.start(StandardServer.java:710)
> at org.apache.catalina.startup.Catalina.start(Catalina.java:593)
> at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
> at
> sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57
> )
> at
> sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl
> .java:43)
> at java.lang.reflect.Method.invoke(Method.java:616)
> at org.apache.catalina.startup.Bootstrap.start(Bootstrap.java:289)
> at org.apache.catalina.startup.Bootstrap.main(Bootstrap.java:414)
> 2014-03-26 10:56:26,367 INFO [utils.component.ComponentLocator] (main:null)
> Config file found at /etc/cloud/management/components.xml. Configuring
> system-integrity-checker
> 2014-03-26 10:56:26,372 DEBUG [utils.component.ComponentLocator] (main:null)
> Looking for class com.cloud.cluster.ManagementServerNode
> 2014-03-26 10:56:26,391 INFO [utils.component.ComponentLocator] (main:null)
> Found component: com.cloud.utils.component.SystemIntegrityChecker in
> com.cloud.cluster.ManagementServerNode - ManagementServerNode
> 2014-03-26 10:56:26,391 INFO [utils.component.ComponentLocator] (main:null)
> Adding system integrity checker: ManagementServerNode
> 2014-03-26 10:56:26,391 DEBUG [utils.component.ComponentLocator] (main:null)
> Looking for class com.cloud.utils.crypt.EncryptionSecretKeyChecker
> 2014-03-26 10:56:26,400 INFO [utils.component.ComponentLocator] (main:null)
> Found component: com.cloud.utils.component.SystemIntegrityChecker in
> com.cloud.utils.crypt.EncryptionSecretKeyChecker -
> EncryptionSecretKeyChecker
> 2014-03-26 10:56:26,400 INFO [utils.component.ComponentLocator] (main:null)
> Adding system integrity checker: EncryptionSecretKeyChecker
> 2014-03-26 10:56:26,400 DEBUG [utils.component.ComponentLocator] (main:null)
> Looking for class com.cloud.upgrade.DatabaseIntegrityChecker
> 2014-03-26 10:56:26,401 INFO [utils.component.ComponentLocator] (main:null)
> Found component: com.cloud.utils.component.SystemIntegrityChecker in
> com.cloud.upgrade.DatabaseIntegrityChecker - DatabaseIntegrityChecker
> 2014-03-26 10:56:26,402 INFO [utils.component.ComponentLocator] (main:null)
> Adding system integrity checker: DatabaseIntegrityChecker
> 2014-03-26 10:56:26,402 DEBUG [utils.component.ComponentLocator] (main:null)
> Looking for class com.cloud.upgrade.PremiumDatabaseUpgradeChecker
> 2014-03-26 10:56:26,403 INFO [utils.component.ComponentLocator] (main:null)
> Found component: com.cloud.utils.component.SystemIntegrityChecker in
> com.cloud.upgrade.PremiumDatabaseUpgradeChecker - DatabaseUpgradeChecker
> 2014-03-26 10:56:26,403 INFO [utils.component.ComponentLocator] (main:null)
> Adding system integrity checker: DatabaseUpgradeChecker
> 2014-03-26 10:56:26,474 DEBUG [utils.crypt.EncryptionSecretKeyChecker]
> (main:null) Encryption Type: file
> 2014-03-26 10:56:26,557 INFO [cloud.upgrade.DatabaseIntegrityChecker]
> (main:null) Grabbing lock to check for database integrity.
> 2014-03-26 10:56:30,774 ERROR [db.Transaction.Transaction] (main:null)
> Unexpected exception:
> com.mysql.jdbc.exceptions.jdbc4.MySQLNonTransientConnectionException: Could
> not create connection to database server. Attempted reconnect 3 times.
> Giving up.
> at sun.reflect.NativeConstructorAccessorImpl.newInstance0(Native
> Method)
> at
> sun.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAcces
> sorImpl.java:57)
> at
> sun.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstruc
> torAccessorImpl.java:45)
> at java.lang.reflect.Constructor.newInstance(Constructor.java:532)
> at com.mysql.jdbc.Util.handleNewInstance(Util.java:411)
> at com.mysql.jdbc.Util.getInstance(Util.java:386)
> at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:1013)
> at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:987)
> at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:982)
> at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:927)
> at
> com.mysql.jdbc.ConnectionImpl.connectWithRetries(ConnectionImpl.java:2238)
> at
> com.mysql.jdbc.ConnectionImpl.createNewIO(ConnectionImpl.java:2159)
> at com.mysql.jdbc.ConnectionImpl.<init>(ConnectionImpl.java:792)
> at com.mysql.jdbc.JDBC4Connection.<init>(JDBC4Connection.java:49)
> at sun.reflect.NativeConstructorAccessorImpl.newInstance0(Native
> Method)
> at
> sun.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAcces
> sorImpl.java:57)
> at
> sun.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstruc
> torAccessorImpl.java:45)
> at java.lang.reflect.Constructor.newInstance(Constructor.java:532)
> at com.mysql.jdbc.Util.handleNewInstance(Util.java:411)
> at
> com.mysql.jdbc.ConnectionImpl.getInstance(ConnectionImpl.java:381)
> at com.mysql.jdbc.NonRegisteringDriver.connect(NonRegisteringDriver.
> java:305)
> at java.sql.DriverManager.getConnection(DriverManager.java:620)
> at java.sql.DriverManager.getConnection(DriverManager.java:200)
> at
> org.apache.commons.dbcp.DriverManagerConnectionFactory.createConnection(Driv
> erManagerConnectionFactory.java:48)
> at
> org.apache.commons.dbcp.PoolableConnectionFactory.makeObject(PoolableConnect
> ionFactory.java:290)
> at
> org.apache.commons.pool.impl.GenericObjectPool.borrowObject(GenericObjectPoo
> l.java:840)
> at
> org.apache.commons.dbcp.PoolingDataSource.getConnection(PoolingDataSource.ja
> va:95)
> at
> com.cloud.utils.db.Transaction.getStandaloneConnectionWithException(Transact
> ion.java:200)
> at
> com.cloud.utils.db.Transaction.getStandaloneConnection(Transaction.java:209)
> at
> com.cloud.utils.db.DbUtil.getConnectionForGlobalLocks(DbUtil.java:58)
> at com.cloud.utils.db.DbUtil.getGlobalLock(DbUtil.java:203)
> at com.cloud.utils.db.GlobalLock.lock(GlobalLock.java:151)
> at
> com.cloud.upgrade.DatabaseIntegrityChecker.check(DatabaseIntegrityChecker.ja
> va:228)
> at
> com.cloud.utils.component.ComponentLocator.runCheckers(ComponentLocator.java
> :273)
> at
> com.cloud.utils.component.ComponentLocator.parse(ComponentLocator.java:245)
> at
> com.cloud.utils.component.ComponentLocator.getLocatorInternal(ComponentLocat
> or.java:836)
> at
> com.cloud.utils.component.ComponentLocator.getLocator(ComponentLocator.java:
> 874)
> at
> com.cloud.utils.component.ComponentLocator.getComponent(ComponentLocator.jav
> a:416)
> at
> com.cloud.utils.component.ComponentLocator.getComponent(ComponentLocator.jav
> a:409)
> at
> com.cloud.servlet.CloudStartupServlet.init(CloudStartupServlet.java:44)
> at javax.servlet.GenericServlet.init(GenericServlet.java:212)
> at
> org.apache.catalina.core.StandardWrapper.loadServlet(StandardWrapper.java:11
> 73)
> at
> org.apache.catalina.core.StandardWrapper.load(StandardWrapper.java:993)
> at
> org.apache.catalina.core.StandardContext.loadOnStartup(StandardContext.java:
> 4187)
> at
> org.apache.catalina.core.StandardContext.start(StandardContext.java:4496)
> at
> org.apache.catalina.core.ContainerBase.addChildInternal(ContainerBase.java:7
> 91)
> at
> org.apache.catalina.core.ContainerBase.addChild(ContainerBase.java:771)
> at
> org.apache.catalina.core.StandardHost.addChild(StandardHost.java:526)
> at
> org.apache.catalina.startup.HostConfig.deployDirectory(HostConfig.java:1041)
> at
> org.apache.catalina.startup.HostConfig.deployDirectories(HostConfig.java:964
> )
> at
> org.apache.catalina.startup.HostConfig.deployApps(HostConfig.java:502)
> at
> org.apache.catalina.startup.HostConfig.start(HostConfig.java:1277)
> at org.apache.catalina.startup.HostConfig.lifecycleEvent(HostConfig.
> java:321)
> at
> org.apache.catalina.util.LifecycleSupport.fireLifecycleEvent(LifecycleSuppor
> t.java:119)
> at
> org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1053)
> at
> org.apache.catalina.core.StandardHost.start(StandardHost.java:722)
> at
> org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1045)
> at
> org.apache.catalina.core.StandardEngine.start(StandardEngine.java:443)
> at
> org.apache.catalina.core.StandardService.start(StandardService.java:516)
> at
> org.apache.catalina.core.StandardServer.start(StandardServer.java:710)
> at org.apache.catalina.startup.Catalina.start(Catalina.java:593)
> at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
> at
> sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57
> )
> at
> sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl
> .java:43)
> at java.lang.reflect.Method.invoke(Method.java:616)
> at org.apache.catalina.startup.Bootstrap.start(Bootstrap.java:289)
> at org.apache.catalina.startup.Bootstrap.main(Bootstrap.java:414)
> Caused by: java.sql.SQLException: Access denied for user 'cloud'@'localhost'
> (using password: YES)
> ... 66 more
> 2014-03-26 10:56:30,778 ERROR [utils.db.DbUtil] (main:null) Unable to
> acquire DB connection for global lock system
> 2014-03-26 10:56:30,778 ERROR [utils.db.DbUtil] (main:null) Unable to
> acquire DB connection for global lock system
> 2014-03-26 10:56:30,779 ERROR [utils.component.ComponentLocator] (main:null)
> Problems with running checker:DatabaseIntegrityChecker
> com.cloud.utils.exception.CloudRuntimeException: Unable to acquire lock to
> check for database integrity.
> at
> com.cloud.upgrade.DatabaseIntegrityChecker.check(DatabaseIntegrityChecker.ja
> va:229)
> at
> com.cloud.utils.component.ComponentLocator.runCheckers(ComponentLocator.java
> :273)
> at
> com.cloud.utils.component.ComponentLocator.parse(ComponentLocator.java:245)
> at
> com.cloud.utils.component.ComponentLocator.getLocatorInternal(ComponentLocat
> or.java:836)
> at
> com.cloud.utils.component.ComponentLocator.getLocator(ComponentLocator.java:
> 874)
> at
> com.cloud.utils.component.ComponentLocator.getComponent(ComponentLocator.jav
> a:416)
> at
> com.cloud.utils.component.ComponentLocator.getComponent(ComponentLocator.jav
> a:409)
> at
> com.cloud.servlet.CloudStartupServlet.init(CloudStartupServlet.java:44)
> at javax.servlet.GenericServlet.init(GenericServlet.java:212)
> at
> org.apache.catalina.core.StandardWrapper.loadServlet(StandardWrapper.java:11
> 73)
> at
> org.apache.catalina.core.StandardWrapper.load(StandardWrapper.java:993)
> at
> org.apache.catalina.core.StandardContext.loadOnStartup(StandardContext.java:
> 4187)
> at
> org.apache.catalina.core.StandardContext.start(StandardContext.java:4496)
> at
> org.apache.catalina.core.ContainerBase.addChildInternal(ContainerBase.java:7
> 91)
> at
> org.apache.catalina.core.ContainerBase.addChild(ContainerBase.java:771)
> at
> org.apache.catalina.core.StandardHost.addChild(StandardHost.java:526)
> at
> org.apache.catalina.startup.HostConfig.deployDirectory(HostConfig.java:1041)
> at
> org.apache.catalina.startup.HostConfig.deployDirectories(HostConfig.java:964
> )
> at
> org.apache.catalina.startup.HostConfig.deployApps(HostConfig.java:502)
> at
> org.apache.catalina.startup.HostConfig.start(HostConfig.java:1277)
> at org.apache.catalina.startup.HostConfig.lifecycleEvent(HostConfig.
> java:321)
> at
> org.apache.catalina.util.LifecycleSupport.fireLifecycleEvent(LifecycleSuppor
> t.java:119)
> at
> org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1053)
> at
> org.apache.catalina.core.StandardHost.start(StandardHost.java:722)
> at
> org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1045)
> at
> org.apache.catalina.core.StandardEngine.start(StandardEngine.java:443)
> at
> org.apache.catalina.core.StandardService.start(StandardService.java:516)
> at
> org.apache.catalina.core.StandardServer.start(StandardServer.java:710)
> at org.apache.catalina.startup.Catalina.start(Catalina.java:593)
> at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
> at
> sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57
> )
> at
> sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl
> .java:43)
> at java.lang.reflect.Method.invoke(Method.java:616)
> at org.apache.catalina.startup.Bootstrap.start(Bootstrap.java:289)
> at org.apache.catalina.startup.Bootstrap.main(Bootstrap.java:414)
>
>
>
>
>
>
>
>
>
> ――――――――――――――――――――――――――――――――――――――
> ――――――――――――――
> MYSQL 日志情况
>
>
>
> 140113 14:27:04 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> InnoDB: The first specified data file ./ibdata1 did not exist:
> InnoDB: a new database to be created!
> 140113 14:27:04 InnoDB: Setting file ./ibdata1 size to 10 MB
> InnoDB: Database physically writes the file full: wait...
> 140113 14:27:04 InnoDB: Log file ./ib_logfile0 did not exist: new to be
> created
> InnoDB: Setting log file ./ib_logfile0 size to 5 MB
> InnoDB: Database physically writes the file full: wait...
> 140113 14:27:04 InnoDB: Log file ./ib_logfile1 did not exist: new to be
> created
> InnoDB: Setting log file ./ib_logfile1 size to 5 MB
> InnoDB: Database physically writes the file full: wait...
> InnoDB: Doublewrite buffer not found: creating new
> InnoDB: Doublewrite buffer created
> InnoDB: Creating foreign key constraint system tables
> InnoDB: Foreign key constraint system tables created
> 140113 14:27:05 InnoDB: Started; log sequence number 0 0
> 140113 14:27:05 [Note] Event Scheduler: Loaded 0 events
> 140113 14:27:05 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52' socket: '/var/lib/mysql/mysql.sock' port: 3306 Source
> distribution
> 140113 14:31:34 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140113 14:31:34 [Note] Event Scheduler: Purging the queue. 0 events
> 140113 14:31:36 InnoDB: Starting shutdown...
> 140113 14:31:40 InnoDB: Shutdown completed; log sequence number 0 44233
> 140113 14:31:40 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140113 14:31:40 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140113 14:31:40 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140113 14:31:40 InnoDB: Started; log sequence number 0 44233
> 140113 14:31:41 [Note] Event Scheduler: Loaded 0 events
> 140113 14:31:41 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140113 15:00:00 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140113 15:00:00 [Note] Event Scheduler: Purging the queue. 0 events
> 140113 15:00:02 InnoDB: Starting shutdown...
> 140113 15:00:03 InnoDB: Shutdown completed; log sequence number 0 272572978
> 140113 15:00:03 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140113 15:00:03 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140113 15:00:03 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140113 15:00:03 InnoDB: Started; log sequence number 0 272572978
> 140113 15:00:04 [Note] Event Scheduler: Loaded 0 events
> 140113 15:00:04 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140113 16:07:27 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140113 16:07:27 [Note] Event Scheduler: Purging the queue. 0 events
> 140113 16:07:29 InnoDB: Starting shutdown...
> 140113 16:07:33 InnoDB: Shutdown completed; log sequence number 0 276001744
> 140113 16:07:33 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140113 16:07:33 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140113 16:15:10 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140113 16:15:10 InnoDB: Started; log sequence number 0 276001744
> 140113 16:15:10 [Note] Event Scheduler: Loaded 0 events
> 140113 16:15:10 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140113 16:40:49 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140113 16:40:49 [Note] Event Scheduler: Purging the queue. 0 events
> 140113 16:40:51 InnoDB: Starting shutdown...
> 140113 16:40:53 InnoDB: Shutdown completed; log sequence number 0
> 1611724675
> 140113 16:40:53 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140113 16:40:53 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140113 16:43:53 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140113 16:43:54 InnoDB: Started; log sequence number 0 1611724675
> 140113 16:43:54 [Note] Event Scheduler: Loaded 0 events
> 140113 16:43:54 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140113 16:46:41 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140113 16:46:41 [Note] Event Scheduler: Purging the queue. 0 events
> 140113 16:46:43 InnoDB: Starting shutdown...
> 140113 16:46:46 InnoDB: Shutdown completed; log sequence number 0
> 1611727339
> 140113 16:46:46 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140113 16:46:46 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140113 16:46:46 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140113 16:46:47 InnoDB: Started; log sequence number 0 1611727339
> 140113 16:46:47 [Note] Event Scheduler: Loaded 0 events
> 140113 16:46:47 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140120 15:03:43 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> InnoDB: Log scan progressed past the checkpoint lsn 0 2652244913
> 140120 15:03:43 InnoDB: Database was not shut down normally!
> InnoDB: Starting crash recovery.
> InnoDB: Reading tablespace information from the .ibd files...
> InnoDB: Restoring possible half-written data pages from the doublewrite
> InnoDB: buffer...
> InnoDB: Doing recovery: scanned up to log sequence number 0 2652246897
> 140120 15:03:44 InnoDB: Starting an apply batch of log records to the
> database...
> InnoDB: Progress in percents: 0 1 2 3 4 5 6 7 8 9 10 11 12 13 14 15 16 17 18
> 19 20 21 22 23 24 25 26 27 28 29 30 31 32 33 34 35 36 37 38 39 40 41 42 43
> 44 45 46 47 48 49 50 51 52 53 54 55 56 57 58 59 60 61 62 63 64 65 66 67 68
> 69 70 71 72 73 74 75 76 77 78 79 80 81 82 83 84 85 86 87 88 89 90 91 92 93
> 94 95 96 97 98 99
> InnoDB: Apply batch completed
> InnoDB: Last MySQL binlog file position 0 425635668, file name
> ./mysql-bin.000005
> 140120 15:03:45 InnoDB: Started; log sequence number 0 2652246897
> 140120 15:03:45 [Note] Recovering after a crash using mysql-bin
> 140120 15:03:47 [Note] Starting crash recovery...
> 140120 15:03:47 [Note] Crash recovery finished.
> 140120 15:03:47 [Note] Event Scheduler: Loaded 0 events
> 140120 15:03:47 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140227 18:23:19 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140227 18:23:19 [Note] Event Scheduler: Purging the queue. 0 events
> 140227 18:23:19 InnoDB: Starting shutdown...
> 140227 18:23:21 InnoDB: Shutdown completed; log sequence number 1 247642825
> 140227 18:23:21 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140227 18:23:21 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140227 18:26:28 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140227 18:26:28 InnoDB: Started; log sequence number 1 247642825
> 140227 18:26:29 [Note] Event Scheduler: Loaded 0 events
> 140227 18:26:29 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140227 19:51:32 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140227 19:51:32 [Note] Event Scheduler: Purging the queue. 0 events
> 140227 19:51:34 InnoDB: Starting shutdown...
> 140227 19:51:35 InnoDB: Shutdown completed; log sequence number 1 531142952
> 140227 19:51:35 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140227 19:51:35 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140227 19:51:36 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140227 19:51:36 InnoDB: Started; log sequence number 1 531142952
> 140227 19:51:36 [Note] Event Scheduler: Loaded 0 events
> 140227 19:51:36 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140227 21:22:56 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140227 21:22:56 [Note] Event Scheduler: Purging the queue. 0 events
> 140227 21:22:56 InnoDB: Starting shutdown...
> 140227 21:22:58 InnoDB: Shutdown completed; log sequence number 1 818066929
> 140227 21:22:58 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140227 21:22:58 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140227 21:23:02 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140227 21:23:02 InnoDB: Started; log sequence number 1 818066929
> 140227 21:23:02 [Note] Event Scheduler: Loaded 0 events
> 140227 21:23:02 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140228 17:15:26 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140228 17:15:26 [Note] Event Scheduler: Purging the queue. 0 events
> 140228 17:15:28 InnoDB: Starting shutdown...
> 140228 17:15:31 InnoDB: Shutdown completed; log sequence number 1
> 1030287660
> 140228 17:15:31 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140228 17:15:31 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140228 17:15:31 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140228 17:15:32 InnoDB: Started; log sequence number 1 1030287660
> 140228 17:15:32 [Note] Event Scheduler: Loaded 0 events
> 140228 17:15:32 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140304 13:41:07 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140304 13:41:07 [Note] Event Scheduler: Purging the queue. 0 events
> 140304 13:41:10 InnoDB: Starting shutdown...
> 140304 13:41:14 InnoDB: Shutdown completed; log sequence number 1
> 2183881397
> 140304 13:41:14 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140304 13:41:14 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140304 13:44:55 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140304 13:44:55 InnoDB: Started; log sequence number 1 2183881397
> 140304 13:44:56 [Note] Event Scheduler: Loaded 0 events
> 140304 13:44:56 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140321 11:52:22 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140321 11:52:22 [Note] Event Scheduler: Purging the queue. 0 events
> 140321 11:52:22 InnoDB: Starting shutdown...
> 140321 11:52:25 InnoDB: Shutdown completed; log sequence number 1
> 4023808129
> 140321 11:52:25 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140321 11:52:25 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140321 11:52:25 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140321 11:52:26 InnoDB: Started; log sequence number 1 4023808129
> 140321 11:52:26 [Note] Event Scheduler: Loaded 0 events
> 140321 11:52:26 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140321 12:02:44 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140321 12:02:44 [Note] Event Scheduler: Purging the queue. 0 events
> 140321 12:02:44 InnoDB: Starting shutdown...
> 140321 12:02:47 InnoDB: Shutdown completed; log sequence number 1
> 4023808129
> 140321 12:02:47 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140321 12:02:47 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140321 12:06:06 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140321 12:06:07 InnoDB: Started; log sequence number 1 4023808129
> 140321 12:06:07 [Note] Event Scheduler: Loaded 0 events
> 140321 12:06:07 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140321 15:54:18 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140321 15:54:18 [Note] Event Scheduler: Purging the queue. 0 events
> 140321 15:54:20 InnoDB: Starting shutdown...
> 140321 15:54:22 InnoDB: Shutdown completed; log sequence number 1
> 4023808129
> 140321 15:54:22 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140321 15:54:22 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140321 15:54:26 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140321 15:54:26 InnoDB: Started; log sequence number 1 4023808129
> 140321 15:54:26 [Note] Event Scheduler: Loaded 0 events
> 140321 15:54:26 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140321 16:09:57 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140321 16:09:57 [Note] Event Scheduler: Purging the queue. 0 events
> 140321 16:09:59 InnoDB: Starting shutdown...
> 140321 16:10:02 InnoDB: Shutdown completed; log sequence number 1
> 4222382720
> 140321 16:10:02 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140321 16:10:02 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140321 16:10:02 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140321 16:10:03 InnoDB: Started; log sequence number 1 4222382720
> 140321 16:10:03 [Note] Event Scheduler: Loaded 0 events
> 140321 16:10:03 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140325 10:48:26 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> InnoDB: Log scan progressed past the checkpoint lsn 2 40199498
> 140325 10:48:26 InnoDB: Database was not shut down normally!
> InnoDB: Starting crash recovery.
> InnoDB: Reading tablespace information from the .ibd files...
> InnoDB: Restoring possible half-written data pages from the doublewrite
> InnoDB: buffer...
> InnoDB: Doing recovery: scanned up to log sequence number 2 40202963
> 140325 10:48:26 InnoDB: Starting an apply batch of log records to the
> database...
> InnoDB: Progress in percents: 38 39 40 41 42 43 44 45 46 47 48 49 50 51 52
> 53 54 55 56 57 58 59 60 61 62 63 64 65 66 67 68 69 70 71 72 73 74 75 76 77
> 78 79 80 81 82 83 84 85 86 87 88 89 90 91 92 93 94 95 96 97 98 99
> InnoDB: Apply batch completed
> InnoDB: Last MySQL binlog file position 0 80960371, file name
> ./mysql-bin.000016
> 140325 10:48:27 InnoDB: Started; log sequence number 2 40202963
> 140325 10:48:27 [Note] Recovering after a crash using mysql-bin
> 140325 10:48:28 [Note] Starting crash recovery...
> 140325 10:48:28 [Note] Crash recovery finished.
> 140325 10:48:28 [Note] Event Scheduler: Loaded 0 events
> 140325 10:48:28 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140325 10:54:18 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140325 10:54:18 [Note] Event Scheduler: Purging the queue. 0 events
> 140325 10:54:18 InnoDB: Starting shutdown...
> 140325 10:54:23 InnoDB: Shutdown completed; log sequence number 2 40203100
> 140325 10:54:23 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140325 10:54:23 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140325 10:54:23 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140325 10:54:23 InnoDB: Started; log sequence number 2 40203100
> 140325 10:54:24 [Note] Event Scheduler: Loaded 0 events
> 140325 10:54:24 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140325 10:55:45 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140325 10:55:45 [Note] Event Scheduler: Purging the queue. 0 events
> 140325 10:55:45 InnoDB: Starting shutdown...
> 140325 10:55:49 InnoDB: Shutdown completed; log sequence number 2 40203100
> 140325 10:55:49 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140325 10:55:49 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140325 10:55:50 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140325 10:55:50 InnoDB: Started; log sequence number 2 40203100
> 140325 10:55:50 [Note] Event Scheduler: Loaded 0 events
> 140325 10:55:50 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140325 10:58:09 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140325 10:58:09 [Note] Event Scheduler: Purging the queue. 0 events
> 140325 10:58:09 InnoDB: Starting shutdown...
> 140325 10:58:10 InnoDB: Shutdown completed; log sequence number 2 40203100
> 140325 10:58:10 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140325 10:58:10 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140325 10:58:11 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140325 10:58:12 InnoDB: Started; log sequence number 2 40203100
> 140325 10:58:12 [Note] Event Scheduler: Loaded 0 events
> 140325 10:58:12 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140325 11:10:15 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140325 11:10:15 [Note] Event Scheduler: Purging the queue. 0 events
> 140325 11:10:15 InnoDB: Starting shutdown...
> 140325 11:10:21 InnoDB: Shutdown completed; log sequence number 2 349169511
> 140325 11:10:21 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140325 11:10:21 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140325 11:10:22 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140325 11:10:22 InnoDB: Started; log sequence number 2 349169511
> 140325 11:10:22 [Note] Event Scheduler: Loaded 0 events
> 140325 11:10:22 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140325 11:13:10 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140325 11:13:10 [Note] Event Scheduler: Purging the queue. 0 events
> 140325 11:13:10 InnoDB: Starting shutdown...
> 140325 11:13:12 InnoDB: Shutdown completed; log sequence number 2 349169511
> 140325 11:13:12 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140325 11:13:12 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140325 11:13:12 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140325 11:13:13 InnoDB: Started; log sequence number 2 349169511
> 140325 11:13:13 [Note] Event Scheduler: Loaded 0 events
> 140325 11:13:13 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> 140325 19:57:40 [Note] /usr/libexec/mysqld: Normal shutdown
>
> 140325 19:57:40 [Note] Event Scheduler: Purging the queue. 0 events
> 140325 19:57:40 InnoDB: Starting shutdown...
> 140325 19:57:43 InnoDB: Shutdown completed; log sequence number 2 349169511
> 140325 19:57:43 [Note] /usr/libexec/mysqld: Shutdown complete
>
> 140325 19:57:43 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
> ended
> 140325 19:57:43 mysqld_safe Starting mysqld daemon with databases from
> /var/lib/mysql
> 140325 19:57:44 InnoDB: Started; log sequence number 2 349169511
> 140325 19:57:44 [Note] Event Scheduler: Loaded 0 events
> 140325 19:57:44 [Note] /usr/libexec/mysqld: ready for connections.
> Version: '5.1.52-log' socket: '/var/lib/mysql/mysql.sock' port: 3306
> Source distribution
> ^C
>
>
--
白清杰 (Born Bai)
北京开源愿景信息技术有限公司
Mail: linuxbqj@gmail.com
回复: cloudstack平台无法打开
Posted by "brito.wang@gmail.com" <br...@gmail.com>.
我的建议是：
检查mysqld服务运行状态service mysqld status如果是stop，尝试启动如果启动失败删除一个文件rm -f ?/var/lib/mysql/mysql.sock再启动mysqld 再启动cloud-management
brito.wang@gmail.com
?发件人：?许叁征发送时间：?2014-03-26?11:42收件人：?users-cn@cloudstack.apache.org主题：?cloudstack平台无法打开HI ALL
?? 昨天虚拟机平台机器宕机后，重启发现平台无法打开，cloudstack 4.0.1 以及
mysql日志报错如下：
? 请教 这个要如何处理，谢谢！
?
?
?
[root@manager ~]#? tailf /usr/share/cloud/management/logs/management-server.
log
at
org.apache.catalina.core.StandardEngine.start(StandardEngine.java:443)
at
org.apache.catalina.core.StandardService.start(StandardService.java:516)
at
org.apache.catalina.core.StandardServer.start(StandardServer.java:710)
at org.apache.catalina.startup.Catalina.start(Catalina.java:593)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57
)
at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl
.java:43)
at java.lang.reflect.Method.invoke(Method.java:616)
at org.apache.catalina.startup.Bootstrap.start(Bootstrap.java:289)
at org.apache.catalina.startup.Bootstrap.main(Bootstrap.java:414)
2014-03-26 10:56:26,367 INFO? [utils.component.ComponentLocator] (main:null)
Config file found at /etc/cloud/management/components.xml.? Configuring
system-integrity-checker
2014-03-26 10:56:26,372 DEBUG [utils.component.ComponentLocator] (main:null)
Looking for class com.cloud.cluster.ManagementServerNode
2014-03-26 10:56:26,391 INFO? [utils.component.ComponentLocator] (main:null)
Found component: com.cloud.utils.component.SystemIntegrityChecker in
com.cloud.cluster.ManagementServerNode - ManagementServerNode
2014-03-26 10:56:26,391 INFO? [utils.component.ComponentLocator] (main:null)
Adding system integrity checker: ManagementServerNode
2014-03-26 10:56:26,391 DEBUG [utils.component.ComponentLocator] (main:null)
Looking for class com.cloud.utils.crypt.EncryptionSecretKeyChecker
2014-03-26 10:56:26,400 INFO? [utils.component.ComponentLocator] (main:null)
Found component: com.cloud.utils.component.SystemIntegrityChecker in
com.cloud.utils.crypt.EncryptionSecretKeyChecker -
EncryptionSecretKeyChecker
2014-03-26 10:56:26,400 INFO? [utils.component.ComponentLocator] (main:null)
Adding system integrity checker: EncryptionSecretKeyChecker
2014-03-26 10:56:26,400 DEBUG [utils.component.ComponentLocator] (main:null)
Looking for class com.cloud.upgrade.DatabaseIntegrityChecker
2014-03-26 10:56:26,401 INFO? [utils.component.ComponentLocator] (main:null)
Found component: com.cloud.utils.component.SystemIntegrityChecker in
com.cloud.upgrade.DatabaseIntegrityChecker - DatabaseIntegrityChecker
2014-03-26 10:56:26,402 INFO? [utils.component.ComponentLocator] (main:null)
Adding system integrity checker: DatabaseIntegrityChecker
2014-03-26 10:56:26,402 DEBUG [utils.component.ComponentLocator] (main:null)
Looking for class com.cloud.upgrade.PremiumDatabaseUpgradeChecker
2014-03-26 10:56:26,403 INFO? [utils.component.ComponentLocator] (main:null)
Found component: com.cloud.utils.component.SystemIntegrityChecker in
com.cloud.upgrade.PremiumDatabaseUpgradeChecker - DatabaseUpgradeChecker
2014-03-26 10:56:26,403 INFO? [utils.component.ComponentLocator] (main:null)
Adding system integrity checker: DatabaseUpgradeChecker
2014-03-26 10:56:26,474 DEBUG [utils.crypt.EncryptionSecretKeyChecker]
(main:null) Encryption Type: file
2014-03-26 10:56:26,557 INFO? [cloud.upgrade.DatabaseIntegrityChecker]
(main:null) Grabbing lock to check for database integrity.
2014-03-26 10:56:30,774 ERROR [db.Transaction.Transaction] (main:null)
Unexpected exception:
com.mysql.jdbc.exceptions.jdbc4.MySQLNonTransientConnectionException: Could
not create connection to database server. Attempted reconnect 3 times.
Giving up.
at sun.reflect.NativeConstructorAccessorImpl.newInstance0(Native
Method)
at
sun.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAcces
sorImpl.java:57)
at
sun.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstruc
torAccessorImpl.java:45)
at java.lang.reflect.Constructor.newInstance(Constructor.java:532)
at com.mysql.jdbc.Util.handleNewInstance(Util.java:411)
at com.mysql.jdbc.Util.getInstance(Util.java:386)
at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:1013)
at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:987)
at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:982)
at com.mysql.jdbc.SQLError.createSQLException(SQLError.java:927)
at
com.mysql.jdbc.ConnectionImpl.connectWithRetries(ConnectionImpl.java:2238)
at
com.mysql.jdbc.ConnectionImpl.createNewIO(ConnectionImpl.java:2159)
at com.mysql.jdbc.ConnectionImpl.<init>(ConnectionImpl.java:792)
at com.mysql.jdbc.JDBC4Connection.<init>(JDBC4Connection.java:49)
at sun.reflect.NativeConstructorAccessorImpl.newInstance0(Native
Method)
at
sun.reflect.NativeConstructorAccessorImpl.newInstance(NativeConstructorAcces
sorImpl.java:57)
at
sun.reflect.DelegatingConstructorAccessorImpl.newInstance(DelegatingConstruc
torAccessorImpl.java:45)
at java.lang.reflect.Constructor.newInstance(Constructor.java:532)
at com.mysql.jdbc.Util.handleNewInstance(Util.java:411)
at
com.mysql.jdbc.ConnectionImpl.getInstance(ConnectionImpl.java:381)
at com.mysql.jdbc.NonRegisteringDriver.connect(NonRegisteringDriver.
java:305)
at java.sql.DriverManager.getConnection(DriverManager.java:620)
at java.sql.DriverManager.getConnection(DriverManager.java:200)
at
org.apache.commons.dbcp.DriverManagerConnectionFactory.createConnection(Driv
erManagerConnectionFactory.java:48)
at
org.apache.commons.dbcp.PoolableConnectionFactory.makeObject(PoolableConnect
ionFactory.java:290)
at
org.apache.commons.pool.impl.GenericObjectPool.borrowObject(GenericObjectPoo
l.java:840)
at
org.apache.commons.dbcp.PoolingDataSource.getConnection(PoolingDataSource.ja
va:95)
at
com.cloud.utils.db.Transaction.getStandaloneConnectionWithException(Transact
ion.java:200)
at
com.cloud.utils.db.Transaction.getStandaloneConnection(Transaction.java:209)
at
com.cloud.utils.db.DbUtil.getConnectionForGlobalLocks(DbUtil.java:58)
at com.cloud.utils.db.DbUtil.getGlobalLock(DbUtil.java:203)
at com.cloud.utils.db.GlobalLock.lock(GlobalLock.java:151)
at
com.cloud.upgrade.DatabaseIntegrityChecker.check(DatabaseIntegrityChecker.ja
va:228)
at
com.cloud.utils.component.ComponentLocator.runCheckers(ComponentLocator.java
:273)
at
com.cloud.utils.component.ComponentLocator.parse(ComponentLocator.java:245)
at
com.cloud.utils.component.ComponentLocator.getLocatorInternal(ComponentLocat
or.java:836)
at
com.cloud.utils.component.ComponentLocator.getLocator(ComponentLocator.java:
874)
at
com.cloud.utils.component.ComponentLocator.getComponent(ComponentLocator.jav
a:416)
at
com.cloud.utils.component.ComponentLocator.getComponent(ComponentLocator.jav
a:409)
at
com.cloud.servlet.CloudStartupServlet.init(CloudStartupServlet.java:44)
at javax.servlet.GenericServlet.init(GenericServlet.java:212)
at
org.apache.catalina.core.StandardWrapper.loadServlet(StandardWrapper.java:11
73)
at
org.apache.catalina.core.StandardWrapper.load(StandardWrapper.java:993)
at
org.apache.catalina.core.StandardContext.loadOnStartup(StandardContext.java:
4187)
at
org.apache.catalina.core.StandardContext.start(StandardContext.java:4496)
at
org.apache.catalina.core.ContainerBase.addChildInternal(ContainerBase.java:7
91)
at
org.apache.catalina.core.ContainerBase.addChild(ContainerBase.java:771)
at
org.apache.catalina.core.StandardHost.addChild(StandardHost.java:526)
at
org.apache.catalina.startup.HostConfig.deployDirectory(HostConfig.java:1041)
at
org.apache.catalina.startup.HostConfig.deployDirectories(HostConfig.java:964
)
at
org.apache.catalina.startup.HostConfig.deployApps(HostConfig.java:502)
at
org.apache.catalina.startup.HostConfig.start(HostConfig.java:1277)
at org.apache.catalina.startup.HostConfig.lifecycleEvent(HostConfig.
java:321)
at
org.apache.catalina.util.LifecycleSupport.fireLifecycleEvent(LifecycleSuppor
t.java:119)
at
org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1053)
at
org.apache.catalina.core.StandardHost.start(StandardHost.java:722)
at
org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1045)
at
org.apache.catalina.core.StandardEngine.start(StandardEngine.java:443)
at
org.apache.catalina.core.StandardService.start(StandardService.java:516)
at
org.apache.catalina.core.StandardServer.start(StandardServer.java:710)
at org.apache.catalina.startup.Catalina.start(Catalina.java:593)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57
)
at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl
.java:43)
at java.lang.reflect.Method.invoke(Method.java:616)
at org.apache.catalina.startup.Bootstrap.start(Bootstrap.java:289)
at org.apache.catalina.startup.Bootstrap.main(Bootstrap.java:414)
Caused by: java.sql.SQLException: Access denied for user 'cloud'@'localhost'
(using password: YES)
... 66 more
2014-03-26 10:56:30,778 ERROR [utils.db.DbUtil] (main:null) Unable to
acquire DB connection for global lock system
2014-03-26 10:56:30,778 ERROR [utils.db.DbUtil] (main:null) Unable to
acquire DB connection for global lock system
2014-03-26 10:56:30,779 ERROR [utils.component.ComponentLocator] (main:null)
Problems with running checker:DatabaseIntegrityChecker
com.cloud.utils.exception.CloudRuntimeException: Unable to acquire lock to
check for database integrity.
at
com.cloud.upgrade.DatabaseIntegrityChecker.check(DatabaseIntegrityChecker.ja
va:229)
at
com.cloud.utils.component.ComponentLocator.runCheckers(ComponentLocator.java
:273)
at
com.cloud.utils.component.ComponentLocator.parse(ComponentLocator.java:245)
at
com.cloud.utils.component.ComponentLocator.getLocatorInternal(ComponentLocat
or.java:836)
at
com.cloud.utils.component.ComponentLocator.getLocator(ComponentLocator.java:
874)
at
com.cloud.utils.component.ComponentLocator.getComponent(ComponentLocator.jav
a:416)
at
com.cloud.utils.component.ComponentLocator.getComponent(ComponentLocator.jav
a:409)
at
com.cloud.servlet.CloudStartupServlet.init(CloudStartupServlet.java:44)
at javax.servlet.GenericServlet.init(GenericServlet.java:212)
at
org.apache.catalina.core.StandardWrapper.loadServlet(StandardWrapper.java:11
73)
at
org.apache.catalina.core.StandardWrapper.load(StandardWrapper.java:993)
at
org.apache.catalina.core.StandardContext.loadOnStartup(StandardContext.java:
4187)
at
org.apache.catalina.core.StandardContext.start(StandardContext.java:4496)
at
org.apache.catalina.core.ContainerBase.addChildInternal(ContainerBase.java:7
91)
at
org.apache.catalina.core.ContainerBase.addChild(ContainerBase.java:771)
at
org.apache.catalina.core.StandardHost.addChild(StandardHost.java:526)
at
org.apache.catalina.startup.HostConfig.deployDirectory(HostConfig.java:1041)
at
org.apache.catalina.startup.HostConfig.deployDirectories(HostConfig.java:964
)
at
org.apache.catalina.startup.HostConfig.deployApps(HostConfig.java:502)
at
org.apache.catalina.startup.HostConfig.start(HostConfig.java:1277)
at org.apache.catalina.startup.HostConfig.lifecycleEvent(HostConfig.
java:321)
at
org.apache.catalina.util.LifecycleSupport.fireLifecycleEvent(LifecycleSuppor
t.java:119)
at
org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1053)
at
org.apache.catalina.core.StandardHost.start(StandardHost.java:722)
at
org.apache.catalina.core.ContainerBase.start(ContainerBase.java:1045)
at
org.apache.catalina.core.StandardEngine.start(StandardEngine.java:443)
at
org.apache.catalina.core.StandardService.start(StandardService.java:516)
at
org.apache.catalina.core.StandardServer.start(StandardServer.java:710)
at org.apache.catalina.startup.Catalina.start(Catalina.java:593)
at sun.reflect.NativeMethodAccessorImpl.invoke0(Native Method)
at
sun.reflect.NativeMethodAccessorImpl.invoke(NativeMethodAccessorImpl.java:57
)
at
sun.reflect.DelegatingMethodAccessorImpl.invoke(DelegatingMethodAccessorImpl
.java:43)
at java.lang.reflect.Method.invoke(Method.java:616)
at org.apache.catalina.startup.Bootstrap.start(Bootstrap.java:289)
at org.apache.catalina.startup.Bootstrap.main(Bootstrap.java:414)
?
?
?
?
?
?
?
?
?
――――――――――――――――――――――――――――――――――――――
――――――――――――――
MYSQL 日志情况
?
?
?
140113 14:27:04 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
InnoDB: The first specified data file ./ibdata1 did not exist:
InnoDB: a new database to be created!
140113 14:27:04? InnoDB: Setting file ./ibdata1 size to 10 MB
InnoDB: Database physically writes the file full: wait...
140113 14:27:04? InnoDB: Log file ./ib_logfile0 did not exist: new to be
created
InnoDB: Setting log file ./ib_logfile0 size to 5 MB
InnoDB: Database physically writes the file full: wait...
140113 14:27:04? InnoDB: Log file ./ib_logfile1 did not exist: new to be
created
InnoDB: Setting log file ./ib_logfile1 size to 5 MB
InnoDB: Database physically writes the file full: wait...
InnoDB: Doublewrite buffer not found: creating new
InnoDB: Doublewrite buffer created
InnoDB: Creating foreign key constraint system tables
InnoDB: Foreign key constraint system tables created
140113 14:27:05? InnoDB: Started; log sequence number 0 0
140113 14:27:05 [Note] Event Scheduler: Loaded 0 events
140113 14:27:05 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52'? socket: '/var/lib/mysql/mysql.sock'? port: 3306? Source
distribution
140113 14:31:34 [Note] /usr/libexec/mysqld: Normal shutdown
?
140113 14:31:34 [Note] Event Scheduler: Purging the queue. 0 events
140113 14:31:36? InnoDB: Starting shutdown...
140113 14:31:40? InnoDB: Shutdown completed; log sequence number 0 44233
140113 14:31:40 [Note] /usr/libexec/mysqld: Shutdown complete
?
140113 14:31:40 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140113 14:31:40 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140113 14:31:40? InnoDB: Started; log sequence number 0 44233
140113 14:31:41 [Note] Event Scheduler: Loaded 0 events
140113 14:31:41 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log'? socket: '/var/lib/mysql/mysql.sock'? port: 3306
Source distribution
140113 15:00:00 [Note] /usr/libexec/mysqld: Normal shutdown
?
140113 15:00:00 [Note] Event Scheduler: Purging the queue. 0 events
140113 15:00:02? InnoDB: Starting shutdown...
140113 15:00:03? InnoDB: Shutdown completed; log sequence number 0 272572978
140113 15:00:03 [Note] /usr/libexec/mysqld: Shutdown complete
?
140113 15:00:03 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140113 15:00:03 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140113 15:00:03? InnoDB: Started; log sequence number 0 272572978
140113 15:00:04 [Note] Event Scheduler: Loaded 0 events
140113 15:00:04 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log'? socket: '/var/lib/mysql/mysql.sock'? port: 3306
Source distribution
140113 16:07:27 [Note] /usr/libexec/mysqld: Normal shutdown
?
140113 16:07:27 [Note] Event Scheduler: Purging the queue. 0 events
140113 16:07:29? InnoDB: Starting shutdown...
140113 16:07:33? InnoDB: Shutdown completed; log sequence number 0 276001744
140113 16:07:33 [Note] /usr/libexec/mysqld: Shutdown complete
?
140113 16:07:33 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140113 16:15:10 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140113 16:15:10? InnoDB: Started; log sequence number 0 276001744
140113 16:15:10 [Note] Event Scheduler: Loaded 0 events
140113 16:15:10 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log'? socket: '/var/lib/mysql/mysql.sock'? port: 3306
Source distribution
140113 16:40:49 [Note] /usr/libexec/mysqld: Normal shutdown
?
140113 16:40:49 [Note] Event Scheduler: Purging the queue. 0 events
140113 16:40:51? InnoDB: Starting shutdown...
140113 16:40:53? InnoDB: Shutdown completed; log sequence number 0
1611724675
140113 16:40:53 [Note] /usr/libexec/mysqld: Shutdown complete
?
140113 16:40:53 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140113 16:43:53 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140113 16:43:54? InnoDB: Started; log sequence number 0 1611724675
140113 16:43:54 [Note] Event Scheduler: Loaded 0 events
140113 16:43:54 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log'? socket: '/var/lib/mysql/mysql.sock'? port: 3306
Source distribution
140113 16:46:41 [Note] /usr/libexec/mysqld: Normal shutdown
?
140113 16:46:41 [Note] Event Scheduler: Purging the queue. 0 events
140113 16:46:43? InnoDB: Starting shutdown...
140113 16:46:46? InnoDB: Shutdown completed; log sequence number 0
1611727339
140113 16:46:46 [Note] /usr/libexec/mysqld: Shutdown complete
?
140113 16:46:46 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140113 16:46:46 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140113 16:46:47? InnoDB: Started; log sequence number 0 1611727339
140113 16:46:47 [Note] Event Scheduler: Loaded 0 events
140113 16:46:47 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log'? socket: '/var/lib/mysql/mysql.sock'? port: 3306
Source distribution
140120 15:03:43 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
InnoDB: Log scan progressed past the checkpoint lsn 0 2652244913
140120 15:03:43? InnoDB: Database was not shut down normally!
InnoDB: Starting crash recovery.
InnoDB: Reading tablespace information from the .ibd files...
InnoDB: Restoring possible half-written data pages from the doublewrite
InnoDB: buffer...
InnoDB: Doing recovery: scanned up to log sequence number 0 2652246897
140120 15:03:44? InnoDB: Starting an apply batch of log records to the
database...
InnoDB: Progress in percents: 0 1 2 3 4 5 6 7 8 9 10 11 12 13 14 15 16 17 18
19 20 21 22 23 24 25 26 27 28 29 30 31 32 33 34 35 36 37 38 39 40 41 42 43
44 45 46 47 48 49 50 51 52 53 54 55 56 57 58 59 60 61 62 63 64 65 66 67 68
69 70 71 72 73 74 75 76 77 78 79 80 81 82 83 84 85 86 87 88 89 90 91 92 93
94 95 96 97 98 99
InnoDB: Apply batch completed
InnoDB: Last MySQL binlog file position 0 425635668, file name
./mysql-bin.000005
140120 15:03:45? InnoDB: Started; log sequence number 0 2652246897
140120 15:03:45 [Note] Recovering after a crash using mysql-bin
140120 15:03:47 [Note] Starting crash recovery...
140120 15:03:47 [Note] Crash recovery finished.
140120 15:03:47 [Note] Event Scheduler: Loaded 0 events
140120 15:03:47 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log'? socket: '/var/lib/mysql/mysql.sock'? port: 3306
Source distribution
140227 18:23:19 [Note] /usr/libexec/mysqld: Normal shutdown
?
140227 18:23:19 [Note] Event Scheduler: Purging the queue. 0 events
140227 18:23:19? InnoDB: Starting shutdown...
140227 18:23:21? InnoDB: Shutdown completed; log sequence number 1 247642825
140227 18:23:21 [Note] /usr/libexec/mysqld: Shutdown complete
?
140227 18:23:21 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140227 18:26:28 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140227 18:26:28? InnoDB: Started; log sequence number 1 247642825
140227 18:26:29 [Note] Event Scheduler: Loaded 0 events
140227 18:26:29 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log'? socket: '/var/lib/mysql/mysql.sock'? port: 3306
Source distribution
140227 19:51:32 [Note] /usr/libexec/mysqld: Normal shutdown
?
140227 19:51:32 [Note] Event Scheduler: Purging the queue. 0 events
140227 19:51:34? InnoDB: Starting shutdown...
140227 19:51:35? InnoDB: Shutdown completed; log sequence number 1 531142952
140227 19:51:35 [Note] /usr/libexec/mysqld: Shutdown complete
?
140227 19:51:35 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140227 19:51:36 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140227 19:51:36? InnoDB: Started; log sequence number 1 531142952
140227 19:51:36 [Note] Event Scheduler: Loaded 0 events
140227 19:51:36 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log'? socket: '/var/lib/mysql/mysql.sock'? port: 3306
Source distribution
140227 21:22:56 [Note] /usr/libexec/mysqld: Normal shutdown
?
140227 21:22:56 [Note] Event Scheduler: Purging the queue. 0 events
140227 21:22:56? InnoDB: Starting shutdown...
140227 21:22:58? InnoDB: Shutdown completed; log sequence number 1 818066929
140227 21:22:58 [Note] /usr/libexec/mysqld: Shutdown complete
?
140227 21:22:58 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140227 21:23:02 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140227 21:23:02? InnoDB: Started; log sequence number 1 818066929
140227 21:23:02 [Note] Event Scheduler: Loaded 0 events
140227 21:23:02 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log'? socket: '/var/lib/mysql/mysql.sock'? port: 3306
Source distribution
140228 17:15:26 [Note] /usr/libexec/mysqld: Normal shutdown
?
140228 17:15:26 [Note] Event Scheduler: Purging the queue. 0 events
140228 17:15:28? InnoDB: Starting shutdown...
140228 17:15:31? InnoDB: Shutdown completed; log sequence number 1
1030287660
140228 17:15:31 [Note] /usr/libexec/mysqld: Shutdown complete
?
140228 17:15:31 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140228 17:15:31 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140228 17:15:32? InnoDB: Started; log sequence number 1 1030287660
140228 17:15:32 [Note] Event Scheduler: Loaded 0 events
140228 17:15:32 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log'? socket: '/var/lib/mysql/mysql.sock'? port: 3306
Source distribution
140304 13:41:07 [Note] /usr/libexec/mysqld: Normal shutdown
?
140304 13:41:07 [Note] Event Scheduler: Purging the queue. 0 events
140304 13:41:10? InnoDB: Starting shutdown...
140304 13:41:14? InnoDB: Shutdown completed; log sequence number 1
2183881397
140304 13:41:14 [Note] /usr/libexec/mysqld: Shutdown complete
?
140304 13:41:14 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140304 13:44:55 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140304 13:44:55? InnoDB: Started; log sequence number 1 2183881397
140304 13:44:56 [Note] Event Scheduler: Loaded 0 events
140304 13:44:56 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log'? socket: '/var/lib/mysql/mysql.sock'? port: 3306
Source distribution
140321 11:52:22 [Note] /usr/libexec/mysqld: Normal shutdown
?
140321 11:52:22 [Note] Event Scheduler: Purging the queue. 0 events
140321 11:52:22? InnoDB: Starting shutdown...
140321 11:52:25? InnoDB: Shutdown completed; log sequence number 1
4023808129
140321 11:52:25 [Note] /usr/libexec/mysqld: Shutdown complete
?
140321 11:52:25 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140321 11:52:25 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140321 11:52:26? InnoDB: Started; log sequence number 1 4023808129
140321 11:52:26 [Note] Event Scheduler: Loaded 0 events
140321 11:52:26 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log'? socket: '/var/lib/mysql/mysql.sock'? port: 3306
Source distribution
140321 12:02:44 [Note] /usr/libexec/mysqld: Normal shutdown
?
140321 12:02:44 [Note] Event Scheduler: Purging the queue. 0 events
140321 12:02:44? InnoDB: Starting shutdown...
140321 12:02:47? InnoDB: Shutdown completed; log sequence number 1
4023808129
140321 12:02:47 [Note] /usr/libexec/mysqld: Shutdown complete
?
140321 12:02:47 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140321 12:06:06 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140321 12:06:07? InnoDB: Started; log sequence number 1 4023808129
140321 12:06:07 [Note] Event Scheduler: Loaded 0 events
140321 12:06:07 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log'? socket: '/var/lib/mysql/mysql.sock'? port: 3306
Source distribution
140321 15:54:18 [Note] /usr/libexec/mysqld: Normal shutdown
?
140321 15:54:18 [Note] Event Scheduler: Purging the queue. 0 events
140321 15:54:20? InnoDB: Starting shutdown...
140321 15:54:22? InnoDB: Shutdown completed; log sequence number 1
4023808129
140321 15:54:22 [Note] /usr/libexec/mysqld: Shutdown complete
?
140321 15:54:22 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140321 15:54:26 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140321 15:54:26? InnoDB: Started; log sequence number 1 4023808129
140321 15:54:26 [Note] Event Scheduler: Loaded 0 events
140321 15:54:26 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log'? socket: '/var/lib/mysql/mysql.sock'? port: 3306
Source distribution
140321 16:09:57 [Note] /usr/libexec/mysqld: Normal shutdown
?
140321 16:09:57 [Note] Event Scheduler: Purging the queue. 0 events
140321 16:09:59? InnoDB: Starting shutdown...
140321 16:10:02? InnoDB: Shutdown completed; log sequence number 1
4222382720
140321 16:10:02 [Note] /usr/libexec/mysqld: Shutdown complete
?
140321 16:10:02 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140321 16:10:02 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140321 16:10:03? InnoDB: Started; log sequence number 1 4222382720
140321 16:10:03 [Note] Event Scheduler: Loaded 0 events
140321 16:10:03 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log'? socket: '/var/lib/mysql/mysql.sock'? port: 3306
Source distribution
140325 10:48:26 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
InnoDB: Log scan progressed past the checkpoint lsn 2 40199498
140325 10:48:26? InnoDB: Database was not shut down normally!
InnoDB: Starting crash recovery.
InnoDB: Reading tablespace information from the .ibd files...
InnoDB: Restoring possible half-written data pages from the doublewrite
InnoDB: buffer...
InnoDB: Doing recovery: scanned up to log sequence number 2 40202963
140325 10:48:26? InnoDB: Starting an apply batch of log records to the
database...
InnoDB: Progress in percents: 38 39 40 41 42 43 44 45 46 47 48 49 50 51 52
53 54 55 56 57 58 59 60 61 62 63 64 65 66 67 68 69 70 71 72 73 74 75 76 77
78 79 80 81 82 83 84 85 86 87 88 89 90 91 92 93 94 95 96 97 98 99
InnoDB: Apply batch completed
InnoDB: Last MySQL binlog file position 0 80960371, file name
./mysql-bin.000016
140325 10:48:27? InnoDB: Started; log sequence number 2 40202963
140325 10:48:27 [Note] Recovering after a crash using mysql-bin
140325 10:48:28 [Note] Starting crash recovery...
140325 10:48:28 [Note] Crash recovery finished.
140325 10:48:28 [Note] Event Scheduler: Loaded 0 events
140325 10:48:28 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log'? socket: '/var/lib/mysql/mysql.sock'? port: 3306
Source distribution
140325 10:54:18 [Note] /usr/libexec/mysqld: Normal shutdown
?
140325 10:54:18 [Note] Event Scheduler: Purging the queue. 0 events
140325 10:54:18? InnoDB: Starting shutdown...
140325 10:54:23? InnoDB: Shutdown completed; log sequence number 2 40203100
140325 10:54:23 [Note] /usr/libexec/mysqld: Shutdown complete
?
140325 10:54:23 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140325 10:54:23 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140325 10:54:23? InnoDB: Started; log sequence number 2 40203100
140325 10:54:24 [Note] Event Scheduler: Loaded 0 events
140325 10:54:24 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log'? socket: '/var/lib/mysql/mysql.sock'? port: 3306
Source distribution
140325 10:55:45 [Note] /usr/libexec/mysqld: Normal shutdown
?
140325 10:55:45 [Note] Event Scheduler: Purging the queue. 0 events
140325 10:55:45? InnoDB: Starting shutdown...
140325 10:55:49? InnoDB: Shutdown completed; log sequence number 2 40203100
140325 10:55:49 [Note] /usr/libexec/mysqld: Shutdown complete
?
140325 10:55:49 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140325 10:55:50 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140325 10:55:50? InnoDB: Started; log sequence number 2 40203100
140325 10:55:50 [Note] Event Scheduler: Loaded 0 events
140325 10:55:50 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log'? socket: '/var/lib/mysql/mysql.sock'? port: 3306
Source distribution
140325 10:58:09 [Note] /usr/libexec/mysqld: Normal shutdown
?
140325 10:58:09 [Note] Event Scheduler: Purging the queue. 0 events
140325 10:58:09? InnoDB: Starting shutdown...
140325 10:58:10? InnoDB: Shutdown completed; log sequence number 2 40203100
140325 10:58:10 [Note] /usr/libexec/mysqld: Shutdown complete
?
140325 10:58:10 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140325 10:58:11 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140325 10:58:12? InnoDB: Started; log sequence number 2 40203100
140325 10:58:12 [Note] Event Scheduler: Loaded 0 events
140325 10:58:12 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log'? socket: '/var/lib/mysql/mysql.sock'? port: 3306
Source distribution
140325 11:10:15 [Note] /usr/libexec/mysqld: Normal shutdown
?
140325 11:10:15 [Note] Event Scheduler: Purging the queue. 0 events
140325 11:10:15? InnoDB: Starting shutdown...
140325 11:10:21? InnoDB: Shutdown completed; log sequence number 2 349169511
140325 11:10:21 [Note] /usr/libexec/mysqld: Shutdown complete
?
140325 11:10:21 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140325 11:10:22 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140325 11:10:22? InnoDB: Started; log sequence number 2 349169511
140325 11:10:22 [Note] Event Scheduler: Loaded 0 events
140325 11:10:22 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log'? socket: '/var/lib/mysql/mysql.sock'? port: 3306
Source distribution
140325 11:13:10 [Note] /usr/libexec/mysqld: Normal shutdown
?
140325 11:13:10 [Note] Event Scheduler: Purging the queue. 0 events
140325 11:13:10? InnoDB: Starting shutdown...
140325 11:13:12? InnoDB: Shutdown completed; log sequence number 2 349169511
140325 11:13:12 [Note] /usr/libexec/mysqld: Shutdown complete
?
140325 11:13:12 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140325 11:13:12 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140325 11:13:13? InnoDB: Started; log sequence number 2 349169511
140325 11:13:13 [Note] Event Scheduler: Loaded 0 events
140325 11:13:13 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log'? socket: '/var/lib/mysql/mysql.sock'? port: 3306
Source distribution
140325 19:57:40 [Note] /usr/libexec/mysqld: Normal shutdown
?
140325 19:57:40 [Note] Event Scheduler: Purging the queue. 0 events
140325 19:57:40? InnoDB: Starting shutdown...
140325 19:57:43? InnoDB: Shutdown completed; log sequence number 2 349169511
140325 19:57:43 [Note] /usr/libexec/mysqld: Shutdown complete
?
140325 19:57:43 mysqld_safe mysqld from pid file /var/run/mysqld/mysqld.pid
ended
140325 19:57:43 mysqld_safe Starting mysqld daemon with databases from
/var/lib/mysql
140325 19:57:44? InnoDB: Started; log sequence number 2 349169511
140325 19:57:44 [Note] Event Scheduler: Loaded 0 events
140325 19:57:44 [Note] /usr/libexec/mysqld: ready for connections.
Version: '5.1.52-log'? socket: '/var/lib/mysql/mysql.sock'? port: 3306
Source distribution
^C
?
?