[19:17:22.304] New invocation is queued and will start shortly
[19:17:22.304] Triggered by user:fuchsia-ci-builder@fuchsia-infra.iam.gserviceaccount.com
[19:17:23.399] Starting the invocation (attempt 1)
[19:17:23.428] Popped buildset tag "buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/7b0396faabce0cec470779ae5e3a851bedb2ac12"
[19:17:23.428] Reconstructed gitiles commit from tags
[19:17:23.428] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[19:17:23.428] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[19:17:23.429] Buildbucket request:
{
"requestId": "8922970277711901168",
"builder": {
"project": "fuchsia",
"bucket": "ci",
"builder": "clang_toolchain.ci.core.arm64-debug"
},
"properties": {
"$fuchsia/checkout": {
"clang_toolchain": {
"cas_digest": "5a2e7a049e964e3c69036e0bc468c785859e8e66dbd9ff78b43a1285de1f457e/578"
},
"gitiles_commit": {
"host": "fuchsia.googlesource.com",
"id": "6ab5d26d7f790e500f1c27ac6fda6696f6f16ff8",
"project": "integration"
}
},
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8922970277711901168",
"job": "fuchsia/clang_toolchain.ci.core.arm64-debug",
"triggers": [
{
"buildbucket": {
"properties": {
"$fuchsia/checkout": {
"clang_toolchain": {
"cas_digest": "2d9b830d1546537fe4070ab700e4242f67e8419ed18137245bebbea12b6e0b31/578"
},
"gitiles_commit": {
"host": "fuchsia.googlesource.com",
"id": "6ab5d26d7f790e500f1c27ac6fda6696f6f16ff8",
"project": "integration"
}
},
"clang_toolchain": {
"git_repository": "https://llvm.googlesource.com/llvm-project",
"git_revision": "cbe5985ff7cd21924ed88b6a46fd5c04acc7fca8"
}
},
"tags": [
"buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/cbe5985ff7cd21924ed88b6a46fd5c04acc7fca8",
"gitiles_ref:refs/heads/main",
"parent_buildername:clang-linux-x64",
"user_agent:recipe"
]
},
"id": "ac612502-7f33-4944-8999-add67db77344",
"title": "clang-linux-x64/0"
},
{
"buildbucket": {
"properties": {
"$fuchsia/checkout": {
"clang_toolchain": {
"cas_digest": "259f48db8d4af60215adcf24ea18e1acc4949073f3d7118a3b7772da0c28164e/578"
},
"gitiles_commit": {
"host": "fuchsia.googlesource.com",
"id": "6ab5d26d7f790e500f1c27ac6fda6696f6f16ff8",
"project": "integration"
}
},
"clang_toolchain": {
"git_repository": "https://llvm.googlesource.com/llvm-project",
"git_revision": "181eab27d244b9a9eb32d6716f9c38f7f3723356"
}
},
"tags": [
"buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/181eab27d244b9a9eb32d6716f9c38f7f3723356",
"gitiles_ref:refs/heads/main",
"parent_buildername:clang-linux-x64",
"user_agent:recipe"
]
},
"id": "fade0d00-baff-4edc-b2ab-7aeecf8d3520",
"title": "clang-linux-x64/0"
},
{
"buildbucket": {
"properties": {
"$fuchsia/checkout": {
"clang_toolchain": {
"cas_digest": "5a2e7a049e964e3c69036e0bc468c785859e8e66dbd9ff78b43a1285de1f457e/578"
},
"gitiles_commit": {
"host": "fuchsia.googlesource.com",
"id": "6ab5d26d7f790e500f1c27ac6fda6696f6f16ff8",
"project": "integration"
}
},
"clang_toolchain": {
"git_repository": "https://llvm.googlesource.com/llvm-project",
"git_revision": "7b0396faabce0cec470779ae5e3a851bedb2ac12"
}
},
"tags": [
"buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/7b0396faabce0cec470779ae5e3a851bedb2ac12",
"gitiles_ref:refs/heads/main",
"parent_buildername:clang-linux-x64",
"user_agent:recipe"
]
},
"id": "3ce05d64-f31f-49fa-a6ff-d91ccd020812",
"title": "clang-linux-x64/0"
}
]
},
"clang_toolchain": {
"git_repository": "https://llvm.googlesource.com/llvm-project",
"git_revision": "7b0396faabce0cec470779ae5e3a851bedb2ac12"
}
},
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "7b0396faabce0cec470779ae5e3a851bedb2ac12",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8922970277711901168"
},
{
"key": "scheduler_job_id",
"value": "fuchsia/clang_toolchain.ci.core.arm64-debug"
},
{
"key": "user_agent",
"value": "luci-scheduler"
},
{
"key": "parent_buildername",
"value": "clang-linux-x64"
},
{
"key": "user_agent",
"value": "recipe"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[19:17:24.006] Scheduled build:
{
"id": "8757540215820575841",
"builder": {
"project": "fuchsia",
"bucket": "ci",
"builder": "clang_toolchain.ci.core.arm64-debug"
},
"createdBy": "project:fuchsia",
"createTime": "2024-01-29T19:17:23.485653497Z",
"updateTime": "2024-01-29T19:17:23.485653497Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "7b0396faabce0cec470779ae5e3a851bedb2ac12",
"ref": "refs/heads/main"
}
}
}
[19:17:24.006] Task URL: https://cr-buildbucket.appspot.com/build/8757540215820575841
[19:17:24.007] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:2:0) after 4m45s
[19:17:24.980] Received PubSub notification, asking Buildbucket for the build status
[19:17:25.016] Build status: SCHEDULED
[19:19:20.282] Received PubSub notification, asking Buildbucket for the build status
[19:19:20.341] Build status: STARTED
[19:22:09.030] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:2:0)
[19:22:09.052] Build status: STARTED
[19:22:09.052] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:5:0) after 1m34s
[19:23:43.071] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:5:0)
[19:23:43.160] Build status: STARTED
[19:23:43.160] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:6:0) after 8m50s
[19:32:33.233] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:6:0)
[19:32:33.286] Build status: STARTED
[19:32:33.286] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:7:0) after 7m35s
[19:40:08.313] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:7:0)
[19:40:08.334] Build status: STARTED
[19:40:08.334] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:8:0) after 1m52s
[19:42:00.355] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:8:0)
[19:42:00.406] Build status: STARTED
[19:42:00.406] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:9:0) after 3m17s
[19:45:17.518] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:9:0)
[19:45:17.543] Build status: STARTED
[19:45:17.543] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:10:0) after 2m8s
[19:47:25.566] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:10:0)
[19:47:25.591] Build status: STARTED
[19:47:25.591] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:11:0) after 7m59s
[19:55:24.712] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:11:0)
[19:55:24.736] Build status: STARTED
[19:55:24.736] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:12:0) after 9m42s
[20:05:06.848] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:12:0)
[20:05:06.962] Build status: STARTED
[20:05:06.962] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:13:0) after 2m41s
[20:07:47.978] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:13:0)
[20:07:48.007] Build status: STARTED
[20:07:48.007] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:14:0) after 9m47s
[20:17:35.032] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:14:0)
[20:17:35.059] Build status: STARTED
[20:17:35.059] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:15:0) after 5m1s
[20:22:36.105] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:15:0)
[20:22:36.127] Build status: STARTED
[20:22:36.127] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:16:0) after 1m45s
[20:24:21.208] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:16:0)
[20:24:21.263] Build status: STARTED
[20:24:21.264] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:17:0) after 1m18s
[20:25:39.277] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:17:0)
[20:25:39.303] Build status: STARTED
[20:25:39.303] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:18:0) after 7m51s
[20:33:30.435] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:18:0)
[20:33:30.458] Build status: STARTED
[20:33:30.458] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:19:0) after 2m27s
[20:35:57.536] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:19:0)
[20:35:57.559] Build status: STARTED
[20:35:57.559] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:20:0) after 8m49s
[20:44:46.574] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:20:0)
[20:44:46.591] Build status: STARTED
[20:44:46.591] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:21:0) after 1m2s
[20:45:48.609] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:21:0)
[20:45:48.734] Build status: STARTED
[20:45:48.734] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:22:0) after 3m2s
[20:48:50.751] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:22:0)
[20:48:50.773] Build status: STARTED
[20:48:50.773] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:23:0) after 2m59s
[20:51:49.793] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:23:0)
[20:51:49.871] Build status: STARTED
[20:51:49.871] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:24:0) after 9m23s
[21:01:12.898] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:24:0)
[21:01:12.924] Build status: STARTED
[21:01:12.924] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:25:0) after 4m47s
[21:05:59.941] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:25:0)
[21:05:59.964] Build status: STARTED
[21:05:59.964] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:26:0) after 6m58s
[21:12:58.022] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:26:0)
[21:12:58.065] Build status: STARTED
[21:12:58.065] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:27:0) after 4m12s
[21:17:10.079] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:27:0)
[21:17:10.105] Build status: STARTED
[21:17:10.105] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.arm64-debug:8922970277711901168:28:0) after 7m53s
[21:19:17.868] Received PubSub notification, asking Buildbucket for the build status
[21:19:17.888] Build:
{
"id": "8757540215820575841",
"builder": {
"project": "fuchsia",
"bucket": "ci",
"builder": "clang_toolchain.ci.core.arm64-debug"
},
"createdBy": "project:fuchsia",
"createTime": "2024-01-29T19:17:23.485653497Z",
"startTime": "2024-01-29T19:19:18.067970Z",
"endTime": "2024-01-29T21:19:17.112496Z",
"updateTime": "2024-01-29T21:19:17.112496Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "7b0396faabce0cec470779ae5e3a851bedb2ac12",
"ref": "refs/heads/main"
}
}
}
[21:19:17.888] Invocation finished in 2h1m55.590991312s with status SUCCEEDED