[00:35:35.175] New invocation is queued and will start shortly
[00:35:36.370] Starting the invocation (attempt 1)
[00:35:36.394] Popped buildset tag "buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/c1ed4f642396c1bbea2cc0cd6d2e46ff674145a4"
[00:35:36.395] Popped gitiles commit info from properties and tags
[00:35:36.395] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[00:35:36.395] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[00:35:36.395] Buildbucket request:
{
"requestId": "8884899531502194656",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-windows-x64"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8884899531502194656",
"job": "fuchsia/toolchain.ci-clang-windows-x64-40be1bb5",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "567b0f89239b0e3f0e96419038863f2386b635e3"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@567b0f89239b0e3f0e96419038863f2386b635e3",
"title": "567b0f89239b0e3f0e96419038863f2386b635e3",
"url": "https://llvm.googlesource.com/llvm-project/+/567b0f89239b0e3f0e96419038863f2386b635e3"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "3ce3d889f6a7faacb883f563697764b8a58c4abf"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@3ce3d889f6a7faacb883f563697764b8a58c4abf",
"title": "3ce3d889f6a7faacb883f563697764b8a58c4abf",
"url": "https://llvm.googlesource.com/llvm-project/+/3ce3d889f6a7faacb883f563697764b8a58c4abf"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "c221d6420687660b5d03df7051e5501a51a339c6"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@c221d6420687660b5d03df7051e5501a51a339c6",
"title": "c221d6420687660b5d03df7051e5501a51a339c6",
"url": "https://llvm.googlesource.com/llvm-project/+/c221d6420687660b5d03df7051e5501a51a339c6"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "ef2735d2436fd14288d1766a152f3a10f36a4af9"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@ef2735d2436fd14288d1766a152f3a10f36a4af9",
"title": "ef2735d2436fd14288d1766a152f3a10f36a4af9",
"url": "https://llvm.googlesource.com/llvm-project/+/ef2735d2436fd14288d1766a152f3a10f36a4af9"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "e6de45a22933114a1d9421dad558a3d62546cb53"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@e6de45a22933114a1d9421dad558a3d62546cb53",
"title": "e6de45a22933114a1d9421dad558a3d62546cb53",
"url": "https://llvm.googlesource.com/llvm-project/+/e6de45a22933114a1d9421dad558a3d62546cb53"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "0aa4c35beb1f4f8028d79b9ce225a338db0bf9a2"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@0aa4c35beb1f4f8028d79b9ce225a338db0bf9a2",
"title": "0aa4c35beb1f4f8028d79b9ce225a338db0bf9a2",
"url": "https://llvm.googlesource.com/llvm-project/+/0aa4c35beb1f4f8028d79b9ce225a338db0bf9a2"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "ff8aa300d68fefadb6fc75876a595467309f9f52"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@ff8aa300d68fefadb6fc75876a595467309f9f52",
"title": "ff8aa300d68fefadb6fc75876a595467309f9f52",
"url": "https://llvm.googlesource.com/llvm-project/+/ff8aa300d68fefadb6fc75876a595467309f9f52"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "25bf4e262c73444a29e84642ddc409806638fb4f"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@25bf4e262c73444a29e84642ddc409806638fb4f",
"title": "25bf4e262c73444a29e84642ddc409806638fb4f",
"url": "https://llvm.googlesource.com/llvm-project/+/25bf4e262c73444a29e84642ddc409806638fb4f"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "ece59a8cb9c82227ccd304b1cd26a2c216ddb13e"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@ece59a8cb9c82227ccd304b1cd26a2c216ddb13e",
"title": "ece59a8cb9c82227ccd304b1cd26a2c216ddb13e",
"url": "https://llvm.googlesource.com/llvm-project/+/ece59a8cb9c82227ccd304b1cd26a2c216ddb13e"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "71a0cfd93263552ddc0bfd2ea7b0abe9a578f87e"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@71a0cfd93263552ddc0bfd2ea7b0abe9a578f87e",
"title": "71a0cfd93263552ddc0bfd2ea7b0abe9a578f87e",
"url": "https://llvm.googlesource.com/llvm-project/+/71a0cfd93263552ddc0bfd2ea7b0abe9a578f87e"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "c1ed4f642396c1bbea2cc0cd6d2e46ff674145a4"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@c1ed4f642396c1bbea2cc0cd6d2e46ff674145a4",
"title": "c1ed4f642396c1bbea2cc0cd6d2e46ff674145a4",
"url": "https://llvm.googlesource.com/llvm-project/+/c1ed4f642396c1bbea2cc0cd6d2e46ff674145a4"
}
]
}
},
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "c1ed4f642396c1bbea2cc0cd6d2e46ff674145a4",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8884899531502194656"
},
{
"key": "scheduler_job_id",
"value": "fuchsia/toolchain.ci-clang-windows-x64-40be1bb5"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[00:35:36.759] Scheduled build:
{
"id": "8719469469505925953",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-windows-x64"
},
"createdBy": "project:fuchsia",
"createTime": "2025-03-25T00:35:36.451025072Z",
"updateTime": "2025-03-25T00:35:36.451025072Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "c1ed4f642396c1bbea2cc0cd6d2e46ff674145a4",
"ref": "refs/heads/main"
}
}
}
[00:35:36.759] Task URL: https://cr-buildbucket.appspot.com/build/8719469469505925953
[00:35:36.759] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:2:0) after 2m57s
[00:35:37.824] Received PubSub notification, asking Buildbucket for the build status
[00:35:37.851] Build status: SCHEDULED
[00:35:41.273] Received PubSub notification, asking Buildbucket for the build status
[00:35:41.371] Build status: STARTED
[00:38:33.739] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:2:0)
[00:38:33.773] Build status: STARTED
[00:38:33.773] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:5:0) after 2m15s
[00:40:48.775] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:5:0)
[00:40:50.363] Build status: STARTED
[00:40:50.363] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:6:0) after 9m19s
[00:50:09.461] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:6:0)
[00:50:09.515] Build status: STARTED
[00:50:09.515] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:7:0) after 5m59s
[00:56:08.536] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:7:0)
[00:56:08.551] Build status: STARTED
[00:56:08.551] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:8:0) after 1m39s
[00:57:47.611] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:8:0)
[00:57:47.636] Build status: STARTED
[00:57:47.636] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:9:0) after 1m40s
[00:59:27.656] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:9:0)
[00:59:27.698] Build status: STARTED
[00:59:27.698] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:10:0) after 8m13s
[01:07:40.887] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:10:0)
[01:07:40.914] Build status: STARTED
[01:07:40.914] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:11:0) after 6m40s
[01:14:20.968] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:11:0)
[01:14:20.995] Build status: STARTED
[01:14:20.995] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:12:0) after 4m32s
[01:18:53.069] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:12:0)
[01:18:53.106] Build status: STARTED
[01:18:53.106] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:13:0) after 9m38s
[01:28:31.200] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:13:0)
[01:28:31.230] Build status: STARTED
[01:28:31.230] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:14:0) after 6m1s
[01:34:32.354] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:14:0)
[01:34:32.374] Build status: STARTED
[01:34:32.374] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:15:0) after 2m13s
[01:36:45.390] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:15:0)
[01:36:45.521] Build status: STARTED
[01:36:45.521] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:16:0) after 1m28s
[01:38:13.624] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:16:0)
[01:38:13.644] Build status: STARTED
[01:38:13.644] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:17:0) after 5m53s
[01:44:06.667] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:17:0)
[01:44:06.684] Build status: STARTED
[01:44:06.684] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:18:0) after 7m58s
[01:52:04.746] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:18:0)
[01:52:04.773] Build status: STARTED
[01:52:04.773] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:19:0) after 3m58s
[01:56:02.842] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:19:0)
[01:56:02.862] Build status: STARTED
[01:56:02.862] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:20:0) after 6m4s
[02:02:06.983] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:20:0)
[02:02:07.029] Build status: STARTED
[02:02:07.029] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8884899531502194656:21:0) after 9m46s
[02:06:24.806] Received PubSub notification, asking Buildbucket for the build status
[02:06:24.832] Build:
{
"id": "8719469469505925953",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-windows-x64"
},
"createdBy": "project:fuchsia",
"createTime": "2025-03-25T00:35:36.451025072Z",
"startTime": "2025-03-25T00:35:41.084810972Z",
"endTime": "2025-03-25T02:06:24.220087839Z",
"updateTime": "2025-03-25T02:06:24.220087839Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "c1ed4f642396c1bbea2cc0cd6d2e46ff674145a4",
"ref": "refs/heads/main"
}
}
}
[02:06:24.832] Invocation finished in 1h30m49.667879301s with status SUCCEEDED