Logs Deploy to Staging

deploy_failure.sh

Running with gitlab-runner 16.1.0~beta.59.g83c66823 (83c66823)
  on blue-2.shared.runners-manager.gitlab.com/default XxUrkriX, system ID: s_90897a2659b5
  feature flags: FF_USE_IMPROVED_URL_MASKING:true
Resolving secrets
00:00
Preparing the "docker+machine" executor
Using Docker executor with image amazon/aws-cli ...
Starting service postgres:9.6.15-alpine ...
Pulling docker image postgres:9.6.15-alpine ...
Using docker image sha256:081f7129326442032531804733cb9d86ff2621a50d77d2241437f7dfb0d972ce for postgres:9.6.15-alpine with digest postgres@sha256:a8d36bd2f4af670c856f33790964ffd74066a8436391c6056f6d0deb7bd71cdb ...
Waiting for services to be up and running (timeout 30 seconds)...
Pulling docker image amazon/aws-cli ...
Using docker image sha256:75b3a5ee77dee56ed2502349a50f4668887f1dcb39df96b79cd01d490da80ac8 for amazon/aws-cli with digest amazon/aws-cli@sha256:f6259b8368202598e51521dd8d4c1e06d185c7d31a72fcd6e1e8e77939d2e8cf ...
Preparing environment
00:04
Running on runner-xxurkrix-project-11171486-concurrent-0 via runner-xxurkrix-shared-1687405269-908d1527...
Getting source from Git repository
00:21
Fetching changes...
Initialized empty Git repository in /builds/stanford-magazine/stanfordmag/.git/
Created fresh repository.
Checking out 7417936f as detached HEAD (ref is staging)...
Skipping Git submodules setup
$ git remote set-url origin "${CI_REPOSITORY_URL}"
Restoring cache
00:16
Checking cache for staging-1-non_protected...
Downloading cache.zip from https://storage.googleapis.com/gitlab-com-runners-cache/project/11171486/staging-1-non_protected 
Successfully extracted cache
Downloading artifacts
00:03
Downloading artifacts for unit (4518717326)...
Downloading artifacts from coordinator... ok        host=storage.googleapis.com id=4518717326 responseStatus=200 OK token=64_iPVvh
Downloading artifacts for system (4518717328)...
Downloading artifacts from coordinator... ok        host=storage.googleapis.com id=4518717328 responseStatus=200 OK token=64_iPVvh
Executing "step_script" stage of the job script
Using docker image sha256:75b3a5ee77dee56ed2502349a50f4668887f1dcb39df96b79cd01d490da80ac8 for amazon/aws-cli with digest amazon/aws-cli@sha256:f6259b8368202598e51521dd8d4c1e06d185c7d31a72fcd6e1e8e77939d2e8cf ...
$ curl -Lo /usr/local/bin/ecs-cli https://amazon-ecs-cli.s3.amazonaws.com/ecs-cli-linux-amd64-latest
  % Total    % Received % Xferd  Average Speed   Time    Time     Time  Current
                                 Dload  Upload   Total   Spent    Left  Speed
100 35.6M  100 35.6M    0     0  69.1M      0 --:--:-- --:--:-- --:--:-- 69.0M
$ chmod o+x /usr/local/bin/ecs-cli
$ ecs-cli --version
ecs-cli version 1.21.0 (bb0b8f0)
$ cp $ENV_STAGING .env.staging
$ ecs-cli configure --cluster $CI_AWS_ECS_CLUSTER --region $AWS_DEFAULT_REGION --default-launch-type EC2 --config-name $CI_AWS_ECS_CLUSTER
time="2023-06-22T03:43:07Z" level=info msg="Saved ECS CLI cluster configuration orion-staging."
$ ecs-cli compose --project-name $CI_AWS_ECS_SERVICE --file "./deploy/staging/docker-compose.yml" --ecs-params "./deploy/staging/ecs-params.yml" service up --cluster-config $CI_AWS_ECS_CLUSTER --force-deployment --timeout 40 --target-groups $CI_AWS_TARGET_GROUP
time="2023-06-22T03:43:08Z" level=warning msg="Skipping unsupported YAML option for service..." option name=build service name=web_server
time="2023-06-22T03:43:08Z" level=warning msg="Skipping unsupported YAML option for service..." option name=build service name=server_app
time="2023-06-22T03:43:08Z" level=warning msg="Skipping unsupported YAML option for service..." option name=build service name=worker_app
time="2023-06-22T03:43:08Z" level=info msg="Using ECS task definition" TaskDefinition="orion-staging:463"
time="2023-06-22T03:43:08Z" level=warning msg="You cannot update the load balancer configuration on an existing service." serviceName=orion-staging
time="2023-06-22T03:43:08Z" level=info msg="Updated the ECS service with a new task definition. Old containers will be stopped automatically, and replaced with new ones" desiredCount=1 force-deployment=true service=orion-staging
time="2023-06-22T03:43:08Z" level=info msg="Service status" desiredCount=1 runningCount=1 serviceName=orion-staging
time="2023-06-22T03:44:44Z" level=info msg="Service status" desiredCount=1 runningCount=2 serviceName=orion-staging
time="2023-06-22T03:44:44Z" level=info msg="(service orion-staging) registered 1 targets in (target-group arn:aws:elasticloadbalancing:us-east-1:151237707411:targetgroup/orion-alb-staging-tg/e60e558bfff5aa72)" timestamp="2023-06-22 03:44:41 +0000 UTC"
time="2023-06-22T03:46:21Z" level=info msg="Service status" desiredCount=1 runningCount=1 serviceName=orion-staging
time="2023-06-22T03:46:21Z" level=info msg="(service orion-staging) (task 23d78c5401804e03ac2917fe73e1f32f) failed container health checks." timestamp="2023-06-22 03:46:18 +0000 UTC"
time="2023-06-22T03:46:21Z" level=info msg="(service orion-staging) has stopped 1 running tasks: (task 23d78c5401804e03ac2917fe73e1f32f)." timestamp="2023-06-22 03:46:18 +0000 UTC"
time="2023-06-22T03:46:31Z" level=info msg="(service orion-staging) deregistered 1 targets in (target-group arn:aws:elasticloadbalancing:us-east-1:151237707411:targetgroup/orion-alb-staging-tg/e60e558bfff5aa72)" timestamp="2023-06-22 03:46:28 +0000 UTC"
time="2023-06-22T03:46:31Z" level=info msg="(service orion-staging, taskSet ecs-svc/1802925539549294404) has begun draining connections on 1 tasks." timestamp="2023-06-22 03:46:28 +0000 UTC"
time="2023-06-22T03:47:32Z" level=info msg="(service orion-staging) has started 1 tasks: (task 00b90def607446c7bba5a9c557e1eb9f)." timestamp="2023-06-22 03:47:29 +0000 UTC"
time="2023-06-22T03:48:43Z" level=info msg="(service orion-staging) has started 1 tasks: (task 320c2f8b17284a9ab1ad9ca11eed0184)." timestamp="2023-06-22 03:48:40 +0000 UTC"
time="2023-06-22T03:49:54Z" level=info msg="(service orion-staging) has started 1 tasks: (task afd2e11da4054d9a8fce20b49a7b6406)." timestamp="2023-06-22 03:49:50 +0000 UTC"
time="2023-06-22T03:55:18Z" level=info msg="(service orion-staging) has started 1 tasks: (task e74f0461258848c491b1574a772a0614)." timestamp="2023-06-22 03:55:16 +0000 UTC"
time="2023-06-22T03:55:38Z" level=info msg="(service orion-staging) registered 1 targets in (target-group arn:aws:elasticloadbalancing:us-east-1:151237707411:targetgroup/orion-alb-staging-tg/e60e558bfff5aa72)" timestamp="2023-06-22 03:55:35 +0000 UTC"
time="2023-06-22T03:55:44Z" level=info msg="Service status" desiredCount=1 runningCount=2 serviceName=orion-staging
time="2023-06-22T03:57:05Z" level=info msg="Service status" desiredCount=1 runningCount=1 serviceName=orion-staging
time="2023-06-22T03:57:05Z" level=info msg="(service orion-staging) (task e74f0461258848c491b1574a772a0614) failed container health checks." timestamp="2023-06-22 03:57:01 +0000 UTC"
time="2023-06-22T03:57:05Z" level=info msg="(service orion-staging) has stopped 1 running tasks: (task e74f0461258848c491b1574a772a0614)." timestamp="2023-06-22 03:57:01 +0000 UTC"
time="2023-06-22T03:57:05Z" level=info msg="Service status" desiredCount=1 runningCount=1 serviceName=orion-staging
time="2023-06-22T03:57:05Z" level=info msg="(service orion-staging) (task e74f0461258848c491b1574a772a0614) failed container health checks." timestamp="2023-06-22 03:57:01 +0000 UTC"
time="2023-06-22T03:57:05Z" level=info msg="(service orion-staging) has stopped 1 running tasks: (task e74f0461258848c491b1574a772a0614)." timestamp="2023-06-22 03:57:01 +0000 UTC"
time="2023-06-22T03:57:15Z" level=info msg="(service orion-staging) deregistered 1 targets in (target-group arn:aws:elasticloadbalancing:us-east-1:151237707411:targetgroup/orion-alb-staging-tg/e60e558bfff5aa72)" timestamp="2023-06-22 03:57:11 +0000 UTC"
time="2023-06-22T03:57:15Z" level=info msg="(service orion-staging, taskSet ecs-svc/8345232683841215435) has begun draining connections on 1 tasks." timestamp="2023-06-22 03:57:11 +0000 UTC"
time="2023-06-22T04:02:44Z" level=info msg="(service orion-staging) has started 1 tasks: (task 0d5437ee2f7d45e88e82f3ca450badda)." timestamp="2023-06-22 04:02:41 +0000 UTC"
time="2023-06-22T04:03:05Z" level=info msg="Service status" desiredCount=1 runningCount=2 serviceName=orion-staging
time="2023-06-22T04:03:05Z" level=info msg="(service orion-staging) registered 1 targets in (target-group arn:aws:elasticloadbalancing:us-east-1:151237707411:targetgroup/orion-alb-staging-tg/e60e558bfff5aa72)" timestamp="2023-06-22 04:03:00 +0000 UTC"
time="2023-06-22T04:03:05Z" level=info msg="Service status" desiredCount=1 runningCount=2 serviceName=orion-staging
time="2023-06-22T04:03:05Z" level=info msg="(service orion-staging) registered 1 targets in (target-group arn:aws:elasticloadbalancing:us-east-1:151237707411:targetgroup/orion-alb-staging-tg/e60e558bfff5aa72)" timestamp="2023-06-22 04:03:00 +0000 UTC"
time="2023-06-22T04:04:51Z" level=info msg="Service status" desiredCount=1 runningCount=1 serviceName=orion-staging
time="2023-06-22T04:04:51Z" level=info msg="(service orion-staging) (task 0d5437ee2f7d45e88e82f3ca450badda) failed container health checks." timestamp="2023-06-22 04:04:46 +0000 UTC"
time="2023-06-22T04:04:51Z" level=info msg="(service orion-staging) has stopped 1 running tasks: (task 0d5437ee2f7d45e88e82f3ca450badda)." timestamp="2023-06-22 04:04:46 +0000 UTC"
time="2023-06-22T04:04:56Z" level=info msg="(service orion-staging) deregistered 1 targets in (target-group arn:aws:elasticloadbalancing:us-east-1:151237707411:targetgroup/orion-alb-staging-tg/e60e558bfff5aa72)" timestamp="2023-06-22 04:04:56 +0000 UTC"
time="2023-06-22T04:04:56Z" level=info msg="(service orion-staging, taskSet ecs-svc/8345232683841215435) has begun draining connections on 1 tasks." timestamp="2023-06-22 04:04:56 +0000 UTC"
time="2023-06-22T04:10:21Z" level=info msg="(service orion-staging) has started 1 tasks: (task 06617f50d6c24de693ee489bb581d209)." timestamp="2023-06-22 04:10:18 +0000 UTC"
time="2023-06-22T04:10:31Z" level=info msg="(service orion-staging) registered 1 targets in (target-group arn:aws:elasticloadbalancing:us-east-1:151237707411:targetgroup/orion-alb-staging-tg/e60e558bfff5aa72)" timestamp="2023-06-22 04:10:28 +0000 UTC"
time="2023-06-22T04:10:36Z" level=info msg="Service status" desiredCount=1 runningCount=2 serviceName=orion-staging
time="2023-06-22T04:11:57Z" level=info msg="Service status" desiredCount=1 runningCount=1 serviceName=orion-staging
time="2023-06-22T04:11:57Z" level=info msg="(service orion-staging) (task 06617f50d6c24de693ee489bb581d209) failed container health checks." timestamp="2023-06-22 04:11:56 +0000 UTC"
time="2023-06-22T04:11:57Z" level=info msg="(service orion-staging) has stopped 1 running tasks: (task 06617f50d6c24de693ee489bb581d209)." timestamp="2023-06-22 04:11:56 +0000 UTC"
time="2023-06-22T04:12:07Z" level=info msg="(service orion-staging) deregistered 1 targets in (target-group arn:aws:elasticloadbalancing:us-east-1:151237707411:targetgroup/orion-alb-staging-tg/e60e558bfff5aa72)" timestamp="2023-06-22 04:12:06 +0000 UTC"
time="2023-06-22T04:12:07Z" level=info msg="(service orion-staging, taskSet ecs-svc/8345232683841215435) has begun draining connections on 1 tasks." timestamp="2023-06-22 04:12:06 +0000 UTC"
time="2023-06-22T04:17:32Z" level=info msg="(service orion-staging) has started 1 tasks: (task 54676c4f2d1041c4926e5bebbd18c244)." timestamp="2023-06-22 04:17:27 +0000 UTC"
time="2023-06-22T04:17:42Z" level=info msg="Service status" desiredCount=1 runningCount=2 serviceName=orion-staging
time="2023-06-22T04:17:42Z" level=info msg="(service orion-staging) registered 1 targets in (target-group arn:aws:elasticloadbalancing:us-east-1:151237707411:targetgroup/orion-alb-staging-tg/e60e558bfff5aa72)" timestamp="2023-06-22 04:17:36 +0000 UTC"
time="2023-06-22T04:19:28Z" level=info msg="Service status" desiredCount=1 runningCount=1 serviceName=orion-staging
time="2023-06-22T04:19:28Z" level=info msg="(service orion-staging) (task 54676c4f2d1041c4926e5bebbd18c244) failed container health checks." timestamp="2023-06-22 04:19:24 +0000 UTC"
time="2023-06-22T04:19:28Z" level=info msg="(service orion-staging) has stopped 1 running tasks: (task 54676c4f2d1041c4926e5bebbd18c244)." timestamp="2023-06-22 04:19:24 +0000 UTC"
time="2023-06-22T04:19:38Z" level=info msg="(service orion-staging) deregistered 1 targets in (target-group arn:aws:elasticloadbalancing:us-east-1:151237707411:targetgroup/orion-alb-staging-tg/e60e558bfff5aa72)" timestamp="2023-06-22 04:19:34 +0000 UTC"
time="2023-06-22T04:19:38Z" level=info msg="(service orion-staging, taskSet ecs-svc/8345232683841215435) has begun draining connections on 1 tasks." timestamp="2023-06-22 04:19:34 +0000 UTC"
time="2023-06-22T04:24:53Z" level=info msg="(service orion-staging) has started 1 tasks: (task 3d9f9cc2cdb64db6b6afd8120167bc0e)." timestamp="2023-06-22 04:24:49 +0000 UTC"
time="2023-06-22T04:25:03Z" level=info msg="(service orion-staging) registered 1 targets in (target-group arn:aws:elasticloadbalancing:us-east-1:151237707411:targetgroup/orion-alb-staging-tg/e60e558bfff5aa72)" timestamp="2023-06-22 04:24:59 +0000 UTC"
time="2023-06-22T04:25:08Z" level=info msg="Service status" desiredCount=1 runningCount=2 serviceName=orion-staging
time="2023-06-22T04:26:44Z" level=info msg="Service status" desiredCount=1 runningCount=1 serviceName=orion-staging
time="2023-06-22T04:26:49Z" level=info msg="(service orion-staging) (task 3d9f9cc2cdb64db6b6afd8120167bc0e) failed container health checks." timestamp="2023-06-22 04:26:44 +0000 UTC"
time="2023-06-22T04:26:49Z" level=info msg="(service orion-staging) has stopped 1 running tasks: (task 3d9f9cc2cdb64db6b6afd8120167bc0e)." timestamp="2023-06-22 04:26:44 +0000 UTC"
time="2023-06-22T04:27:00Z" level=info msg="(service orion-staging) deregistered 1 targets in (target-group arn:aws:elasticloadbalancing:us-east-1:151237707411:targetgroup/orion-alb-staging-tg/e60e558bfff5aa72)" timestamp="2023-06-22 04:26:54 +0000 UTC"
time="2023-06-22T04:27:00Z" level=info msg="(service orion-staging, taskSet ecs-svc/8345232683841215435) has begun draining connections on 1 tasks." timestamp="2023-06-22 04:26:54 +0000 UTC"
time="2023-06-22T04:32:19Z" level=info msg="(service orion-staging) has started 1 tasks: (task 7f613ca924c54e57a5ed5ee7cade8018)." timestamp="2023-06-22 04:32:15 +0000 UTC"
time="2023-06-22T04:32:29Z" level=info msg="Service status" desiredCount=1 runningCount=2 serviceName=orion-staging
time="2023-06-22T04:32:29Z" level=info msg="(service orion-staging) registered 1 targets in (target-group arn:aws:elasticloadbalancing:us-east-1:151237707411:targetgroup/orion-alb-staging-tg/e60e558bfff5aa72)" timestamp="2023-06-22 04:32:25 +0000 UTC"
time="2023-06-22T04:34:10Z" level=info msg="Service status" desiredCount=1 runningCount=1 serviceName=orion-staging
time="2023-06-22T04:34:15Z" level=info msg="(service orion-staging) (task 7f613ca924c54e57a5ed5ee7cade8018) failed container health checks." timestamp="2023-06-22 04:34:09 +0000 UTC"
time="2023-06-22T04:34:15Z" level=info msg="(service orion-staging) has stopped 1 running tasks: (task 7f613ca924c54e57a5ed5ee7cade8018)." timestamp="2023-06-22 04:34:09 +0000 UTC"
time="2023-06-22T04:34:21Z" level=info msg="(service orion-staging) deregistered 1 targets in (target-group arn:aws:elasticloadbalancing:us-east-1:151237707411:targetgroup/orion-alb-staging-tg/e60e558bfff5aa72)" timestamp="2023-06-22 04:34:19 +0000 UTC"
time="2023-06-22T04:34:21Z" level=info msg="(service orion-staging, taskSet ecs-svc/8345232683841215435) has begun draining connections on 1 tasks." timestamp="2023-06-22 04:34:19 +0000 UTC"
time="2023-06-22T04:39:40Z" level=info msg="(service orion-staging) has started 1 tasks: (task a4afdb6920a04b30bfaa63df91fc0ef2)." timestamp="2023-06-22 04:39:38 +0000 UTC"
time="2023-06-22T04:39:50Z" level=info msg="(service orion-staging) registered 1 targets in (target-group arn:aws:elasticloadbalancing:us-east-1:151237707411:targetgroup/orion-alb-staging-tg/e60e558bfff5aa72)" timestamp="2023-06-22 04:39:48 +0000 UTC"
time="2023-06-22T04:39:55Z" level=info msg="Service status" desiredCount=1 runningCount=2 serviceName=orion-staging
time="2023-06-22T04:41:37Z" level=info msg="Service status" desiredCount=1 runningCount=1 serviceName=orion-staging
time="2023-06-22T04:41:37Z" level=info msg="(service orion-staging) (task a4afdb6920a04b30bfaa63df91fc0ef2) failed container health checks." timestamp="2023-06-22 04:41:36 +0000 UTC"
time="2023-06-22T04:41:37Z" level=info msg="(service orion-staging) has stopped 1 running tasks: (task a4afdb6920a04b30bfaa63df91fc0ef2)." timestamp="2023-06-22 04:41:36 +0000 UTC"
time="2023-06-22T04:41:47Z" level=info msg="(service orion-staging) deregistered 1 targets in (target-group arn:aws:elasticloadbalancing:us-east-1:151237707411:targetgroup/orion-alb-staging-tg/e60e558bfff5aa72)" timestamp="2023-06-22 04:41:45 +0000 UTC"
time="2023-06-22T04:41:47Z" level=info msg="(service orion-staging, taskSet ecs-svc/8345232683841215435) has begun draining connections on 1 tasks." timestamp="2023-06-22 04:41:45 +0000 UTC"
ERROR: Job failed: execution took longer than 1h0m0s seconds