<<< restart after applying Windows updates >>> <<< Ignition service did not start >>> STATUS | wrapper | 2023/04/24 12:13:05 | Machine is shutting down. INFO | jvm 1 | 2023/04/24 12:13:06 | E [g.Database ] [17:13:06]: Database connection FAULTED. store-forward-name=walcomet_connection, database=walcomet_connection INFO | jvm 1 | 2023/04/24 12:13:06 | org.postgresql.util.PSQLException: Connection to localhost:5432 refused. Check that the hostname and port are correct and that the postmaster is accepting TCP/IP connections. INFO | jvm 1 | 2023/04/24 12:13:06 | at org.postgresql.core.v3.ConnectionFactoryImpl.openConnectionImpl(ConnectionFactoryImpl.java:280) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.postgresql.core.ConnectionFactory.openConnection(ConnectionFactory.java:49) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.postgresql.jdbc.PgConnection.(PgConnection.java:195) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.postgresql.Driver.makeConnection(Driver.java:454) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.postgresql.Driver.connect(Driver.java:256) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.apache.commons.dbcp2.DriverConnectionFactory.createConnection(DriverConnectionFactory.java:52) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.apache.commons.dbcp2.PoolableConnectionFactory.makeObject(PoolableConnectionFactory.java:357) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.apache.commons.pool2.impl.GenericObjectPool.create(GenericObjectPool.java:565) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.apache.commons.pool2.impl.GenericObjectPool.borrowObject(GenericObjectPool.java:307) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.apache.commons.pool2.impl.GenericObjectPool.borrowObject(GenericObjectPool.java:428) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.apache.commons.pool2.impl.GenericObjectPool.borrowObject(GenericObjectPool.java:232) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.apache.commons.dbcp2.PoolingDataSource.getConnection(PoolingDataSource.java:134) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.apache.commons.dbcp2.BasicDataSource.getConnection(BasicDataSource.java:734) INFO | jvm 1 | 2023/04/24 12:13:06 | at com.inductiveautomation.ignition.gateway.datasource.DatasourceImpl.getConnectionInternal(DatasourceImpl.java:300) INFO | jvm 1 | 2023/04/24 12:13:06 | at com.inductiveautomation.ignition.gateway.datasource.DatasourceManagerImpl.getConnectionImpl(DatasourceManagerImpl.java:169) INFO | jvm 1 | 2023/04/24 12:13:06 | at com.inductiveautomation.ignition.gateway.datasource.DatasourceImpl.getConnection(DatasourceImpl.java:293) INFO | jvm 1 | 2023/04/24 12:13:06 | at com.inductiveautomation.ignition.gateway.history.sf.sinks.AbstractDatasourceSink.storeToDatasource(AbstractDatasourceSink.java:165) INFO | jvm 1 | 2023/04/24 12:13:06 | at com.inductiveautomation.ignition.gateway.history.sf.sinks.AbstractDatasourceSink.storeData(AbstractDatasourceSink.java:156) INFO | jvm 1 | 2023/04/24 12:13:06 | at com.inductiveautomation.ignition.gateway.history.sf.sinks.AggregateSink.storeData(AggregateSink.java:180) INFO | jvm 1 | 2023/04/24 12:13:06 | at com.inductiveautomation.ignition.gateway.history.forwarders.ForwarderThread.run(ForwarderThread.java:147) INFO | jvm 1 | 2023/04/24 12:13:06 | Caused by: java.net.ConnectException: Connection refused: connect INFO | jvm 1 | 2023/04/24 12:13:06 | at java.base/java.net.PlainSocketImpl.waitForConnect(Native Method) INFO | jvm 1 | 2023/04/24 12:13:06 | at java.base/java.net.PlainSocketImpl.socketConnect(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:06 | at java.base/java.net.AbstractPlainSocketImpl.doConnect(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:06 | at java.base/java.net.AbstractPlainSocketImpl.connectToAddress(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:06 | at java.base/java.net.AbstractPlainSocketImpl.connect(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:06 | at java.base/java.net.SocksSocketImpl.connect(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:06 | at java.base/java.net.Socket.connect(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.postgresql.core.PGStream.(PGStream.java:70) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.postgresql.core.v3.ConnectionFactoryImpl.tryConnect(ConnectionFactoryImpl.java:91) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.postgresql.core.v3.ConnectionFactoryImpl.openConnectionImpl(ConnectionFactoryImpl.java:192) INFO | jvm 1 | 2023/04/24 12:13:06 | ... 19 common frames omitted INFO | jvm 1 | 2023/04/24 12:13:06 | E [S.S.M.MemoryForwardTransaction] [17:13:06]: Error forwarding data store-forward-name=walcomet_connection INFO | jvm 1 | 2023/04/24 12:13:06 | org.postgresql.util.PSQLException: Connection to localhost:5432 refused. Check that the hostname and port are correct and that the postmaster is accepting TCP/IP connections. INFO | jvm 1 | 2023/04/24 12:13:06 | at org.postgresql.core.v3.ConnectionFactoryImpl.openConnectionImpl(ConnectionFactoryImpl.java:280) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.postgresql.core.ConnectionFactory.openConnection(ConnectionFactory.java:49) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.postgresql.jdbc.PgConnection.(PgConnection.java:195) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.postgresql.Driver.makeConnection(Driver.java:454) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.postgresql.Driver.connect(Driver.java:256) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.apache.commons.dbcp2.DriverConnectionFactory.createConnection(DriverConnectionFactory.java:52) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.apache.commons.dbcp2.PoolableConnectionFactory.makeObject(PoolableConnectionFactory.java:357) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.apache.commons.pool2.impl.GenericObjectPool.create(GenericObjectPool.java:565) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.apache.commons.pool2.impl.GenericObjectPool.borrowObject(GenericObjectPool.java:307) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.apache.commons.pool2.impl.GenericObjectPool.borrowObject(GenericObjectPool.java:428) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.apache.commons.pool2.impl.GenericObjectPool.borrowObject(GenericObjectPool.java:232) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.apache.commons.dbcp2.PoolingDataSource.getConnection(PoolingDataSource.java:134) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.apache.commons.dbcp2.BasicDataSource.getConnection(BasicDataSource.java:734) INFO | jvm 1 | 2023/04/24 12:13:06 | at com.inductiveautomation.ignition.gateway.datasource.DatasourceImpl.getConnectionInternal(DatasourceImpl.java:300) INFO | jvm 1 | 2023/04/24 12:13:06 | at com.inductiveautomation.ignition.gateway.datasource.DatasourceManagerImpl.getConnectionImpl(DatasourceManagerImpl.java:169) INFO | jvm 1 | 2023/04/24 12:13:06 | at com.inductiveautomation.ignition.gateway.datasource.DatasourceImpl.getConnection(DatasourceImpl.java:293) INFO | jvm 1 | 2023/04/24 12:13:06 | at com.inductiveautomation.ignition.gateway.history.sf.sinks.AbstractDatasourceSink.storeToDatasource(AbstractDatasourceSink.java:165) INFO | jvm 1 | 2023/04/24 12:13:06 | at com.inductiveautomation.ignition.gateway.history.sf.sinks.AbstractDatasourceSink.storeData(AbstractDatasourceSink.java:156) INFO | jvm 1 | 2023/04/24 12:13:06 | at com.inductiveautomation.ignition.gateway.history.sf.sinks.AggregateSink.storeData(AggregateSink.java:180) INFO | jvm 1 | 2023/04/24 12:13:06 | at com.inductiveautomation.ignition.gateway.history.forwarders.ForwarderThread.run(ForwarderThread.java:147) INFO | jvm 1 | 2023/04/24 12:13:06 | Caused by: java.net.ConnectException: Connection refused: connect INFO | jvm 1 | 2023/04/24 12:13:06 | at java.base/java.net.PlainSocketImpl.waitForConnect(Native Method) INFO | jvm 1 | 2023/04/24 12:13:06 | at java.base/java.net.PlainSocketImpl.socketConnect(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:06 | at java.base/java.net.AbstractPlainSocketImpl.doConnect(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:06 | at java.base/java.net.AbstractPlainSocketImpl.connectToAddress(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:06 | at java.base/java.net.AbstractPlainSocketImpl.connect(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:06 | at java.base/java.net.SocksSocketImpl.connect(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:06 | at java.base/java.net.Socket.connect(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.postgresql.core.PGStream.(PGStream.java:70) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.postgresql.core.v3.ConnectionFactoryImpl.tryConnect(ConnectionFactoryImpl.java:91) INFO | jvm 1 | 2023/04/24 12:13:06 | at org.postgresql.core.v3.ConnectionFactoryImpl.openConnectionImpl(ConnectionFactoryImpl.java:192) INFO | jvm 1 | 2023/04/24 12:13:06 | ... 19 common frames omitted INFO | jvm 1 | 2023/04/24 12:13:07 | I [o.e.j.s.AbstractConnector ] [17:13:07]: Stopped ServerConnector@4e6fe20c{HTTP/1.1, (http/1.1)}{0.0.0.0:8088} INFO | jvm 1 | 2023/04/24 12:13:07 | I [m.T.W.WebSocketConnection ] [17:13:07]: [1445200399] walcomet_scada-backup connection status has been updated from Running to Faulted: onClose has been called on web socket:Disconnected gan-remote-connection-id=90987886-e636-443b-93a0-8f8b56d70249 INFO | jvm 1 | 2023/04/24 12:13:07 | I [o.e.j.s.AbstractConnector ] [17:13:07]: Stopped ServerConnector@47cd7eae{SSL, (ssl, http/1.1)}{0.0.0.0:8060} INFO | jvm 1 | 2023/04/24 12:13:07 | I [o.e.j.s.session ] [17:13:07]: node0 Stopped scavenging INFO | jvm 1 | 2023/04/24 12:13:07 | I [R.S.MasterStateManager ] [17:13:07]: Destroying session. INFO | jvm 1 | 2023/04/24 12:13:07 | I [m.M.Routing ] [17:13:07]: Route disconnected between server '_0:2:Walcomet_SCADA' and connection 'walcomet_scada-backup|90987886-e636-443b-93a0-8f8b56d70249' INFO | jvm 1 | 2023/04/24 12:13:07 | E [m.T.W.MetroWebSocket ] [17:13:07]: <- incoming local='walcomet_scada-master' remote='walcomet_scada-backup' method=onClose: Connection walcomet_scada-backup|90987886-e636-443b-93a0-8f8b56d70249 has been set to Faulted:Disconnected INFO | jvm 1 | 2023/04/24 12:13:07 | I [IgnitionGateway ] [17:13:07]: Ignition[state=RUNNING] ContextState = STOPPING INFO | jvm 1 | 2023/04/24 12:13:07 | I [IgnitionGateway ] [17:13:07]: Ignition Gateway shutting down... INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: ModuleManager shutting down... INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutting down module 'com.inductiveautomation.reporting' v6.1.20 (b2022082313)... module-name=Reporting INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutdown of module "com.inductiveautomation.reporting" completed in 3 ms module-name=Reporting INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutting down module 'com.inductiveautomation.opcua.drivers.ablegacy' v6.1.20 (b2022082313)... module-name=Allen-Bradley Driver INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutdown of module "com.inductiveautomation.opcua.drivers.ablegacy" completed in 1 ms module-name=Allen-Bradley Driver INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutting down module 'com.inductiveautomation.opcua.drivers.modbus' v7.1.20 (b2022082313)... module-name=Modbus Driver INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutdown of module "com.inductiveautomation.opcua.drivers.modbus" completed in 0 ms module-name=Modbus Driver INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutting down module 'com.inductiveautomation.opcua.drivers.logix' v5.1.20 (b2022082313)... module-name=Logix Driver INFO | jvm 1 | 2023/04/24 12:13:07 | E [R.S.SyncManager ] [17:13:07]: Error executing task 'syncRequest'. INFO | jvm 1 | 2023/04/24 12:13:07 | com.inductiveautomation.metro.api.ex.ServiceUnavailableException: null INFO | jvm 1 | 2023/04/24 12:13:07 | at com.inductiveautomation.metro.impl.services.ServiceManagerImpl$ServerWrapper$ServerService.getChecked(ServiceManagerImpl.java:661) INFO | jvm 1 | 2023/04/24 12:13:07 | at com.inductiveautomation.ignition.gateway.redundancy.state.SynchronizationManager.service(SynchronizationManager.java:272) INFO | jvm 1 | 2023/04/24 12:13:07 | at com.inductiveautomation.ignition.gateway.redundancy.state.SynchronizationManager$SyncRequest.run(SynchronizationManager.java:1053) INFO | jvm 1 | 2023/04/24 12:13:07 | at com.inductiveautomation.ignition.gateway.redundancy.state.SynchronizationManager$CollapsingRunnable.run(SynchronizationManager.java:1018) INFO | jvm 1 | 2023/04/24 12:13:07 | at java.base/java.util.concurrent.Executors$RunnableAdapter.call(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:07 | at java.base/java.util.concurrent.FutureTask.run(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:07 | at java.base/java.util.concurrent.ScheduledThreadPoolExecutor$ScheduledFutureTask.run(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:07 | at java.base/java.util.concurrent.ThreadPoolExecutor.runWorker(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:07 | at java.base/java.util.concurrent.ThreadPoolExecutor$Worker.run(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:07 | at java.base/java.lang.Thread.run(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutdown of module "com.inductiveautomation.opcua.drivers.logix" completed in 77 ms module-name=Logix Driver INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutting down module 'com.inductiveautomation.opcua.drivers.tcpudp' v6.1.20 (b2022082313)... module-name=UDP and TCP Drivers INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutdown of module "com.inductiveautomation.opcua.drivers.tcpudp" completed in 0 ms module-name=UDP and TCP Drivers INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutting down module 'com.inductiveautomation.sms-notification' v6.1.20 (b2022082313)... module-name=SMS Notification INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutdown of module "com.inductiveautomation.sms-notification" completed in 3 ms module-name=SMS Notification INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutting down module 'com.inductiveautomation.phone-notification' v6.1.20 (b2022082313)... module-name=Voice Notification INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutdown of module "com.inductiveautomation.phone-notification" completed in 4 ms module-name=Voice Notification INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutting down module 'com.inductiveautomation.perspective' v2.1.20 (b2022082313)... module-name=Perspective INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutdown of module "com.inductiveautomation.perspective" completed in 5 ms module-name=Perspective INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutting down module 'com.inductiveautomation.opccom' v6.1.20 (b2022082313)... module-name=OpcCom INFO | jvm 1 | 2023/04/24 12:13:07 | I [c.i.o.ModuleHook ] [17:13:07]: Message loop stopped. module-name=OpcCom INFO | jvm 1 | 2023/04/24 12:13:07 | I [c.i.o.ModuleHook ] [17:13:07]: Cleaning up native resource collector. module-name=OpcCom INFO | jvm 1 | 2023/04/24 12:13:07 | I [c.i.o.ModuleHook ] [17:13:07]: Shutdown native resource collector. module-name=OpcCom INFO | jvm 1 | 2023/04/24 12:13:07 | I [c.i.o.ModuleHook ] [17:13:07]: Native thread killed. module-name=OpcCom INFO | jvm 1 | 2023/04/24 12:13:07 | I [c.i.o.ModuleHook ] [17:13:07]: Native resource collector has stopped. module-name=OpcCom INFO | jvm 1 | 2023/04/24 12:13:07 | I [c.i.o.ModuleHook ] [17:13:07]: COM-OPC Module shutdown. module-name=OpcCom INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutdown of module "com.inductiveautomation.opccom" completed in 14 ms module-name=OpcCom INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutting down module 'com.inductiveautomation.taghistorian' v4.1.20 (b2022082313)... module-name=Tag Historian INFO | jvm 1 | 2023/04/24 12:13:07 | I [h.ModuleHook ] [17:13:07]: Tag Historian module stopped. module-name=Tag Historian INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutdown of module "com.inductiveautomation.taghistorian" completed in 2 ms module-name=Tag Historian INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutting down module 'com.inductiveautomation.sqlbridge' v10.1.20 (b2022082313)... module-name=SQL Bridge INFO | jvm 1 | 2023/04/24 12:13:07 | I [s.ProjectRunner ] [17:13:07]: Project shutdown. module-name=SQL Bridge, project-name=Walcomet_TEST INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutdown of module "com.inductiveautomation.sqlbridge" completed in 1 ms module-name=SQL Bridge INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutting down module 'com.inductiveautomation.serial-support-gateway' v6.1.20 (b2022082313)... module-name=Serial Support Gateway INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutdown of module "com.inductiveautomation.serial-support-gateway" completed in 0 ms module-name=Serial Support Gateway INFO | jvm 1 | 2023/04/24 12:13:07 | I [g.ModuleManager ] [17:13:07]: Shutting down module 'com.inductiveautomation.opcua' v9.1.20 (b2022082313)... module-name=OPC-UA INFO | jvm 1 | 2023/04/24 12:13:08 | E [p.HistoryManager ] [17:13:08]: The datasource 'walcomet_connection' cannot accept data of the given type [__sqltaghistory__]. store-forward-name=walcomet_connection STATUS | wrapper | 2023/04/24 12:13:30 | --> Wrapper Started as Service STATUS | wrapper | 2023/04/24 12:13:35 | Java Service Wrapper Standard Edition 64-bit 3.5.42 STATUS | wrapper | 2023/04/24 12:13:35 | Java Service Wrapper Standard Edition 64-bit 3.5.42 STATUS | wrapper | 2023/04/24 12:13:35 | Copyright (C) 1999-2020 Tanuki Software, Ltd. All Rights Reserved. STATUS | wrapper | 2023/04/24 12:13:35 | Copyright (C) 1999-2020 Tanuki Software, Ltd. All Rights Reserved. STATUS | wrapper | 2023/04/24 12:13:35 | Licensed to Inductive Automation for Inductive Automation STATUS | wrapper | 2023/04/24 12:13:35 | http://wrapper.tanukisoftware.com STATUS | wrapper | 2023/04/24 12:13:35 | STATUS | wrapper | 2023/04/24 12:13:35 | Licensed to Inductive Automation for Inductive Automation STATUS | wrapper | 2023/04/24 12:13:35 | STATUS | wrapper | 2023/04/24 12:13:39 | Launching a JVM... STATUS | wrapper | 2023/04/24 12:13:39 | Launching a JVM... INFO | jvm 1 | 2023/04/24 12:13:39 | WrapperManager: Initializing... INFO | jvm 1 | 2023/04/24 12:13:45 | 12:13:45,635 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - About to instantiate appender of type [ch.qos.logback.core.ConsoleAppender] INFO | jvm 1 | 2023/04/24 12:13:45 | 12:13:45,651 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - Naming appender as [SysoutAppender] INFO | jvm 1 | 2023/04/24 12:13:45 | 12:13:45,651 |-INFO in ch.qos.logback.core.joran.action.NestedComplexPropertyIA - Assuming default type [ch.qos.logback.classic.encoder.PatternLayoutEncoder] for [encoder] property INFO | jvm 1 | 2023/04/24 12:13:45 | 12:13:45,698 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - About to instantiate appender of type [com.inductiveautomation.logging.SQLiteAppender] INFO | jvm 1 | 2023/04/24 12:13:45 | 12:13:45,729 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - Naming appender as [DB] INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,182 |-INFO in ch.qos.logback.core.db.DataSourceConnectionSource@7c128cc2 - Driver name=SQLite JDBC INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,182 |-INFO in ch.qos.logback.core.db.DataSourceConnectionSource@7c128cc2 - Driver version=3.23.1 INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,182 |-INFO in ch.qos.logback.core.db.DataSourceConnectionSource@7c128cc2 - supportsGetGeneratedKeys=true INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,432 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - About to instantiate appender of type [ch.qos.logback.classic.AsyncAppender] INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,432 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - Naming appender as [SysoutAsync] INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,432 |-INFO in ch.qos.logback.core.joran.action.AppenderRefAction - Attaching appender named [SysoutAppender] to ch.qos.logback.classic.AsyncAppender[SysoutAsync] INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,432 |-INFO in ch.qos.logback.classic.AsyncAppender[SysoutAsync] - Attaching appender named [SysoutAppender] to AsyncAppender. INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,432 |-INFO in ch.qos.logback.classic.AsyncAppender[SysoutAsync] - Setting discardingThreshold to 51 INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,448 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - About to instantiate appender of type [ch.qos.logback.classic.AsyncAppender] INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,448 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - Naming appender as [DBAsync] INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,448 |-INFO in ch.qos.logback.core.joran.action.AppenderRefAction - Attaching appender named [DB] to ch.qos.logback.classic.AsyncAppender[DBAsync] INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,448 |-INFO in ch.qos.logback.classic.AsyncAppender[DBAsync] - Attaching appender named [DB] to AsyncAppender. INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,448 |-INFO in ch.qos.logback.classic.AsyncAppender[DBAsync] - Setting discardingThreshold to 51 INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,448 |-INFO in ch.qos.logback.classic.joran.action.RootLoggerAction - Setting level of ROOT logger to INFO INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,448 |-INFO in ch.qos.logback.core.joran.action.AppenderRefAction - Attaching appender named [SysoutAsync] to Logger[ROOT] INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,448 |-INFO in ch.qos.logback.core.joran.action.AppenderRefAction - Attaching appender named [DBAsync] to Logger[ROOT] INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,448 |-INFO in ch.qos.logback.classic.joran.action.ConfigurationAction - End of configuration. INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,448 |-INFO in ch.qos.logback.classic.joran.JoranConfigurator@33d2b810 - Registering current configuration as safe fallback point INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,604 |-INFO in ch.qos.logback.classic.jul.LevelChangePropagator@12d3439c - Propagating INFO level on Logger[ROOT] onto the JUL framework INFINFO | jvm 1 | 2023/04/24 12:13:45 | 12:13:45,635 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - About to instantiate appender of type [ch.qos.logback.core.ConsoleAppender] INFO | jvm 1 | 2023/04/24 12:13:45 | 12:13:45,651 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - Naming appender as [SysoutAppender] INFO | jvm 1 | 2023/04/24 12:13:45 | 12:13:45,651 |-INFO in ch.qos.logback.core.joran.action.NestedComplexPropertyIA - Assuming default type [ch.qos.logback.classic.encoder.PatternLayoutEncoder] for [encoder] property INFO | jvm 1 | 2023/04/24 12:13:45 | 12:13:45,698 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - About to instantiate appender of type [com.inductiveautomation.logging.SQLiteAppender] INFO | jvm 1 | 2023/04/24 12:13:45 | 12:13:45,729 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - Naming appender as [DB] INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,182 |-INFO in ch.qos.logback.core.db.DataSourceConnectionSource@143f40c3 - Driver name=SQLite JDBC INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,182 |-INFO in ch.qos.logback.core.db.DataSourceConnectionSource@143f40c3 - Driver version=3.23.1 INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,182 |-INFO in ch.qos.logback.core.db.DataSourceConnectionSource@143f40c3 - supportsGetGeneratedKeys=true INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,432 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - About to instantiate appender of type [ch.qos.logback.classic.AsyncAppender] INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,432 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - Naming appender as [SysoutAsync] INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,432 |-INFO in ch.qos.logback.core.joran.action.AppenderRefAction - Attaching appender named [SysoutAppender] to ch.qos.logback.classic.AsyncAppender[SysoutAsync] INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,432 |-INFO in ch.qos.logback.classic.AsyncAppender[SysoutAsync] - Attaching appender named [SysoutAppender] to AsyncAppender. INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,432 |-INFO in ch.qos.logback.classic.AsyncAppender[SysoutAsync] - Setting discardingThreshold to 51 INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,432 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - About to instantiate appender of type [ch.qos.logback.classic.AsyncAppender] INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,448 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - Naming appender as [DBAsync] INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,448 |-INFO in ch.qos.logback.core.joran.action.AppenderRefAction - Attaching appender named [DB] to ch.qos.logback.classic.AsyncAppender[DBAsync] INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,448 |-INFO in ch.qos.logback.classic.AsyncAppender[DBAsync] - Attaching appender named [DB] to AsyncAppender. INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,448 |-INFO in ch.qos.logback.classic.AsyncAppender[DBAsync] - Setting discardingThreshold to 51 INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,448 |-INFO in ch.qos.logback.classic.joran.action.RootLoggerAction - Setting level of ROOT logger to INFO INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,448 |-INFO in ch.qos.logback.core.joran.action.AppenderRefAction - Attaching appender named [SysoutAsync] to Logger[ROOT] INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,448 |-INFO in ch.qos.logback.core.joran.action.AppenderRefAction - Attaching appender named [DBAsync] to Logger[ROOT] INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,448 |-INFO in ch.qos.logback.classic.joran.action.ConfigurationAction - End of configuration. INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,448 |-INFO in ch.qos.logback.classic.joran.JoranConfigurator@6d16b81e - Registering current configuration as safe fallback point INFO | jvm 1 | 2023/04/24 12:13:46 | 12:13:46,604 |-INFO in ch.qos.logback.classic.jul.LevelChangePropagator@4a4c5845 - Propagating INFO level on Logger[ROOT] onto the JUL framework INFO | jvm 1 | 2023/04/24 12:13:46 | W [WebResourceManagerImpl ] [17:13:46]: Unable to read "gateway.metroKeystoreAlias" gateway.xml property. Assuming metro keystore alias is: metro-key O | jvm 1 | 2023/04/24 12:13:46 | W [WebResourceManagerImpl ] [17:13:46]: Unable to read "gateway.metroKeystoreAlias" gateway.xml property. Assuming metro keystore alias is: metro-key INFO | jvm 1 | 2023/04/24 12:13:47 | I [o.e.j.u.log ] [17:13:47]: Logging initialized @8192ms to org.eclipse.jetty.util.log.Slf4jLog INFO | jvm 1 | 2023/04/24 12:13:47 | I [g.WebServerManager ] [17:13:47]: Starting setup INFO | jvm 1 | 2023/04/24 12:13:47 | I [g.WebServerManager ] [17:13:47]: Setup complete INFO | jvm 1 | 2023/04/24 12:13:48 | I [g.WebServerManager ] [17:13:48]: Starting up INFO | jvm 1 | 2023/04/24 12:13:48 | I [C.SecureRandomProvider ] [17:13:48]: Secure random seed generated in 0ms INFO | jvm 1 | 2023/04/24 12:13:48 | I [o.e.j.s.Server ] [17:13:48]: jetty-9.4.46.v20220331; built: 2022-03-31T16:38:08.030Z; git: bc17a0369a11ecf40bb92c839b9ef0a8ac50ea18; jvm 11.0.15+10-LTS INFO | jvm 1 | 2023/04/24 12:13:48 | I [o.e.j.s.session ] [17:13:48]: DefaultSessionIdManager workerName=node0 INFO | jvm 1 | 2023/04/24 12:13:48 | I [o.e.j.s.session ] [17:13:48]: No SessionScavenger set, using defaults INFO | jvm 1 | 2023/04/24 12:13:48 | I [o.e.j.s.session ] [17:13:48]: node0 Scavenging every 660000ms INFO | jvm 1 | 2023/04/24 12:13:49 | W [c.i.i.g.b.GatewayFilter ] [17:13:48]: Unable to clean temp dir INFO | jvm 1 | 2023/04/24 12:13:49 | java.io.IOException: Unable to delete file: temp\libstdc++-6.dll INFO | jvm 1 | 2023/04/24 12:13:49 | at com.inductiveautomation.ignition.gateway.bootstrap.BootstrapFileUtils.forceDelete(BootstrapFileUtils.java:158) INFO | jvm 1 | 2023/04/24 12:13:49 | at com.inductiveautomation.ignition.gateway.bootstrap.BootstrapFileUtils.cleanDirectory(BootstrapFileUtils.java:123) INFO | jvm 1 | 2023/04/24 12:13:49 | at com.inductiveautomation.ignition.gateway.bootstrap.GatewayFilter.init(GatewayFilter.java:49) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.apache.wicket.protocol.http.WicketFilter.init(WicketFilter.java:351) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.servlet.FilterHolder.initialize(FilterHolder.java:140) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.servlet.ServletHandler.lambda$initialize$0(ServletHandler.java:731) INFO | jvm 1 | 2023/04/24 12:13:49 | at java.base/java.util.Spliterators$ArraySpliterator.forEachRemaining(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:49 | at java.base/java.util.stream.Streams$ConcatSpliterator.forEachRemaining(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:49 | at java.base/java.util.stream.ReferencePipeline$Head.forEach(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.servlet.ServletHandler.initialize(ServletHandler.java:755) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.servlet.ServletContextHandler.startContext(ServletContextHandler.java:379) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.webapp.WebAppContext.startWebapp(WebAppContext.java:1449) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.webapp.WebAppContext.startContext(WebAppContext.java:1414) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.server.handler.ContextHandler.doStart(ContextHandler.java:916) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.servlet.ServletContextHandler.doStart(ServletContextHandler.java:288) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.webapp.WebAppContext.doStart(WebAppContext.java:524) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.AbstractLifeCycle.start(AbstractLifeCycle.java:73) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.ContainerLifeCycle.start(ContainerLifeCycle.java:169) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.ContainerLifeCycle.doStart(ContainerLifeCycle.java:110) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.server.handler.AbstractHandler.doStart(AbstractHandler.java:97) INFO | jvm 1 | 2023/04/24 12:13:49 | at com.inductiveautomation.catapult.handlers.RemoteHostNameLookupHandler.doStart(RemoteHostNameLookupHandler.java:58) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.AbstractLifeCycle.start(AbstractLifeCycle.java:73) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.ContainerLifeCycle.start(ContainerLifeCycle.java:169) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.ContainerLifeCycle.doStart(ContainerLifeCycle.java:110) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.server.handler.AbstractHandler.doStart(AbstractHandler.java:97) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.AbstractLifeCycle.start(AbstractLifeCycle.java:73) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipsINFO | jvm 1 | 2023/04/24 12:13:48 | I [o.e.j.s.session ] [17:13:48]: DefaultSessionIdManager workerName=node0 INFO | jvm 1 | 2023/04/24 12:13:48 | I [o.e.j.s.session ] [17:13:48]: No SessionScavenger set, using defaults INFO | jvm 1 | 2023/04/24 12:13:48 | I [o.e.j.s.session ] [17:13:48]: node0 Scavenging every 660000ms INFO | jvm 1 | 2023/04/24 12:13:49 | W [c.i.i.g.b.GatewayFilter ] [17:13:48]: Unable to clean temp dir INFO | jvm 1 | 2023/04/24 12:13:49 | java.io.IOException: Unable to delete file: temp\pylib_compressed.zip INFO | jvm 1 | 2023/04/24 12:13:49 | at com.inductiveautomation.ignition.gateway.bootstrap.BootstrapFileUtils.forceDelete(BootstrapFileUtils.java:158) INFO | jvm 1 | 2023/04/24 12:13:49 | at com.inductiveautomation.ignition.gateway.bootstrap.BootstrapFileUtils.cleanDirectory(BootstrapFileUtils.java:123) INFO | jvm 1 | 2023/04/24 12:13:49 | at com.inductiveautomation.ignition.gateway.bootstrap.GatewayFilter.init(GatewayFilter.java:49) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.apache.wicket.protocol.http.WicketFilter.init(WicketFilter.java:351) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.servlet.FilterHolder.initialize(FilterHolder.java:140) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.servlet.ServletHandler.lambda$initialize$0(ServletHandler.java:731) INFO | jvm 1 | 2023/04/24 12:13:49 | at java.base/java.util.Spliterators$ArraySpliterator.forEachRemaining(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:49 | at java.base/java.util.stream.Streams$ConcatSpliterator.forEachRemaining(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:49 | at java.base/java.util.stream.ReferencePipeline$Head.forEach(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.servlet.ServletHandler.initialize(ServletHandler.java:755) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.servlet.ServletContextHandler.startContext(ServletContextHandler.java:379) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.webapp.WebAppContext.startWebapp(WebAppContext.java:1449) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.webapp.WebAppContext.startContext(WebAppContext.java:1414) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.server.handler.ContextHandler.doStart(ContextHandler.java:916) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.servlet.ServletContextHandler.doStart(ServletContextHandler.java:288) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.webapp.WebAppContext.doStart(WebAppContext.java:524) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.AbstractLifeCycle.start(AbstractLifeCycle.java:73) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.ContainerLifeCycle.start(ContainerLifeCycle.java:169) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.ContainerLifeCycle.doStart(ContainerLifeCycle.java:110) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.server.handler.AbstractHandler.doStart(AbstractHandler.java:97) INFO | jvm 1 | 2023/04/24 12:13:49 | at com.inductiveautomation.catapult.handlers.RemoteHostNameLookupHandler.doStart(RemoteHostNameLookupHandler.java:58) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.AbstractLifeCycle.start(AbstractLifeCycle.java:73) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.ContainerLifeCycle.start(ContainerLifeCycle.java:169) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.ContainerLifeCycle.doStart(ContainerLifeCycle.java:110) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.server.handler.AbstractHandler.doStart(AbstractHandler.java:97) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.AbstractLifeCycle.start(AbstractLifeCycle.java:73) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.ee.jetty.util.component.ContainerLifeCycle.start(ContainerLifeCycle.java:169) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.ContainerLifeCycle.doStart(ContainerLifeCycle.java:117) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.server.handler.AbstractHandler.doStart(AbstractHandler.java:97) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.AbstractLifeCycle.start(AbstractLifeCycle.java:73) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.ContainerLifeCycle.start(ContainerLifeCycle.java:169) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.ContainerLifeCycle.doStart(ContainerLifeCycle.java:117) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.server.handler.AbstractHandler.doStart(AbstractHandler.java:97) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.AbstractLifeCycle.start(AbstractLifeCycle.java:73) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.ContainerLifeCycle.start(ContainerLifeCycle.java:169) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.server.Server.start(Server.java:423) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.ContainerLifeCycle.doStart(ContainerLifeCycle.java:110) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.server.handler.AbstractHandler.doStart(AbstractHandler.java:97) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.server.Server.doStart(Server.java:387) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.AbstractLifeCycle.start(AbstractLifeCycle.java:73) INFO | jvm 1 | 2023/04/24 12:13:49 | at com.inductiveautomation.catapult.IgnitionServer.start(IgnitionServer.java:1170) INFO | jvm 1 | 2023/04/24 12:13:49 | at com.inductiveautomation.ignition.gateway.web.WebResourceManagerImpl.start(WebResourceManagerImpl.java:337) INFO | jvm 1 | 2023/04/24 12:13:49 | at com.inductiveautomation.ignition.gateway.IgnitionGateway.start(IgnitionGateway.java:565) INFO | jvm 1 | 2023/04/24 12:13:49 | at com.inductiveautomation.ignition.gateway.IgnitionGateway.main(IgnitionGateway.java:297) INFO | jvm 1 | 2023/04/24 12:13:49 | at com.inductiveautomation.catapult.Catapult.main(Catapult.java:8) INFO | jvm 1 | 2023/04/24 12:13:49 | at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method) INFO | jvm 1 | 2023/04/24 12:13:49 | at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:49 | at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:49 | at java.base/java.lang.reflect.Method.invoke(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.tanukisoftware.wrapper.WrapperSimpleApp.run(WrapperSimpleApp.java:349) INFO | jvm 1 | 2023/04/24 12:13:49 | at java.base/java.lang.Thread.run(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:49 | I [o.a.w.Application ] [17:13:49]: [WicketFilter] init: Wicket core library initializer INFO | jvm 1 | 2023/04/24 12:13:49 | I [o.a.w.RequestListenerInterface] [17:13:49]: registered listener interface [RequestListenerInterface name=IBehaviorListener, method=public abstract void org.apache.wicket.behavior.IBehaviorListener.onRequest()] INFO | jvm 1 | 2023/04/24 12:13:49 | I [o.a.w.RequestListenerInterface] [17:13:49]: registered listener interface [RequestListenerInterface name=IFormSubmitListener, method=public abstract void org.apache.wicket.markup.html.form.IFormSubmitListener.onFormSubmitted()] INFO | jvm 1 | 2023/04/24 12:13:49 | I [o.a.w.RequestListenerInterface] [17:13:49]: registered listener interface [RequestListenerInterface name=ILinkListener, method=public abstract void org.apache.wicket.markup.html.link.ILinkListener.onLinkClicked()] INFO | jvm 1 | 2023/04/24 12:13:49 | I [o.a.w.RequestListenerInterface] [17:1clipse.jetty.util.component.ContainerLifeCycle.start(ContainerLifeCycle.java:169) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.ContainerLifeCycle.doStart(ContainerLifeCycle.java:117) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.server.handler.AbstractHandler.doStart(AbstractHandler.java:97) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.AbstractLifeCycle.start(AbstractLifeCycle.java:73) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.ContainerLifeCycle.start(ContainerLifeCycle.java:169) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.ContainerLifeCycle.doStart(ContainerLifeCycle.java:117) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.server.handler.AbstractHandler.doStart(AbstractHandler.java:97) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.AbstractLifeCycle.start(AbstractLifeCycle.java:73) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.ContainerLifeCycle.start(ContainerLifeCycle.java:169) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.server.Server.start(Server.java:423) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.ContainerLifeCycle.doStart(ContainerLifeCycle.java:110) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.server.handler.AbstractHandler.doStart(AbstractHandler.java:97) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.server.Server.doStart(Server.java:387) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.eclipse.jetty.util.component.AbstractLifeCycle.start(AbstractLifeCycle.java:73) INFO | jvm 1 | 2023/04/24 12:13:49 | at com.inductiveautomation.catapult.IgnitionServer.start(IgnitionServer.java:1170) INFO | jvm 1 | 2023/04/24 12:13:49 | at com.inductiveautomation.ignition.gateway.web.WebResourceManagerImpl.start(WebResourceManagerImpl.java:337) INFO | jvm 1 | 2023/04/24 12:13:49 | at com.inductiveautomation.ignition.gateway.IgnitionGateway.start(IgnitionGateway.java:565) INFO | jvm 1 | 2023/04/24 12:13:49 | at com.inductiveautomation.ignition.gateway.IgnitionGateway.main(IgnitionGateway.java:297) INFO | jvm 1 | 2023/04/24 12:13:49 | at com.inductiveautomation.catapult.Catapult.main(Catapult.java:8) INFO | jvm 1 | 2023/04/24 12:13:49 | at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method) INFO | jvm 1 | 2023/04/24 12:13:49 | at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:49 | at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:49 | at java.base/java.lang.reflect.Method.invoke(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:49 | at org.tanukisoftware.wrapper.WrapperSimpleApp.run(WrapperSimpleApp.java:349) INFO | jvm 1 | 2023/04/24 12:13:49 | at java.base/java.lang.Thread.run(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:49 | I [o.a.w.Application ] [17:13:49]: [WicketFilter] init: Wicket core library initializer INFO | jvm 1 | 2023/04/24 12:13:49 | I [o.a.w.RequestListenerInterface] [17:13:49]: registered listener interface [RequestListenerInterface name=IBehaviorListener, method=public abstract void org.apache.wicket.behavior.IBehaviorListener.onRequest()] INFO | jvm 1 | 2023/04/24 12:13:49 | I [o.a.w.RequestListenerInterface] [17:13:49]: registered listener interface [RequestListenerInterface name=IFormSubmitListener, method=public abstract void org.apache.wicket.markup.html.form.IFormSubmitListener.onFormSubmitted()] INFO | jvm 1 | 2023/04/24 12:13:49 | I [o.a.w.RequestListenerInterface] [17:13:49]: registered listener interface [RequestListenerInterface name=ILinkListener, method=public abstract void org.apache.wicket.markup.html.link.ILinkListener.onLinkClicked()] INFO | jvm 1 | 2023/04/24 12:13:49 | I [o.a.w.RequestListenerInterface] 3:49]: registered listener interface [RequestListenerInterface name=IOnChangeListener, method=public abstract void org.apache.wicket.markup.html.form.IOnChangeListener.onSelectionChanged()] INFO | jvm 1 | 2023/04/24 12:13:49 | I [o.a.w.RequestListenerInterface] [17:13:49]: registered listener interface [RequestListenerInterface name=IRedirectListener, method=public abstract void org.apache.wicket.IRedirectListener.onRedirect()] INFO | jvm 1 | 2023/04/24 12:13:49 | I [o.a.w.RequestListenerInterface] [17:13:49]: registered listener interface [RequestListenerInterface name=IResourceListener, method=public abstract void org.apache.wicket.IResourceListener.onResourceRequested()] INFO | jvm 1 | 2023/04/24 12:13:49 | I [o.a.w.Application ] [17:13:49]: [WicketFilter] init: Wicket extensions initializer INFO | jvm 1 | 2023/04/24 12:13:49 | I [IgnitionGateway ] [17:13:49]: Ignition[state=STOPPED] ContextState = STARTING INFO | jvm 1 | 2023/04/24 12:13:49 | I [o.a.w.p.h.WebApplication ] [17:13:49]: [WicketFilter] Started Wicket version 6.30.0 in DEPLOYMENT mode INFO | jvm 1 | 2023/04/24 12:13:49 | I [IgnitionGateway ] [17:13:49]: Starting Ignition 8.1.20 (b2022082313) INFO | jvm 1 | 2023/04/24 12:13:49 | I [IgnitionGateway ] [17:13:49]: Reloading JDBC classloader. r. INFO | jvm 1 | 2023/04/24 12:13:50 | I [o.e.j.s.h.ContextHandler ] [17:13:50]: Started c.i.c.MainWebAppContext@734b758c{Ignition,/,file:///C:/Program%20Files/Inductive%20Automation/Ignition/webserver/webapps/main/,AVAILABLE} INFO | jvm 1 | 2023/04/24 12:13:50 | I [R.S.S.InternalDb ] [17:13:50]: Internal db synchronizer disk cache initialized. State id=8a9f8047-f137-49ac-bded-cb94e2844e54 INFO | jvm 1 | 2023/04/24 12:13:50 | I [R.S.MasterStateManager ] [17:13:50]: Redundancy state changed: Role=Master, Activity level=Undecided, Project state=Unknown, History level=Full INFO | jvm 1 | 2023/04/24 12:13:50 | I [o.e.j.s.AbstractConnector ] [17:13:50]: Started ServerConnector@13de1c34{HTTP/1.1, (http/1.1)}{0.0.0.0:8088} INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp: INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: Encountered an error running main: INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: java.io.IOException: Failed to bind to 0.0.0.0/0.0.0.0:8060 INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at org.eclipse.jetty.server.ServerConnector.openAcceptChannel(ServerConnector.java:349) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at org.eclipse.jetty.server.ServerConnector.open(ServerConnector.java:310) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at org.eclipse.jetty.server.AbstractNetworkConnector.doStart(AbstractNetworkConnector.java:80) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at org.eclipse.jetty.server.ServerConnector.doStart(ServerConnector.java:234) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at org.eclipse.jetty.util.component.AbstractLifeCycle.start(AbstractLifeCycle.java:73) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at org.eclipse.jetty.server.Server.doStart(Server.java:401) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at org.eclipse.jetty.util.component.AbstractLifeCycle.start(AbstractLifeCycle.java:73) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at com.inductiveautomation.catapult.IgnitionServer.start(IgnitionServer.java:1170) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at com.inductiveautomation.ignition.gateway.web.WebResourceManagerImpl.start(WebResourceManagerImpl.java:337) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at com.inductiveautomation.ignition.gateway.IgnitionGateway.start(IgnitionGateway.java:565) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at com.inductiveautomation.ignition.gateway.IgnitionGateway.main(IgnitionGateway.java:297) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at com.inductiveautomation.catapult.Catapult.main(Catapult.java:8) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at java.base/java.lang.reflect.Method.invoke(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at org.tanukisoftware.wrapper.WrapperSimpleApp.run(WrapperSimpleApp.java:349) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at java.base/java.lang.Thread.run(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: Caused by: java.net.BindException: Address already in use: bind INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at java.base/sun.nio.ch.Net.bind0(Native Method) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at java.base/sun.nio.ch.Net.bind(Unknown Source) INFO | jvINFO | jvm 1 | 2023/04/24 12:13:50 | I [o.e.j.s.h.ContextHandler ] [17:13:50]: Started c.i.c.MainWebAppContext@2dc18ffb{Ignition,/,file:///C:/Program%20Files/Inductive%20Automation/Ignition/webserver/webapps/main/,AVAILABLE} INFO | jvm 1 | 2023/04/24 12:13:50 | I [R.S.S.InternalDb ] [17:13:50]: Internal db synchronizer disk cache initialized. State id=8a9f8047-f137-49ac-bded-cb94e2844e54 INFO | jvm 1 | 2023/04/24 12:13:50 | I [R.S.MasterStateManager ] [17:13:50]: Redundancy state changed: Role=Master, Activity level=Undecided, Project state=Unknown, History level=Full INFO | jvm 1 | 2023/04/24 12:13:50 | I [g.InternalDatabaseManager ] [17:13:50]: Starting up... INFO | jvm 1 | 2023/04/24 12:13:50 | I [P.InternalDatabase ] [17:13:50]: Looking for existing internal database "config.idb"... INFO | jvm 1 | 2023/04/24 12:13:50 | I [P.InternalDatabase ] [17:13:50]: ... found existing. INFO | jvm 1 | 2023/04/24 12:13:50 | I [P.InternalDatabase ] [17:13:50]: internal database "config.idb" started up successfully. INFO | jvm 1 | 2023/04/24 12:13:50 | I [P.InternalDatabase ] [17:13:50]: Registering autobackup task [owner=Internal DB Autobackup, name=internal database "config.idb"] INFO | jvm 1 | 2023/04/24 12:13:50 | WARNING: An illegal reflective access operation has occurred INFO | jvm 1 | 2023/04/24 12:13:50 | WARNING: Illegal reflective access by com.inductiveautomation.ignition.gateway.modules.ModuleManagerImpl (file:/C:/Program%20Files/Inductive%20Automation/Ignition/lib/core/gateway/gateway-8.1.20.jar) to field java.lang.ClassLoader.usr_paths INFO | jvm 1 | 2023/04/24 12:13:50 | WARNING: Please consider reporting this to the maintainers of com.inductiveautomation.ignition.gateway.modules.ModuleManagerImpl INFO | jvm 1 | 2023/04/24 12:13:50 | WARNING: Use --illegal-access=warn to enable warnings of further illegal reflective access operations INFO | jvm 1 | 2023/04/24 12:13:50 | WARNING: All illegal access operations will be denied in a future release INFO | jvm 1 | 2023/04/24 12:13:50 | I [o.e.j.s.AbstractConnector ] [17:13:50]: Started ServerConnector@181a3662{SSL, (ssl, http/1.1)}{0.0.0.0:8060} INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp: INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: Encountered an error running main: INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: java.io.IOException: Failed to bind to 0.0.0.0/0.0.0.0:8088 INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at org.eclipse.jetty.server.ServerConnector.openAcceptChannel(ServerConnector.java:349) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at org.eclipse.jetty.server.ServerConnector.open(ServerConnector.java:310) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at org.eclipse.jetty.server.AbstractNetworkConnector.doStart(AbstractNetworkConnector.java:80) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at org.eclipse.jetty.server.ServerConnector.doStart(ServerConnector.java:234) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at org.eclipse.jetty.util.component.AbstractLifeCycle.start(AbstractLifeCycle.java:73) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at org.eclipse.jetty.server.Server.doStart(Server.java:401) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at org.eclipse.jetty.util.component.AbstractLifeCycle.start(AbstractLifeCycle.java:73) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at com.inductiveautomation.catapult.IgnitionServer.start(IgnitionServer.java:1170) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at com.inductiveautomation.ignition.gateway.web.WebResourceManagerImpl.start(WebResourceManagerImpl.java:337) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at com.inductiveautomation.ignition.gateway.IgnitionGateway.start(IgnitionGateway.java:565) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at com.inductiveautomation.ignition.gateway.IgnitionGateway.main(IgnitionGateway.java:297) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at com.inductiveautomation.catapult.Catapult.main(Catapult.java:8) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke0(Native Method) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at java.base/jdk.internal.reflect.NativeMethodAccessorImpl.invoke(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at java.base/jdk.internal.reflect.DelegatingMethodAccessorImpl.invoke(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at java.base/java.lang.reflect.Method.invoke(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at org.tanukisoftware.wrapper.WrapperSimpleApp.run(WrapperSimpleApp.java:349) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at java.base/java.lang.Thread.run(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: Caused by: java.net.BindException: Address already in use: bind INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at java.base/sun.nio.ch.Net.bind0(Native Method) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at java.base/sun.nio.ch.Net.bind(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at java.base/sun.nio.ch.Net.bind(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at java.base/sun.nio.ch.ServerSocketChannelImpl.bind(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at java.base/sun.nio.ch.ServerSocketAdaptor.bind(Unknown Source) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: at org.eclipse.jetty.server.ServerConnector.openAcceptChannel(ServerConnector.java:344) INFO | jvm 1 | 2023/04/24 12:13:50 | WrapperSimpleApp Error: ... 17 more INFO | jvm 1 | 2023/04/24 12:13:51 | I [SystemInfo ] [17:13:51]: os.name="windows server 2022", os.arch="amd64". INFO | jvm 1 | 2023/04/24 12:13:51 | I [SystemInfo ] [17:13:51]: Validating native library "ignition64"... INFO | jvm 1 | 2023/04/24 12:13:51 | I [SystemInfo ] [17:13:51]: Validated ignition64 (ignition64.dll) INFO | jvm 1 | 2023/04/24 12:13:51 | I [SystemInfo ] [17:13:51]: Loading native library "ignition64"... INFO | jvm 1 | 2023/04/24 12:13:51 | I [SystemInfo ] [17:13:51]: Native library load complete INFO | jvm 1 | 2023/04/24 12:13:51 | I [g.ModuleManager ] [17:13:51]: Loading modules.... INFO | jvm 1 | 2023/04/24 12:13:51 | I [SystemInfo ] [17:13:51]: os.name="windows server 2022", os.arch="amd64". INFO | jvm 1 | 2023/04/24 12:13:51 | I [SystemInfo ] [17:13:51]: Validating native library "ignition64"... INFO | jvm 1 | 2023/04/24 12:13:51 | I [SystemInfo ] [17:13:51]: Validated ignition64 (ignition64.dll) INFO | jvm 1 | 2023/04/24 12:13:51 | I [SystemInfo ] [17:13:51]: Loading native library "ignition64"... INFO | jvm 1 | 2023/04/24 12:13:51 | I [SystemInfo ] [17:13:51]: Native library load complete INFO | jvm 1 | 2023/04/24 12:13:51 | I [g.ModuleManager ] [17:13:51]: Loading modules.... STATUS | wrapper | 2023/04/24 12:13:53 | <-- Wrapper Stopped STATUS | wrapper | 2023/04/24 12:13:53 | <-- Wrapper Stopped <<< log entries below here were after starting Ignition service manually >>> STATUS | wrapper | 2023/04/24 12:15:38 | --> Wrapper Started as Service STATUS | wrapper | 2023/04/24 12:15:38 | Java Service Wrapper Standard Edition 64-bit 3.5.42 STATUS | wrapper | 2023/04/24 12:15:38 | Copyright (C) 1999-2020 Tanuki Software, Ltd. All Rights Reserved. STATUS | wrapper | 2023/04/24 12:15:38 | http://wrapper.tanukisoftware.com STATUS | wrapper | 2023/04/24 12:15:38 | Licensed to Inductive Automation for Inductive Automation STATUS | wrapper | 2023/04/24 12:15:38 | STATUS | wrapper | 2023/04/24 12:15:38 | Launching a JVM... INFO | jvm 1 | 2023/04/24 12:15:39 | WrapperManager: Initializing... INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,481 |-INFO in ch.qos.logback.classic.LoggerContext[default] - Found resource [data\\logback.xml] at [file:/C:/Program%20Files/Inductive%20Automation/Ignition/data/logback.xml] INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,560 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - About to instantiate appender of type [ch.qos.logback.core.ConsoleAppender] INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,560 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - Naming appender as [SysoutAppender] INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,575 |-INFO in ch.qos.logback.core.joran.action.NestedComplexPropertyIA - Assuming default type [ch.qos.logback.classic.encoder.PatternLayoutEncoder] for [encoder] property INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,591 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - About to instantiate appender of type [com.inductiveautomation.logging.SQLiteAppender] INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,591 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - Naming appender as [DB] INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,794 |-INFO in ch.qos.logback.core.db.DataSourceConnectionSource@793e6b20 - Driver name=SQLite JDBC INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,794 |-INFO in ch.qos.logback.core.db.DataSourceConnectionSource@793e6b20 - Driver version=3.23.1 INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,794 |-INFO in ch.qos.logback.core.db.DataSourceConnectionSource@793e6b20 - supportsGetGeneratedKeys=true INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,810 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - About to instantiate appender of type [ch.qos.logback.classic.AsyncAppender] INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,810 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - Naming appender as [SysoutAsync] INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,810 |-INFO in ch.qos.logback.core.joran.action.AppenderRefAction - Attaching appender named [SysoutAppender] to ch.qos.logback.classic.AsyncAppender[SysoutAsync] INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,810 |-INFO in ch.qos.logback.classic.AsyncAppender[SysoutAsync] - Attaching appender named [SysoutAppender] to AsyncAppender. INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,810 |-INFO in ch.qos.logback.classic.AsyncAppender[SysoutAsync] - Setting discardingThreshold to 51 INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,810 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - About to instantiate appender of type [ch.qos.logback.classic.AsyncAppender] INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,810 |-INFO in ch.qos.logback.core.joran.action.AppenderAction - Naming appender as [DBAsync] INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,810 |-INFO in ch.qos.logback.core.joran.action.AppenderRefAction - Attaching appender named [DB] to ch.qos.logback.classic.AsyncAppender[DBAsync] INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,810 |-INFO in ch.qos.logback.classic.AsyncAppender[DBAsync] - Attaching appender named [DB] to AsyncAppender. INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,810 |-INFO in ch.qos.logback.classic.AsyncAppender[DBAsync] - Setting discardingThreshold to 51 INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,810 |-INFO in ch.qos.logback.classic.joran.action.RootLoggerAction - Setting level of ROOT logger to INFO INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,810 |-INFO in ch.qos.logback.core.joran.action.AppenderRefAction - Attaching appender named [SysoutAsync] to Logger[ROOT] INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,810 |-INFO in ch.qos.logback.core.joran.action.AppenderRefAction - Attaching appender named [DBAsync] to Logger[ROOT] INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,810 |-INFO in ch.qos.logback.classic.joran.action.ConfigurationAction - End of configuration. INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,810 |-INFO in ch.qos.logback.classic.joran.JoranConfigurator@759e0ee8 - Registering current configuration as safe fallback point INFO | jvm 1 | 2023/04/24 12:15:39 | 12:15:39,841 |-INFO in ch.qos.logback.classic.jul.LevelChangePropagator@4c129711 - Propagating INFO level on Logger[ROOT] onto the JUL framework INFO | jvm 1 | 2023/04/24 12:15:39 | W [WebResourceManagerImpl ] [17:15:39]: Unable to read "gateway.metroKeystoreAlias" gateway.xml property. Assuming metro keystore alias is: metro-key INFO | jvm 1 | 2023/04/24 12:15:40 | I [o.e.j.u.log ] [17:15:40]: Logging initialized @1247ms to org.eclipse.jetty.util.log.Slf4jLog INFO | jvm 1 | 2023/04/24 12:15:40 | I [g.WebServerManager ] [17:15:40]: Starting setup INFO | jvm 1 | 2023/04/24 12:15:40 | I [g.WebServerManager ] [17:15:40]: Setup complete INFO | jvm 1 | 2023/04/24 12:15:40 | I [g.WebServerManager ] [17:15:40]: Starting up INFO | jvm 1 | 2023/04/24 12:15:40 | I [C.SecureRandomProvider ] [17:15:40]: Secure random seed generated in 0ms INFO | jvm 1 | 2023/04/24 12:15:40 | I [o.e.j.s.Server ] [17:15:40]: jetty-9.4.46.v20220331; built: 2022-03-31T16:38:08.030Z; git: bc17a0369a11ecf40bb92c839b9ef0a8ac50ea18; jvm 11.0.15+10-LTS INFO | jvm 1 | 2023/04/24 12:15:40 | I [o.e.j.s.session ] [17:15:40]: DefaultSessionIdManager workerName=node0 INFO | jvm 1 | 2023/04/24 12:15:40 | I [o.e.j.s.session ] [17:15:40]: No SessionScavenger set, using defaults INFO | jvm 1 | 2023/04/24 12:15:40 | I [o.e.j.s.session ] [17:15:40]: node0 Scavenging every 660000ms INFO | jvm 1 | 2023/04/24 12:15:40 | I [o.a.w.Application ] [17:15:40]: [WicketFilter] init: Wicket core library initializer INFO | jvm 1 | 2023/04/24 12:15:40 | I [o.a.w.RequestListenerInterface] [17:15:40]: registered listener interface [RequestListenerInterface name=IBehaviorListener, method=public abstract void org.apache.wicket.behavior.IBehaviorListener.onRequest()] INFO | jvm 1 | 2023/04/24 12:15:40 | I [o.a.w.RequestListenerInterface] [17:15:40]: registered listener interface [RequestListenerInterface name=IFormSubmitListener, method=public abstract void org.apache.wicket.markup.html.form.IFormSubmitListener.onFormSubmitted()] INFO | jvm 1 | 2023/04/24 12:15:40 | I [o.a.w.RequestListenerInterface] [17:15:40]: registered listener interface [RequestListenerInterface name=ILinkListener, method=public abstract void org.apache.wicket.markup.html.link.ILinkListener.onLinkClicked()] INFO | jvm 1 | 2023/04/24 12:15:40 | I [o.a.w.RequestListenerInterface] [17:15:40]: registered listener interface [RequestListenerInterface name=IOnChangeListener, method=public abstract void org.apache.wicket.markup.html.form.IOnChangeListener.onSelectionChanged()] INFO | jvm 1 | 2023/04/24 12:15:40 | I [o.a.w.RequestListenerInterface] [17:15:40]: registered listener interface [RequestListenerInterface name=IRedirectListener, method=public abstract void org.apache.wicket.IRedirectListener.onRedirect()] INFO | jvm 1 | 2023/04/24 12:15:40 | I [o.a.w.RequestListenerInterface] [17:15:40]: registered listener interface [RequestListenerInterface name=IResourceListener, method=public abstract void org.apache.wicket.IResourceListener.onResourceRequested()] INFO | jvm 1 | 2023/04/24 12:15:40 | I [o.a.w.Application ] [17:15:40]: [WicketFilter] init: Wicket extensions initializer INFO | jvm 1 | 2023/04/24 12:15:40 | I [IgnitionGateway ] [17:15:40]: Ignition[state=STOPPED] ContextState = STARTING INFO | jvm 1 | 2023/04/24 12:15:40 | I [o.a.w.p.h.WebApplication ] [17:15:40]: [WicketFilter] Started Wicket version 6.30.0 in DEPLOYMENT mode INFO | jvm 1 | 2023/04/24 12:15:40 | I [IgnitionGateway ] [17:15:40]: Starting Ignition 8.1.20 (b2022082313) INFO | jvm 1 | 2023/04/24 12:15:40 | I [IgnitionGateway ] [17:15:40]: Reloading JDBC classloader. INFO | jvm 1 | 2023/04/24 12:15:40 | I [R.S.S.InternalDb ] [17:15:40]: Internal db synchronizer disk cache initialized. State id=8a9f8047-f137-49ac-bded-cb94e2844e54 INFO | jvm 1 | 2023/04/24 12:15:40 | I [R.S.MasterStateManager ] [17:15:40]: Redundancy state changed: Role=Master, Activity level=Undecided, Project state=Unknown, History level=Full INFO | jvm 1 | 2023/04/24 12:15:40 | I [o.e.j.s.h.ContextHandler ] [17:15:40]: Started c.i.c.MainWebAppContext@51efcd60{Ignition,/,file:///C:/Program%20Files/Inductive%20Automation/Ignition/webserver/webapps/main/,AVAILABLE} INFO | jvm 1 | 2023/04/24 12:15:40 | I [o.e.j.s.AbstractConnector ] [17:15:40]: Started ServerConnector@42ed5fe7{HTTP/1.1, (http/1.1)}{0.0.0.0:8088} INFO | jvm 1 | 2023/04/24 12:15:40 | I [g.InternalDatabaseManager ] [17:15:40]: Starting up... INFO | jvm 1 | 2023/04/24 12:15:40 | I [P.InternalDatabase ] [17:15:40]: Looking for existing internal database "config.idb"... INFO | jvm 1 | 2023/04/24 12:15:40 | I [P.InternalDatabase ] [17:15:40]: ... found existing. INFO | jvm 1 | 2023/04/24 12:15:40 | I [P.InternalDatabase ] [17:15:40]: internal database "config.idb" started up successfully. INFO | jvm 1 | 2023/04/24 12:15:40 | I [P.InternalDatabase ] [17:15:40]: Registering autobackup task [owner=Internal DB Autobackup, name=internal database "config.idb"] INFO | jvm 1 | 2023/04/24 12:15:40 | WARNING: An illegal reflective access operation has occurred INFO | jvm 1 | 2023/04/24 12:15:40 | WARNING: Illegal reflective access by com.inductiveautomation.ignition.gateway.modules.ModuleManagerImpl (file:/C:/Program%20Files/Inductive%20Automation/Ignition/lib/core/gateway/gateway-8.1.20.jar) to field java.lang.ClassLoader.usr_paths INFO | jvm 1 | 2023/04/24 12:15:40 | WARNING: Please consider reporting this to the maintainers of com.inductiveautomation.ignition.gateway.modules.ModuleManagerImpl INFO | jvm 1 | 2023/04/24 12:15:40 | WARNING: Use --illegal-access=warn to enable warnings of further illegal reflective access operations INFO | jvm 1 | 2023/04/24 12:15:40 | WARNING: All illegal access operations will be denied in a future release INFO | jvm 1 | 2023/04/24 12:15:41 | I [o.e.j.s.AbstractConnector ] [17:15:41]: Started ServerConnector@aa8fb33{SSL, (ssl, http/1.1)}{0.0.0.0:8060} INFO | jvm 1 | 2023/04/24 12:15:41 | I [o.e.j.s.Server ] [17:15:41]: Started @2301ms INFO | jvm 1 | 2023/04/24 12:15:41 | I [SystemInfo ] [17:15:41]: os.name="windows server 2022", os.arch="amd64". INFO | jvm 1 | 2023/04/24 12:15:41 | I [SystemInfo ] [17:15:41]: Validating native library "ignition64"... INFO | jvm 1 | 2023/04/24 12:15:41 | I [SystemInfo ] [17:15:41]: Validated ignition64 (ignition64.dll) INFO | jvm 1 | 2023/04/24 12:15:41 | I [SystemInfo ] [17:15:41]: Loading native library "ignition64"... INFO | jvm 1 | 2023/04/24 12:15:41 | I [SystemInfo ] [17:15:41]: Native library load complete INFO | jvm 1 | 2023/04/24 12:15:41 | I [g.ModuleManager ] [17:15:41]: Loading modules.... INFO | jvm 1 | 2023/04/24 12:15:44 | I [A.Notification ] [17:15:44]: Alert notification system created. INFO | jvm 1 | 2023/04/24 12:15:44 | I [g.PersistentRecordSecurityLevelConfigService] [17:15:44]: Set up in 4 ms INFO | jvm 1 | 2023/04/24 12:15:44 | I [g.PersistentRecordIdpAdapterConfigService] [17:15:44]: Set up in 9 ms INFO | jvm 1 | 2023/04/24 12:15:44 | I [g.PersistentRecordIdpAdapterMetricsService] [17:15:44]: Set up in 8 ms INFO | jvm 1 | 2023/04/24 12:15:44 | I [IgnitionGateway ] [17:15:44]: System properties exist in IDB. Checking if system IdP is set... INFO | jvm 1 | 2023/04/24 12:15:44 | I [g.InternalDatabaseRememberedSubjects] [17:15:44]: Set up in 8 ms INFO | jvm 1 | 2023/04/24 12:15:44 | I [g.OIDCProviderManager ] [17:15:44]: Set up in 8 ms INFO | jvm 1 | 2023/04/24 12:15:45 | I [G.Manager ] [17:15:45]: Setting up trust list managers... INFO | jvm 1 | 2023/04/24 12:15:45 | I [G.Manager ] [17:15:45]: Trust list managers setup completed in 76 ms INFO | jvm 1 | 2023/04/24 12:15:46 | I [c.i.i.g.p.r.ProjectRecordConverter] [17:15:45]: Conversion finished. Elapsed time: 18 ms INFO | jvm 1 | 2023/04/24 12:15:50 | I [g.ModuleManager ] [17:15:50]: Setting up modules INFO | jvm 1 | 2023/04/24 12:15:50 | I [G.L.A.AlarmNotificationService] [17:15:50]: Remote Alarm Notification Manager initialized successfully. INFO | jvm 1 | 2023/04/24 12:15:50 | I [c.i.i.g.o.KeyStoreManager ] [17:15:50]: Loading KeyStore at C:\Program Files\Inductive Automation\Ignition\data\opcua\client\security\certificates.pfx INFO | jvm 1 | 2023/04/24 12:15:50 | I [c.i.i.g.o.KeyStoreManager ] [17:15:50]: Loading KeyStore at C:\Program Files\Inductive Automation\Ignition\data\opcua\server\security\certificates.pfx INFO | jvm 1 | 2023/04/24 12:15:50 | I [o.e.m.o.s.s.OpcUaServer ] [17:15:50]: Java version: 11.0.15 INFO | jvm 1 | 2023/04/24 12:15:50 | I [o.e.m.o.s.s.OpcUaServer ] [17:15:50]: Eclipse Milo OPC UA Stack version: 0.6.7 INFO | jvm 1 | 2023/04/24 12:15:50 | I [o.e.m.o.s.s.OpcUaServer ] [17:15:50]: Eclipse Milo OPC UA Server SDK version: 0.6.7 INFO | jvm 1 | 2023/04/24 12:15:52 | I [o.e.m.o.s.s.n.OpcUaNamespace ] [17:15:52]: Loaded 2004 nodes in 627ms. INFO | jvm 1 | 2023/04/24 12:15:52 | I [c.i.o.ModuleHook ] [17:15:52]: JNI Library: C:\Windows\TEMP\__3586943403__jniwrap-3.10.Build.3.109355259c-e29d-47b7-8a0c-