search

libero / editor

Expedite your production workflow with our open tools and management system
MIT License
10 stars 0 forks source link

Docker CLI throws errors when starting #941

Closed GrazingScientist closed 2 years ago

GrazingScientist commented 2 years ago

Description

When running docker-compose up, Mongo DB yells that it cannot found the configuration file /config/initializerJson.json.

The complete error message:

Attaching to editor-mock-service, editor-mongo, transformer, editor-localstack, editor-article-store, editor-pdf-service, editor-client, editor-nginx
editor-client           | /docker-entrypoint.sh: /docker-entrypoint.d/ is not empty, will attempt to perform configuration
editor-client           | /docker-entrypoint.sh: Looking for shell scripts in /docker-entrypoint.d/
editor-localstack       | Waiting for all LocalStack services to be ready
editor-client           | /docker-entrypoint.sh: Launching /docker-entrypoint.d/10-listen-on-ipv6-by-default.sh
editor-mock-service     | 2021-11-04 13:03:41 5.11.1 INFO loading JSON initialization file:
editor-mock-service     | 
editor-mock-service     |   /config/initializerJson.json
editor-mock-service     |  
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:40.820+00:00"},"s":"I",  "c":"NETWORK",  "id":4915701, "ctx":"-","msg":"Initialized wire specification","attr":{"spec":{"incomingExternalClient":{"minWireVersion":0,"maxWireVersion":13},"incomingInternalClient":{"minWireVersion":0,"maxWireVersion":13},"outgoing":{"minWireVersion":0,"maxWireVersion":13},"isInternalClient":true}}}
editor-mock-service     | 2021-11-04 13:03:41 5.11.1 WARNING exception while loading JSON initialization file, ignoring file 
editor-mock-service     | java.lang.RuntimeException: Exception while loading "/config/initializerJson.json"
editor-mock-service     |   at org.mockserver.file.FileReader.readFileFromClassPathOrPath(FileReader.java:24)
editor-mock-service     |   at org.mockserver.server.initialize.ExpectationInitializerLoader.retrieveExpectationsFromJson(ExpectationInitializerLoader.java:83)
editor-mock-service     |   at org.mockserver.server.initialize.ExpectationInitializerLoader.loadExpectations(ExpectationInitializerLoader.java:115)
editor-mock-service     |   at org.mockserver.server.initialize.ExpectationInitializerLoader.addExpectationsFromInitializer(ExpectationInitializerLoader.java:37)
editor-mock-service     |   at org.mockserver.server.initialize.ExpectationInitializerLoader.<init>(ExpectationInitializerLoader.java:33)
editor-mock-service     |   at org.mockserver.mock.HttpState.<init>(HttpState.java:119)
editor-mock-service     |   at org.mockserver.lifecycle.LifeCycle.<init>(LifeCycle.java:48)
editor-mock-service     |   at org.mockserver.netty.MockServer.<init>(MockServer.java:50)
editor-mock-service     |   at org.mockserver.netty.MockServer.<init>(MockServer.java:41)
editor-mock-service     |   at org.mockserver.cli.Main.main(Main.java:100)
editor-mock-service     | Caused by: java.io.FileNotFoundException: /config/initializerJson.json (No such file or directory)
editor-mock-service     |   at java.base/java.io.FileInputStream.open0(Native Method)
editor-mock-service     |   at java.base/java.io.FileInputStream.open(FileInputStream.java:219)
editor-mock-service     |   at java.base/java.io.FileInputStream.<init>(FileInputStream.java:157)
editor-mock-service     |   at java.base/java.io.FileInputStream.<init>(FileInputStream.java:112)
editor-mock-service     |   at org.mockserver.file.FileReader.openStreamToFileFromClassPathOrPath(FileReader.java:32)
editor-mock-service     |   at org.mockserver.file.FileReader.readFileFromClassPathOrPath(FileReader.java:21)
editor-mock-service     |   ... 9 more
editor-mock-service     | 
....

A little later another problem comes up (not from Mongo, but from the article store):

editor-article-store    | Connected to DB.
editor-article-store    | Creating changes indexes...
editor-article-store    | Connected to DB.
editor-article-store    | Creating articles indexes...
editor-article-store    | Server listening on port 8080
editor-article-store    | SQS - Error interacting with queue -  SQSError: SQS receive message failed: Inaccessible host: `editor-localstack'. This service may not be available in the `eu-west-1' region.
editor-article-store    |     at toSQSError (/node_modules/sqs-consumer/dist/consumer.js:41:22)
editor-article-store    |     at Consumer.receiveMessage (/node_modules/sqs-consumer/dist/consumer.js:137:19)
editor-article-store    |     at processTicksAndRejections (internal/process/task_queues.js:95:5) {
editor-article-store    |   code: 'UnknownEndpoint',
editor-article-store    |   statusCode: undefined,
editor-article-store    |   region: 'eu-west-1',
editor-article-store    |   retryable: true,
editor-article-store    |   hostname: 'editor-localstack',
editor-article-store    |   time: 2021-11-04T13:03:42.820Z
editor-article-store    | }

Followed by an endless repetition of:

editor-article-store    | SQS - Error interacting with queue -  SQSError: SQS receive message failed: The specified queue does not exist for this wsdl version.
editor-article-store    |     at toSQSError (/node_modules/sqs-consumer/dist/consumer.js:41:22)
editor-article-store    |     at Consumer.receiveMessage (/node_modules/sqs-consumer/dist/consumer.js:137:19)
editor-article-store    |     at processTicksAndRejections (internal/process/task_queues.js:95:5) {
editor-article-store    |   code: 'AWS.SimpleQueueService.NonExistentQueue',
editor-article-store    |   statusCode: 400,
editor-article-store    |   region: undefined,
editor-article-store    |   retryable: false,
editor-article-store    |   hostname: undefined,
editor-article-store    |   time: 2021-11-04T13:03:52.939Z
editor-article-store    | }

What are the Steps to Reproduce to issue?

Although it should not matter in a Docker environment: I use Ubuntu 20.20 with Docker version 20.10.10, build b485636 and docker-compose version 1.29.2, build 5becea4c.

I will post the complete output in the next post.

GrazingScientist commented 2 years ago

Complete output (at least to the point where the CLI throws the same error over and over again):

> docker-compose up

Starting editor-mongo        ... done
Starting editor-localstack   ... done
Starting editor-mock-service ... done
Starting transformer         ... done
Starting editor-article-store ... done
Starting editor-client        ... done
Starting editor-pdf-service   ... done
Starting editor-nginx         ... done
Attaching to editor-mock-service, editor-mongo, transformer, editor-localstack, editor-article-store, editor-pdf-service, editor-client, editor-nginx
editor-client           | /docker-entrypoint.sh: /docker-entrypoint.d/ is not empty, will attempt to perform configuration
editor-client           | /docker-entrypoint.sh: Looking for shell scripts in /docker-entrypoint.d/
editor-localstack       | Waiting for all LocalStack services to be ready
editor-client           | /docker-entrypoint.sh: Launching /docker-entrypoint.d/10-listen-on-ipv6-by-default.sh
editor-mock-service     | 2021-11-04 13:03:41 5.11.1 INFO loading JSON initialization file:
editor-mock-service     | 
editor-mock-service     |   /config/initializerJson.json
editor-mock-service     |  
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:40.820+00:00"},"s":"I",  "c":"NETWORK",  "id":4915701, "ctx":"-","msg":"Initialized wire specification","attr":{"spec":{"incomingExternalClient":{"minWireVersion":0,"maxWireVersion":13},"incomingInternalClient":{"minWireVersion":0,"maxWireVersion":13},"outgoing":{"minWireVersion":0,"maxWireVersion":13},"isInternalClient":true}}}
editor-mock-service     | 2021-11-04 13:03:41 5.11.1 WARNING exception while loading JSON initialization file, ignoring file 
editor-mock-service     | java.lang.RuntimeException: Exception while loading "/config/initializerJson.json"
editor-mock-service     |   at org.mockserver.file.FileReader.readFileFromClassPathOrPath(FileReader.java:24)
editor-mock-service     |   at org.mockserver.server.initialize.ExpectationInitializerLoader.retrieveExpectationsFromJson(ExpectationInitializerLoader.java:83)
editor-mock-service     |   at org.mockserver.server.initialize.ExpectationInitializerLoader.loadExpectations(ExpectationInitializerLoader.java:115)
editor-mock-service     |   at org.mockserver.server.initialize.ExpectationInitializerLoader.addExpectationsFromInitializer(ExpectationInitializerLoader.java:37)
editor-mock-service     |   at org.mockserver.server.initialize.ExpectationInitializerLoader.<init>(ExpectationInitializerLoader.java:33)
editor-mock-service     |   at org.mockserver.mock.HttpState.<init>(HttpState.java:119)
editor-mock-service     |   at org.mockserver.lifecycle.LifeCycle.<init>(LifeCycle.java:48)
editor-mock-service     |   at org.mockserver.netty.MockServer.<init>(MockServer.java:50)
editor-mock-service     |   at org.mockserver.netty.MockServer.<init>(MockServer.java:41)
editor-mock-service     |   at org.mockserver.cli.Main.main(Main.java:100)
editor-mock-service     | Caused by: java.io.FileNotFoundException: /config/initializerJson.json (No such file or directory)
editor-mock-service     |   at java.base/java.io.FileInputStream.open0(Native Method)
editor-mock-service     |   at java.base/java.io.FileInputStream.open(FileInputStream.java:219)
editor-mock-service     |   at java.base/java.io.FileInputStream.<init>(FileInputStream.java:157)
editor-mock-service     |   at java.base/java.io.FileInputStream.<init>(FileInputStream.java:112)
editor-mock-service     |   at org.mockserver.file.FileReader.openStreamToFileFromClassPathOrPath(FileReader.java:32)
editor-mock-service     |   at org.mockserver.file.FileReader.readFileFromClassPathOrPath(FileReader.java:21)
editor-mock-service     |   ... 9 more
editor-mock-service     | 
editor-client           | 10-listen-on-ipv6-by-default.sh: info: IPv6 listen already enabled
editor-nginx            | /docker-entrypoint.sh: /docker-entrypoint.d/ is not empty, will attempt to perform configuration
editor-nginx            | /docker-entrypoint.sh: Looking for shell scripts in /docker-entrypoint.d/
editor-localstack       | 2021-11-04 13:03:41,388 CRIT Supervisor is running as root.  Privileges were not dropped because no user is specified in the config file.  If you intend to run as root, you can set user=root in the config file to avoid this message.
editor-localstack       | 2021-11-04 13:03:41,404 INFO supervisord started with pid 16
editor-nginx            | /docker-entrypoint.sh: Launching /docker-entrypoint.d/10-listen-on-ipv6-by-default.sh
editor-client           | /docker-entrypoint.sh: Launching /docker-entrypoint.d/20-envsubst-on-templates.sh
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:40.828+00:00"},"s":"I",  "c":"CONTROL",  "id":23285,   "ctx":"main","msg":"Automatically disabling TLS 1.0, to force-enable TLS 1.0 specify --sslDisabledProtocols 'none'"}
editor-mock-service     | 2021-11-04 13:03:41 5.11.1 INFO 1080 started on port: 1080 
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:40.829+00:00"},"s":"W",  "c":"ASIO",     "id":22601,   "ctx":"main","msg":"No TransportLayer configured during NetworkInterface startup"}
editor-pdf-service      | Starting server...
editor-localstack       | 2021-11-04 13:03:42,406 INFO spawned: 'infra' with pid 22
editor-client           | /docker-entrypoint.sh: Launching /docker-entrypoint.d/30-tune-worker-processes.sh
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:40.829+00:00"},"s":"I",  "c":"NETWORK",  "id":4648601, "ctx":"main","msg":"Implicit TCP FastOpen unavailable. If TCP FastOpen is required, set tcpFastOpenServer, tcpFastOpenClient, and tcpFastOpenQueueSize."}
transformer             | /srv/basex/.basex could not be written.
editor-mock-service     | 2021-11-04 13:03:41 5.11.1 INFO logger level is INFO, change using:
editor-mock-service     |  - 'ConfigurationProperties.logLevel(String level)' in Java code,
editor-mock-service     |  - '-logLevel' command line argument,
editor-mock-service     |  - 'mockserver.logLevel' JVM system property or,
editor-mock-service     |  - 'mockserver.logLevel' property value in 'mockserver.properties' 
editor-pdf-service      | Server listening on port 4001
transformer             | /srv/basex/.basex: line "General Options" ignored.
transformer             | /srv/basex/.basex: writing new configuration file.
editor-nginx            | 10-listen-on-ipv6-by-default.sh: info: IPv6 listen already enabled
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:40.831+00:00"},"s":"W",  "c":"ASIO",     "id":22601,   "ctx":"main","msg":"No TransportLayer configured during NetworkInterface startup"}
transformer             | BaseX 9.5.2 beta [HTTP Server]
editor-nginx            | /docker-entrypoint.sh: Launching /docker-entrypoint.d/20-envsubst-on-templates.sh
editor-client           | /docker-entrypoint.sh: Configuration complete; ready for start up
transformer             | [main] INFO org.eclipse.jetty.util.log - Logging initialized @534ms to org.eclipse.jetty.util.log.Slf4jLog
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:40.832+00:00"},"s":"I",  "c":"REPL",     "id":5123008, "ctx":"main","msg":"Successfully registered PrimaryOnlyService","attr":{"service":"TenantMigrationDonorService","ns":"config.tenantMigrationDonors"}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:40.832+00:00"},"s":"I",  "c":"REPL",     "id":5123008, "ctx":"main","msg":"Successfully registered PrimaryOnlyService","attr":{"service":"TenantMigrationRecipientService","ns":"config.tenantMigrationRecipients"}}
editor-nginx            | 20-envsubst-on-templates.sh: Running envsubst on /etc/nginx/templates/nginx.conf.template to /etc/nginx/nginx.conf
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:40.832+00:00"},"s":"I",  "c":"CONTROL",  "id":4615611, "ctx":"initandlisten","msg":"MongoDB starting","attr":{"pid":1,"port":27017,"dbPath":"/data/db","architecture":"64-bit","host":"45b44e854d0e"}}
editor-client           | 2021/11/04 13:03:42 [notice] 1#1: using the "epoll" event method
transformer             | [main] INFO org.eclipse.jetty.server.Server - jetty-9.4.38.v20210224; built: 2021-02-24T20:25:07.675Z; git: 288f3cc74549e8a913bf363250b0744f2695b8e6; jvm 1.8.0_212-b04
editor-client           | 2021/11/04 13:03:42 [notice] 1#1: nginx/1.21.3
editor-client           | 2021/11/04 13:03:42 [notice] 1#1: built by gcc 10.3.1 20210424 (Alpine 10.3.1_git20210424) 
editor-client           | 2021/11/04 13:03:42 [notice] 1#1: OS: Linux 5.11.0-38-generic
editor-client           | 2021/11/04 13:03:42 [notice] 1#1: getrlimit(RLIMIT_NOFILE): 1048576:1048576
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:40.832+00:00"},"s":"I",  "c":"CONTROL",  "id":23403,   "ctx":"initandlisten","msg":"Build Info","attr":{"buildInfo":{"version":"5.0.3","gitVersion":"657fea5a61a74d7a79df7aff8e4bcf0bc742b748","openSSLVersion":"OpenSSL 1.1.1f  31 Mar 2020","modules":[],"allocator":"tcmalloc","environment":{"distmod":"ubuntu2004","distarch":"x86_64","target_arch":"x86_64"}}}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:40.832+00:00"},"s":"I",  "c":"CONTROL",  "id":51765,   "ctx":"initandlisten","msg":"Operating System","attr":{"os":{"name":"Ubuntu","version":"20.04"}}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:40.832+00:00"},"s":"I",  "c":"CONTROL",  "id":21951,   "ctx":"initandlisten","msg":"Options set by command line","attr":{"options":{"net":{"bindIp":"*"},"security":{"authorization":"enabled"}}}}
editor-client           | 2021/11/04 13:03:42 [notice] 1#1: start worker processes
editor-client           | 2021/11/04 13:03:42 [notice] 1#1: start worker process 24
editor-client           | 2021/11/04 13:03:42 [notice] 1#1: start worker process 25
editor-client           | 2021/11/04 13:03:42 [notice] 1#1: start worker process 26
editor-client           | 2021/11/04 13:03:42 [notice] 1#1: start worker process 27
transformer             | [main] INFO org.eclipse.jetty.webapp.StandardDescriptorProcessor - NO JSP Support for /, did not find org.eclipse.jetty.jsp.JettyJspServlet
editor-client           | 2021/11/04 13:03:42 [notice] 1#1: start worker process 28
transformer             | [main] INFO org.eclipse.jetty.server.session - DefaultSessionIdManager workerName=node0
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:40.834+00:00"},"s":"I",  "c":"STORAGE",  "id":22270,   "ctx":"initandlisten","msg":"Storage engine to use detected by data files","attr":{"dbpath":"/data/db","storageEngine":"wiredTiger"}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:40.834+00:00"},"s":"I",  "c":"STORAGE",  "id":22297,   "ctx":"initandlisten","msg":"Using the XFS filesystem is strongly recommended with the WiredTiger storage engine. See http://dochub.mongodb.org/core/prodnotes-filesystem","tags":["startupWarnings"]}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:40.834+00:00"},"s":"I",  "c":"STORAGE",  "id":22315,   "ctx":"initandlisten","msg":"Opening WiredTiger","attr":{"config":"create,cache_size=7322M,session_max=33000,eviction=(threads_min=4,threads_max=4),config_base=false,statistics=(fast),log=(enabled=true,archive=true,path=journal,compressor=snappy),builtin_extension_config=(zstd=(compression_level=6)),file_manager=(close_idle_time=600,close_scan_interval=10,close_handle_minimum=250),statistics_log=(wait=0),verbose=[recovery_progress,checkpoint_progress,compact_progress],"}}
editor-client           | 2021/11/04 13:03:42 [notice] 1#1: start worker process 29
transformer             | [main] INFO org.eclipse.jetty.server.session - No SessionScavenger set, using defaults
editor-client           | 2021/11/04 13:03:42 [notice] 1#1: start worker process 30
editor-client           | 2021/11/04 13:03:42 [notice] 1#1: start worker process 31
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:41.351+00:00"},"s":"I",  "c":"STORAGE",  "id":22430,   "ctx":"initandlisten","msg":"WiredTiger message","attr":{"message":"[1636031021:351139][1:0x7f78c0ef2c80], txn-recover: [WT_VERB_RECOVERY_PROGRESS] Recovering log 3 through 4"}}
editor-nginx            | /docker-entrypoint.sh: Launching /docker-entrypoint.d/30-tune-worker-processes.sh
transformer             | [main] INFO org.eclipse.jetty.server.session - node0 Scavenging every 660000ms
editor-nginx            | /docker-entrypoint.sh: Configuration complete; ready for start up
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:41.469+00:00"},"s":"I",  "c":"STORAGE",  "id":22430,   "ctx":"initandlisten","msg":"WiredTiger message","attr":{"message":"[1636031021:469073][1:0x7f78c0ef2c80], txn-recover: [WT_VERB_RECOVERY_PROGRESS] Recovering log 4 through 4"}}
transformer             | Server was started (port: 1984).
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:41.613+00:00"},"s":"I",  "c":"STORAGE",  "id":22430,   "ctx":"initandlisten","msg":"WiredTiger message","attr":{"message":"[1636031021:613322][1:0x7f78c0ef2c80], txn-recover: [WT_VERB_RECOVERY | WT_VERB_RECOVERY_PROGRESS] Main recovery loop: starting at 3/5248 to 4/256"}}
transformer             | [main] INFO org.eclipse.jetty.server.handler.ContextHandler - Started o.e.j.w.WebAppContext@1cab0bfb{BaseX: The XML Database and XQuery Processor,/,file:///srv/basex/webapp/,AVAILABLE}{/srv/basex/webapp}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:41.755+00:00"},"s":"I",  "c":"STORAGE",  "id":22430,   "ctx":"initandlisten","msg":"WiredTiger message","attr":{"message":"[1636031021:755803][1:0x7f78c0ef2c80], txn-recover: [WT_VERB_RECOVERY_PROGRESS] Recovering log 3 through 4"}}
transformer             | [main] INFO org.eclipse.jetty.server.AbstractConnector - Started ServerConnector@18be83e4{HTTP/1.1, (http/1.1)}{0.0.0.0:8984}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:41.814+00:00"},"s":"I",  "c":"STORAGE",  "id":22430,   "ctx":"initandlisten","msg":"WiredTiger message","attr":{"message":"[1636031021:814575][1:0x7f78c0ef2c80], txn-recover: [WT_VERB_RECOVERY_PROGRESS] Recovering log 4 through 4"}}
transformer             | [main] INFO org.eclipse.jetty.server.Server - Started @1260ms
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:41.862+00:00"},"s":"I",  "c":"STORAGE",  "id":22430,   "ctx":"initandlisten","msg":"WiredTiger message","attr":{"message":"[1636031021:862887][1:0x7f78c0ef2c80], txn-recover: [WT_VERB_RECOVERY | WT_VERB_RECOVERY_PROGRESS] Set global recovery timestamp: (0, 0)"}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:41.862+00:00"},"s":"I",  "c":"STORAGE",  "id":22430,   "ctx":"initandlisten","msg":"WiredTiger message","attr":{"message":"[1636031021:862928][1:0x7f78c0ef2c80], txn-recover: [WT_VERB_RECOVERY | WT_VERB_RECOVERY_PROGRESS] Set global oldest timestamp: (0, 0)"}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:41.866+00:00"},"s":"I",  "c":"STORAGE",  "id":22430,   "ctx":"initandlisten","msg":"WiredTiger message","attr":{"message":"[1636031021:866628][1:0x7f78c0ef2c80], WT_SESSION.checkpoint: [WT_VERB_CHECKPOINT_PROGRESS] saving checkpoint snapshot min: 1, snapshot max: 1 snapshot count: 0, oldest timestamp: (0, 0) , meta checkpoint timestamp: (0, 0) base write gen: 30"}}
transformer             | HTTP STOP Server was started (port: 8985).
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:41.875+00:00"},"s":"I",  "c":"STORAGE",  "id":4795906, "ctx":"initandlisten","msg":"WiredTiger opened","attr":{"durationMillis":1041}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:41.875+00:00"},"s":"I",  "c":"RECOVERY", "id":23987,   "ctx":"initandlisten","msg":"WiredTiger recoveryTimestamp","attr":{"recoveryTimestamp":{"$timestamp":{"t":0,"i":0}}}}
transformer             | HTTP Server was started (port: 8984).
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:41.877+00:00"},"s":"I",  "c":"STORAGE",  "id":4366408, "ctx":"initandlisten","msg":"No table logging settings modifications are required for existing WiredTiger tables","attr":{"loggingEnabled":true}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:41.879+00:00"},"s":"I",  "c":"STORAGE",  "id":22262,   "ctx":"initandlisten","msg":"Timestamp monitor starting"}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:41.892+00:00"},"s":"I",  "c":"NETWORK",  "id":4915702, "ctx":"initandlisten","msg":"Updated wire specification","attr":{"oldSpec":{"incomingExternalClient":{"minWireVersion":0,"maxWireVersion":13},"incomingInternalClient":{"minWireVersion":0,"maxWireVersion":13},"outgoing":{"minWireVersion":0,"maxWireVersion":13},"isInternalClient":true},"newSpec":{"incomingExternalClient":{"minWireVersion":0,"maxWireVersion":13},"incomingInternalClient":{"minWireVersion":13,"maxWireVersion":13},"outgoing":{"minWireVersion":13,"maxWireVersion":13},"isInternalClient":true}}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:41.892+00:00"},"s":"I",  "c":"STORAGE",  "id":5071100, "ctx":"initandlisten","msg":"Clearing temp directory"}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:41.893+00:00"},"s":"I",  "c":"CONTROL",  "id":20536,   "ctx":"initandlisten","msg":"Flow Control is enabled on this deployment"}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:41.894+00:00"},"s":"I",  "c":"FTDC",     "id":20625,   "ctx":"initandlisten","msg":"Initializing full-time diagnostic data capture","attr":{"dataDirectory":"/data/db/diagnostic.data"}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:41.898+00:00"},"s":"I",  "c":"NETWORK",  "id":23015,   "ctx":"listener","msg":"Listening on","attr":{"address":"/tmp/mongodb-27017.sock"}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:41.898+00:00"},"s":"I",  "c":"NETWORK",  "id":23015,   "ctx":"listener","msg":"Listening on","attr":{"address":"0.0.0.0"}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:41.898+00:00"},"s":"I",  "c":"NETWORK",  "id":23016,   "ctx":"listener","msg":"Waiting for connections","attr":{"port":27017,"ssl":"off"}}
editor-article-store    | Starting import listener...
editor-article-store    | Connecting to DB...
editor-article-store    | Starting server...
editor-article-store    | Connecting to DB...
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:42.520+00:00"},"s":"I",  "c":"NETWORK",  "id":22943,   "ctx":"listener","msg":"Connection accepted","attr":{"remote":"172.19.0.6:38070","uuid":"585751f5-4aec-4a0d-8ff2-d5ea63fd1064","connectionId":1,"connectionCount":1}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:42.520+00:00"},"s":"I",  "c":"NETWORK",  "id":22943,   "ctx":"listener","msg":"Connection accepted","attr":{"remote":"172.19.0.6:38072","uuid":"caa75638-66d7-443e-a33c-951f59faee6d","connectionId":2,"connectionCount":2}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:42.525+00:00"},"s":"I",  "c":"NETWORK",  "id":51800,   "ctx":"conn1","msg":"client metadata","attr":{"remote":"172.19.0.6:38070","client":"conn1","doc":{"driver":{"name":"nodejs","version":"3.6.2"},"os":{"type":"Linux","name":"linux","architecture":"x64","version":"5.11.0-38-generic"},"platform":"'Node.js v14.18.1, LE (unified)"}}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:42.526+00:00"},"s":"I",  "c":"NETWORK",  "id":51800,   "ctx":"conn2","msg":"client metadata","attr":{"remote":"172.19.0.6:38072","client":"conn2","doc":{"driver":{"name":"nodejs","version":"3.6.2"},"os":{"type":"Linux","name":"linux","architecture":"x64","version":"5.11.0-38-generic"},"platform":"'Node.js v14.18.1, LE (unified)"}}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:42.532+00:00"},"s":"I",  "c":"NETWORK",  "id":22943,   "ctx":"listener","msg":"Connection accepted","attr":{"remote":"172.19.0.6:38074","uuid":"ce034543-7496-45f7-be99-b18ee3e06612","connectionId":3,"connectionCount":3}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:42.533+00:00"},"s":"I",  "c":"NETWORK",  "id":22943,   "ctx":"listener","msg":"Connection accepted","attr":{"remote":"172.19.0.6:38076","uuid":"e26ec986-5c7b-4cda-87d2-03de71eff493","connectionId":4,"connectionCount":4}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:42.535+00:00"},"s":"I",  "c":"NETWORK",  "id":51800,   "ctx":"conn3","msg":"client metadata","attr":{"remote":"172.19.0.6:38074","client":"conn3","doc":{"driver":{"name":"nodejs","version":"3.6.2"},"os":{"type":"Linux","name":"linux","architecture":"x64","version":"5.11.0-38-generic"},"platform":"'Node.js v14.18.1, LE (unified)"}}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:42.536+00:00"},"s":"I",  "c":"NETWORK",  "id":51800,   "ctx":"conn4","msg":"client metadata","attr":{"remote":"172.19.0.6:38076","client":"conn4","doc":{"driver":{"name":"nodejs","version":"3.6.2"},"os":{"type":"Linux","name":"linux","architecture":"x64","version":"5.11.0-38-generic"},"platform":"'Node.js v14.18.1, LE (unified)"}}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:42.550+00:00"},"s":"I",  "c":"ACCESS",   "id":20250,   "ctx":"conn3","msg":"Authentication succeeded","attr":{"mechanism":"SCRAM-SHA-256","speculative":true,"principalName":"root","authenticationDatabase":"admin","remote":"172.19.0.6:38074","extraInfo":{}}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:42.551+00:00"},"s":"I",  "c":"ACCESS",   "id":20250,   "ctx":"conn4","msg":"Authentication succeeded","attr":{"mechanism":"SCRAM-SHA-256","speculative":true,"principalName":"root","authenticationDatabase":"admin","remote":"172.19.0.6:38076","extraInfo":{}}}
editor-article-store    | Connected to DB.
editor-article-store    | Creating changes indexes...
editor-article-store    | Connected to DB.
editor-article-store    | Creating articles indexes...
editor-article-store    | Server listening on port 8080
editor-article-store    | SQS - Error interacting with queue -  SQSError: SQS receive message failed: Inaccessible host: `editor-localstack'. This service may not be available in the `eu-west-1' region.
editor-article-store    |     at toSQSError (/node_modules/sqs-consumer/dist/consumer.js:41:22)
editor-article-store    |     at Consumer.receiveMessage (/node_modules/sqs-consumer/dist/consumer.js:137:19)
editor-article-store    |     at processTicksAndRejections (internal/process/task_queues.js:95:5) {
editor-article-store    |   code: 'UnknownEndpoint',
editor-article-store    |   statusCode: undefined,
editor-article-store    |   region: 'eu-west-1',
editor-article-store    |   retryable: true,
editor-article-store    |   hostname: 'editor-localstack',
editor-article-store    |   time: 2021-11-04T13:03:42.820Z
editor-article-store    | }
editor-localstack       | (. .venv/bin/activate; exec bin/localstack start --host --no-banner)
editor-localstack       | 2021-11-04 13:03:43,412 INFO success: infra entered RUNNING state, process has stayed up for > than 1 seconds (startsecs)
editor-localstack       | Waiting for all LocalStack services to be ready
editor-localstack       | 
editor-localstack       | LocalStack version: 0.12.19.1
editor-localstack       | LocalStack build date: 2021-11-01
editor-localstack       | LocalStack build git hash: c49f2b0a
editor-localstack       | 
editor-localstack       | Starting edge router (https port 4566)...
editor-localstack       | 2021-11-04T13:03:49:INFO:bootstrap.py: Execution of "prepare_environment" took 548.83ms
editor-localstack       | [2021-11-04 13:03:49 +0000] [23] [INFO] Running on https://0.0.0.0:4566 (CTRL + C to quit)
editor-localstack       | 2021-11-04T13:03:49:INFO:hypercorn.error: Running on https://0.0.0.0:4566 (CTRL + C to quit)
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:50.883+00:00"},"s":"I",  "c":"NETWORK",  "id":22943,   "ctx":"listener","msg":"Connection accepted","attr":{"remote":"172.19.0.3:51268","uuid":"b003d76e-f22e-4065-af5f-c7a672c79427","connectionId":5,"connectionCount":5}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:50.883+00:00"},"s":"I",  "c":"NETWORK",  "id":51800,   "ctx":"conn5","msg":"client metadata","attr":{"remote":"172.19.0.3:51268","client":"conn5","doc":{"application":{"name":"MongoDB Shell"},"driver":{"name":"MongoDB Internal Client","version":"5.0.3"},"os":{"type":"Linux","name":"Ubuntu","architecture":"x86_64","version":"20.04"}}}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:50.895+00:00"},"s":"I",  "c":"NETWORK",  "id":22944,   "ctx":"conn5","msg":"Connection ended","attr":{"remote":"172.19.0.3:51268","uuid":"b003d76e-f22e-4065-af5f-c7a672c79427","connectionId":5,"connectionCount":4}}
editor-localstack       | 2021-11-04T13:03:50:INFO:bootstrap.py: Execution of "_load_service_plugin" took 701.77ms
editor-localstack       | 2021-11-04T13:03:50:INFO:bootstrap.py: Execution of "require" took 702.00ms
editor-localstack       | 2021-11-04T13:03:52:INFO:bootstrap.py: Execution of "_load_service_plugin" took 2276.26ms
editor-localstack       | 2021-11-04T13:03:52:INFO:bootstrap.py: Execution of "require" took 2276.44ms
editor-localstack       | 2021-11-04T13:03:52:INFO:localstack.services.motoserver: starting moto server on http://0.0.0.0:40785
editor-localstack       | 2021-11-04T13:03:52:INFO:localstack.services.infra: Starting mock S3 service on http port 4566 ...
editor-localstack       | 2021-11-04T13:03:52:INFO:localstack.services.infra: Starting mock SQS service on http port 4566 ...
editor-article-store    | SQS - Error interacting with queue -  SQSError: SQS receive message failed: The specified queue does not exist for this wsdl version.
editor-article-store    |     at toSQSError (/node_modules/sqs-consumer/dist/consumer.js:41:22)
editor-article-store    |     at Consumer.receiveMessage (/node_modules/sqs-consumer/dist/consumer.js:137:19)
editor-article-store    |     at processTicksAndRejections (internal/process/task_queues.js:95:5) {
editor-article-store    |   code: 'AWS.SimpleQueueService.NonExistentQueue',
editor-article-store    |   statusCode: 400,
editor-article-store    |   region: undefined,
editor-article-store    |   retryable: false,
editor-article-store    |   hostname: undefined,
editor-article-store    |   time: 2021-11-04T13:03:52.939Z
editor-article-store    | }
editor-article-store    | SQS - Error interacting with queue -  SQSError: SQS receive message failed: The specified queue does not exist for this wsdl version.
editor-article-store    |     at toSQSError (/node_modules/sqs-consumer/dist/consumer.js:41:22)
editor-article-store    |     at Consumer.receiveMessage (/node_modules/sqs-consumer/dist/consumer.js:137:19)
editor-article-store    |     at processTicksAndRejections (internal/process/task_queues.js:95:5) {
editor-article-store    |   code: 'AWS.SimpleQueueService.NonExistentQueue',
editor-article-store    |   statusCode: 400,
editor-article-store    |   region: undefined,
editor-article-store    |   retryable: false,
editor-article-store    |   hostname: undefined,
editor-article-store    |   time: 2021-11-04T13:03:52.970Z
editor-article-store    | }
editor-article-store    | SQS - Error interacting with queue -  SQSError: SQS receive message failed: The specified queue does not exist for this wsdl version.
editor-article-store    |     at toSQSError (/node_modules/sqs-consumer/dist/consumer.js:41:22)
editor-article-store    |     at Consumer.receiveMessage (/node_modules/sqs-consumer/dist/consumer.js:137:19)
editor-article-store    |     at processTicksAndRejections (internal/process/task_queues.js:95:5) {
editor-article-store    |   code: 'AWS.SimpleQueueService.NonExistentQueue',
editor-article-store    |   statusCode: 400,
editor-article-store    |   region: undefined,
editor-article-store    |   retryable: false,
editor-article-store    |   hostname: undefined,
editor-article-store    |   time: 2021-11-04T13:03:52.984Z
editor-article-store    | }
editor-article-store    | SQS - Error interacting with queue -  SQSError: SQS receive message failed: The specified queue does not exist for this wsdl version.
editor-article-store    |     at toSQSError (/node_modules/sqs-consumer/dist/consumer.js:41:22)
editor-article-store    |     at Consumer.receiveMessage (/node_modules/sqs-consumer/dist/consumer.js:137:19)
editor-article-store    |     at processTicksAndRejections (internal/process/task_queues.js:95:5) {
editor-article-store    |   code: 'AWS.SimpleQueueService.NonExistentQueue',
editor-article-store    |   statusCode: 400,
editor-article-store    |   region: undefined,
editor-article-store    |   retryable: false,
editor-article-store    |   hostname: undefined,
editor-article-store    |   time: 2021-11-04T13:03:53.000Z
editor-article-store    | }
editor-article-store    | SQS - Error interacting with queue -  SQSError: SQS receive message failed: The specified queue does not exist for this wsdl version.
editor-article-store    |     at toSQSError (/node_modules/sqs-consumer/dist/consumer.js:41:22)
editor-article-store    |     at Consumer.receiveMessage (/node_modules/sqs-consumer/dist/consumer.js:137:19)
editor-article-store    |     at processTicksAndRejections (internal/process/task_queues.js:95:5) {
editor-article-store    |   code: 'AWS.SimpleQueueService.NonExistentQueue',
editor-article-store    |   statusCode: 400,
editor-article-store    |   region: undefined,
editor-article-store    |   retryable: false,
editor-article-store    |   hostname: undefined,
editor-article-store    |   time: 2021-11-04T13:03:53.015Z
editor-article-store    | }
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:53.033+00:00"},"s":"I",  "c":"NETWORK",  "id":22943,   "ctx":"listener","msg":"Connection accepted","attr":{"remote":"172.19.0.6:38146","uuid":"624ff961-f64b-4182-8641-157a87a85809","connectionId":6,"connectionCount":5}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:53.034+00:00"},"s":"I",  "c":"NETWORK",  "id":51800,   "ctx":"conn6","msg":"client metadata","attr":{"remote":"172.19.0.6:38146","client":"conn6","doc":{"driver":{"name":"nodejs","version":"3.6.2"},"os":{"type":"Linux","name":"linux","architecture":"x64","version":"5.11.0-38-generic"},"platform":"'Node.js v14.18.1, LE (unified)"}}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:53.034+00:00"},"s":"I",  "c":"NETWORK",  "id":22943,   "ctx":"listener","msg":"Connection accepted","attr":{"remote":"172.19.0.6:38148","uuid":"0c5a7835-f566-48e5-a0bc-427f5ca64fca","connectionId":7,"connectionCount":6}}
editor-mongo            | {"t":{"$date":"2021-11-04T13:03:53.035+00:00"},"s":"I",  "c":"NETWORK",  "id":51800,   "ctx":"conn7","msg":"client metadata","attr":{"remote":"172.19.0.6:38148","client":"conn7","doc":{"driver":{"name":"nodejs","version":"3.6.2"},"os":{"type":"Linux","name":"linux","architecture":"x64","version":"5.11.0-38-generic"},"platform":"'Node.js v14.18.1, LE (unified)"}}}
editor-article-store    | SQS - Error interacting with queue -  SQSError: SQS receive message failed: The specified queue does not exist for this wsdl version.
editor-article-store    |     at toSQSError (/node_modules/sqs-consumer/dist/consumer.js:41:22)
editor-article-store    |     at Consumer.receiveMessage (/node_modules/sqs-consumer/dist/consumer.js:137:19)
editor-article-store    |     at processTicksAndRejections (internal/process/task_queues.js:95:5) {
editor-article-store    |   code: 'AWS.SimpleQueueService.NonExistentQueue',
editor-article-store    |   statusCode: 400,
editor-article-store    |   region: undefined,
editor-article-store    |   retryable: false,
editor-article-store    |   hostname: undefined,
editor-article-store    |   time: 2021-11-04T13:03:53.139Z
editor-article-store    | }
editor-article-store    | SQS - Error interacting with queue -  SQSError: SQS receive message failed: The specified queue does not exist for this wsdl version.
editor-article-store    |     at toSQSError (/node_modules/sqs-consumer/dist/consumer.js:41:22)
editor-article-store    |     at Consumer.receiveMessage (/node_modules/sqs-consumer/dist/consumer.js:137:19)
editor-article-store    |     at processTicksAndRejections (internal/process/task_queues.js:95:5) {
editor-article-store    |   code: 'AWS.SimpleQueueService.NonExistentQueue',
editor-article-store    |   statusCode: 400,
editor-article-store    |   region: undefined,
editor-article-store    |   retryable: false,
editor-article-store    |   hostname: undefined,
editor-article-store    |   time: 2021-11-04T13:03:53.156Z
editor-article-store    | }
editor-article-store    | SQS - Error interacting with queue -  SQSError: SQS receive message failed: The specified queue does not exist for this wsdl version.
editor-article-store    |     at toSQSError (/node_modules/sqs-consumer/dist/consumer.js:41:22)
editor-article-store    |     at Consumer.receiveMessage (/node_modules/sqs-consumer/dist/consumer.js:137:19)
editor-article-store    |     at processTicksAndRejections (internal/process/task_queues.js:95:5) {
editor-article-store    |   code: 'AWS.SimpleQueueService.NonExistentQueue',
editor-article-store    |   statusCode: 400,
editor-article-store    |   region: undefined,
editor-article-store    |   retryable: false,
editor-article-store    |   hostname: undefined,
editor-article-store    |   time: 2021-11-04T13:03:53.174Z
editor-article-store    | }
editor-article-store    | SQS - Error interacting with queue -  SQSError: SQS receive message failed: The specified queue does not exist for this wsdl version.
editor-article-store    |     at toSQSError (/node_modules/sqs-consumer/dist/consumer.js:41:22)
editor-article-store    |     at Consumer.receiveMessage (/node_modules/sqs-consumer/dist/consumer.js:137:19)
editor-article-store    |     at processTicksAndRejections (internal/process/task_queues.js:95:5) {
editor-article-store    |   code: 'AWS.SimpleQueueService.NonExistentQueue',
editor-article-store    |   statusCode: 400,
editor-article-store    |   region: undefined,
editor-article-store    |   retryable: false,
editor-article-store    |   hostname: undefined,
editor-article-store    |   time: 2021-11-04T13:03:53.212Z
editor-article-store    | }
editor-article-store    | SQS - Error interacting with queue -  SQSError: SQS receive message failed: The specified queue does not exist for this wsdl version.
editor-article-store    |     at toSQSError (/node_modules/sqs-consumer/dist/consumer.js:41:22)
editor-article-store    |     at Consumer.receiveMessage (/node_modules/sqs-consumer/dist/consumer.js:137:19)
editor-article-store    |     at processTicksAndRejections (internal/process/task_queues.js:95:5) {
editor-article-store    |   code: 'AWS.SimpleQueueService.NonExistentQueue',
editor-article-store    |   statusCode: 400,
editor-article-store    |   region: undefined,
editor-article-store    |   retryable: false,
editor-article-store    |   hostname: undefined,
editor-article-store    |   time: 2021-11-04T13:03:53.226Z
editor-article-store    | }
editor-article-store    | SQS - Error interacting with queue -  SQSError: SQS receive message failed: The specified queue does not exist for this wsdl version.
editor-article-store    |     at toSQSError (/node_modules/sqs-consumer/dist/consumer.js:41:22)
editor-article-store    |     at Consumer.receiveMessage (/node_modules/sqs-consumer/dist/consumer.js:137:19)
editor-article-store    |     at processTicksAndRejections (internal/process/task_queues.js:95:5) {
editor-article-store    |   code: 'AWS.SimpleQueueService.NonExistentQueue',
editor-article-store    |   statusCode: 400,
editor-article-store    |   region: undefined,
editor-article-store    |   retryable: false,
editor-article-store    |   hostname: undefined,
editor-article-store    |   time: 2021-11-04T13:03:53.246Z
editor-article-store    | }
editor-article-store    | SQS - Error interacting with queue -  SQSError: SQS receive message failed: The specified queue does not exist for this wsdl version.
editor-article-store    |     at toSQSError (/node_modules/sqs-consumer/dist/consumer.js:41:22)
editor-article-store    |     at Consumer.receiveMessage (/node_modules/sqs-consumer/dist/consumer.js:137:19)
editor-article-store    |     at processTicksAndRejections (internal/process/task_queues.js:95:5) {
editor-article-store    |   code: 'AWS.SimpleQueueService.NonExistentQueue',
editor-article-store    |   statusCode: 400,
editor-article-store    |   region: undefined,
editor-article-store    |   retryable: false,
editor-article-store    |   hostname: undefined,
editor-article-store    |   time: 2021-11-04T13:03:53.260Z
editor-article-store    | }
NuclearRedeye commented 2 years ago

Thanks @GrazingScientist.

The errors SQS - Error interacting with queue - SQSError: SQS receive message failed: The specified queue does not exist for this wsdl version. although annoying are safe to ignore. They are caused by the localstack container taking a while to startup and create the required resources, and there not being any logic in editor-article-store to patiently wait until the service is available. They should only happen for the first 20 odd seconds at startup and then once the resources are available you should see that it moves on to importing the content. It's noisy, and does need sorting but it's not a high priority for us right now but I'll at least add a note to the README about this.

Now, the other error I can't see myself locally. I also tried just starting the mockServer in isolation to see what I got, where I get quite different output to yours above.

docker-compose up mockServer

Starting editor-mock-service ... done
Attaching to editor-mock-service
editor-mock-service     | 2021-11-09 11:46:06 5.11.1 INFO loading JSON initialization file:
editor-mock-service     | 
editor-mock-service     |   /config/initializerJson.json
editor-mock-service     |  
editor-mock-service     | 2021-11-09 11:46:07 5.11.1 INFO creating expectation:
editor-mock-service     | 
editor-mock-service     |   {
editor-mock-service     |     "id" : "54bf09b1-7920-42a6-8201-4046aa9c347b",
editor-mock-service     |     "priority" : 0,
editor-mock-service     |     "httpRequest" : {
editor-mock-service     |       "method" : "POST",
editor-mock-service     |       "path" : "/pdf-generation/start"
editor-mock-service     |     },
editor-mock-service     |     "times" : {
editor-mock-service     |       "unlimited" : true
editor-mock-service     |     },
editor-mock-service     |     "timeToLive" : {
editor-mock-service     |       "unlimited" : true
editor-mock-service     |     },
editor-mock-service     |     "httpResponse" : {
editor-mock-service     |       "statusCode" : 200,
editor-mock-service     |       "body" : "{\"status\": {\"code\": 200,\"message\": \"job created successfully\"},\"message\": {\"jobid\": \"4b111882-d0e8-4d3d-8ef2-043ac3751ea2\"}}"
editor-mock-service     |     }
editor-mock-service     |   }
editor-mock-service     | 
editor-mock-service     |  with id:
editor-mock-service     | 
editor-mock-service     |   54bf09b1-7920-42a6-8201-4046aa9c347b
editor-mock-service     |  
editor-mock-service     | 2021-11-09 11:46:07 5.11.1 INFO creating expectation:
editor-mock-service     | 
editor-mock-service     |   {
editor-mock-service     |     "id" : "26567d28-950e-4579-8113-707688735d12",
editor-mock-service     |     "priority" : 0,
editor-mock-service     |     "httpRequest" : {
editor-mock-service     |       "method" : "POST",
editor-mock-service     |       "path" : "/pdf-generation/status"
editor-mock-service     |     },
editor-mock-service     |     "times" : {
editor-mock-service     |       "remainingTimes" : 5
editor-mock-service     |     },
editor-mock-service     |     "timeToLive" : {
editor-mock-service     |       "unlimited" : true
editor-mock-service     |     },
editor-mock-service     |     "httpResponse" : {
editor-mock-service     |       "statusCode" : 200,
editor-mock-service     |       "body" : "{\"status\": { \"code\": 200, \"message\": { \"id\": \"385ae272-e98e-47d9-83f5-c3ded54ab467\", \"lastUpdatedTime\": 1620885422660, \"status\": \"in-progress\" }}}"
editor-mock-service     |     }
editor-mock-service     |   }
editor-mock-service     | 
editor-mock-service     |  with id:
editor-mock-service     | 
editor-mock-service     |   26567d28-950e-4579-8113-707688735d12
editor-mock-service     |  
editor-mock-service     | 2021-11-09 11:46:07 5.11.1 INFO creating expectation:
editor-mock-service     | 
editor-mock-service     |   {
editor-mock-service     |     "id" : "d2cc894a-9cb8-4eca-8fc6-c52e362684e0",
editor-mock-service     |     "priority" : 0,
editor-mock-service     |     "httpRequest" : {
editor-mock-service     |       "method" : "POST",
editor-mock-service     |       "path" : "/pdf-generation/status"
editor-mock-service     |     },
editor-mock-service     |     "times" : {
editor-mock-service     |       "unlimited" : true
editor-mock-service     |     },
editor-mock-service     |     "timeToLive" : {
editor-mock-service     |       "unlimited" : true
editor-mock-service     |     },
editor-mock-service     |     "httpResponse" : {
editor-mock-service     |       "statusCode" : 200,
editor-mock-service     |       "body" : "{\"status\": { \"code\": 200, \"message\": { \"id\": \"385ae272-e98e-47d9-83f5-c3ded54ab467\", \"lastUpdatedTime\": 1620885422660, \"status\": \"completed\" }}}"
editor-mock-service     |     }
editor-mock-service     |   }
editor-mock-service     | 
editor-mock-service     |  with id:
editor-mock-service     | 
editor-mock-service     |   d2cc894a-9cb8-4eca-8fc6-c52e362684e0
editor-mock-service     |  
editor-mock-service     | 2021-11-09 11:46:07 5.11.1 INFO 1080 started on port: 1080 
editor-mock-service     | 2021-11-09 11:46:07 5.11.1 INFO logger level is INFO, change using:
editor-mock-service     |  - 'ConfigurationProperties.logLevel(String level)' in Java code,
editor-mock-service     |  - '-logLevel' command line argument,
editor-mock-service     |  - 'mockserver.logLevel' JVM system property or,
editor-mock-service     |  - 'mockserver.logLevel' property value in 'mockserver.properties'

I've also just tried a pull to see if its an issue with container versions, but again it starts up OK for me. Biggest difference seems to be our environments, but you are right in the sense that this shouldn't be an issue because that is what containers are. I'll have a go and see what behaviour I get on a Linux machine to see if I can reproduce the problem there.

GrazingScientist commented 2 years ago

Just to be sure: Can you confirm that your have the same image hashes?

REPOSITORY TAG IMAGE ID CREATED SIZE
localstack/localstack latest b61e4bbe0e8a 9 days ago 828MB
liberoadmin/editor-client latest 8dea0b6ab16f 9 days ago 32MB
liberoadmin/editor-article-store latest e7b88dcea8fd 3 weeks ago 442MB
mongo latest fefd78e9381a 3 weeks ago 699MB
nginx alpine 513f9a9d8748 2 months ago 22.9MB
liberoadmin/editor-pdf-service latest a49c7a1a53ea 2 months ago 249MB
mockserver/mockserver mockserver-5.11.1 22c2245cd0f2 15 months ago 214MB

After roughly 20 seconds, I indeed get:

editor-localstack       | Ready.
editor-localstack       | 2021-11-11T12:23:49:INFO:bootstrap.py: Execution of "_load_service_plugin" took 2227.42ms
editor-localstack       | 2021-11-11T12:23:49:INFO:bootstrap.py: Execution of "require" took 2227.60ms
editor-localstack       | 2021-11-11T12:23:49:INFO:localstack.services.motoserver: starting moto server on http://0.0.0.0:45431
editor-localstack       | 2021-11-11T12:23:49:INFO:localstack.services.infra: Starting mock S3 service on http port 4566 ...
editor-localstack       | 2021-11-11T12:23:49:INFO:localstack.services.infra: Starting mock SQS service on http port 4566 ...
editor-localstack       | 2021-11-11T12:23:49:INFO:bootstrap.py: Execution of "preload_services" took 3365.85ms

However, when I connect to http://localhost:4000 I get a greyed webpage with only an ever spinning circle.

NuclearRedeye commented 2 years ago

Sorry for the delay responding to this.

I've just cleaned all my local images and retested, again things seem fine my end.

REPOSITORY TAG IMAGE ID CREATED SIZE
localstack/localstack latest 136495a5f8b5 12 hours ago 1.48GB
liberoadmin/editor-client latest cceb87c40e0f 2 days ago 32.2MB
mongo latest 4253856b2570 2 weeks ago 701MB
nginx alpine b46db85084b8 3 weeks ago 23.2MB
liberoadmin/editor-article-store latest e7b88dcea8fd 6 weeks ago 442MB
liberoadmin/editor-pdf-service latest a49c7a1a53ea 3 months ago 249MB
elifesciences/basex-transformer latest de9bc6491016 7 months ago 227MB
mockserver/mockserver mockserver-5.11.1 22c2245cd0f2 16 months ago 214MB

One thing that I did spot is that you don't seem to have the elifesciences/basex-transformer in your list of container ids, but I can see messages from the transformer in your logs.

Anyhow, most of our image ids match up other than a few outliers. I don't believe nginx or mongo would be causing the issue, however updating to the latest versions of localstack and editor-client might help.

In the meantime, i'll try and see if I can get a Linux environment setup to try and reproduce the issue.

NuclearRedeye commented 2 years ago

@will-byrne Any chance you could try cloning https://github.com/libero/editor and following the instructions in the README and see what results you get on your Linux machine?

will-byrne commented 2 years ago

I can reproduce the issue on my machine using Linux Mint 20.1 Ulyssa, docker: 20.10.11 and docker-compose: 1.27.4

NuclearRedeye commented 2 years ago

@GrazingScientist myself and @will-byrne managed to reproduce the issue you've been seeing, and have merged a fix which we believe should solve your issue. If you could retest when you get a chance and let us know if that worked that would be great.

GrazingScientist commented 2 years ago

@NuclearRedeye I can confirm that works now like a charm. Thank you! :smile: