[21:19:35.444] New invocation is queued and will start shortly
[21:19:36.748] Starting the invocation (attempt 1)
[21:19:36.774] Popped buildset tag "buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/031f08c0a5aa1e9fb6995e26f5e9270a81f077cd"
[21:19:36.774] Popped gitiles commit info from properties and tags
[21:19:36.774] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[21:19:36.774] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[21:19:36.774] Buildbucket request:
{
"requestId": "8911909758471770496",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-windows-x64"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8911909758471770496",
"job": "fuchsia/toolchain.ci-clang-windows-x64-40be1bb5",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "7b8048939024841e07f8d89ddfaa4311f9dd7e9c"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@7b8048939024841e07f8d89ddfaa4311f9dd7e9c",
"title": "7b8048939024841e07f8d89ddfaa4311f9dd7e9c",
"url": "https://llvm.googlesource.com/llvm-project/+/7b8048939024841e07f8d89ddfaa4311f9dd7e9c"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "224581cf3c8b734d619e261ec4705106282ae3a8"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@224581cf3c8b734d619e261ec4705106282ae3a8",
"title": "224581cf3c8b734d619e261ec4705106282ae3a8",
"url": "https://llvm.googlesource.com/llvm-project/+/224581cf3c8b734d619e261ec4705106282ae3a8"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "22ada554d5123717d163fea5a2a8d87020b332fe"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@22ada554d5123717d163fea5a2a8d87020b332fe",
"title": "22ada554d5123717d163fea5a2a8d87020b332fe",
"url": "https://llvm.googlesource.com/llvm-project/+/22ada554d5123717d163fea5a2a8d87020b332fe"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "6f576d957e7efd2e3b2af90d03e626f0bafbd018"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@6f576d957e7efd2e3b2af90d03e626f0bafbd018",
"title": "6f576d957e7efd2e3b2af90d03e626f0bafbd018",
"url": "https://llvm.googlesource.com/llvm-project/+/6f576d957e7efd2e3b2af90d03e626f0bafbd018"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "d471860f2d3bbc7208ebf6e9e3e5350677f9c290"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@d471860f2d3bbc7208ebf6e9e3e5350677f9c290",
"title": "d471860f2d3bbc7208ebf6e9e3e5350677f9c290",
"url": "https://llvm.googlesource.com/llvm-project/+/d471860f2d3bbc7208ebf6e9e3e5350677f9c290"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "6e975ecf5c93c40d2f088425548eb6476332629c"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@6e975ecf5c93c40d2f088425548eb6476332629c",
"title": "6e975ecf5c93c40d2f088425548eb6476332629c",
"url": "https://llvm.googlesource.com/llvm-project/+/6e975ecf5c93c40d2f088425548eb6476332629c"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "8247068b70106d188d037b9cc4b8de3548108597"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@8247068b70106d188d037b9cc4b8de3548108597",
"title": "8247068b70106d188d037b9cc4b8de3548108597",
"url": "https://llvm.googlesource.com/llvm-project/+/8247068b70106d188d037b9cc4b8de3548108597"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "167cad531db897c708610447d2632f137931c4be"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@167cad531db897c708610447d2632f137931c4be",
"title": "167cad531db897c708610447d2632f137931c4be",
"url": "https://llvm.googlesource.com/llvm-project/+/167cad531db897c708610447d2632f137931c4be"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "493eefc93f2901dd987b8ff441004352b317cab9"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@493eefc93f2901dd987b8ff441004352b317cab9",
"title": "493eefc93f2901dd987b8ff441004352b317cab9",
"url": "https://llvm.googlesource.com/llvm-project/+/493eefc93f2901dd987b8ff441004352b317cab9"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "031f08c0a5aa1e9fb6995e26f5e9270a81f077cd"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@031f08c0a5aa1e9fb6995e26f5e9270a81f077cd",
"title": "031f08c0a5aa1e9fb6995e26f5e9270a81f077cd",
"url": "https://llvm.googlesource.com/llvm-project/+/031f08c0a5aa1e9fb6995e26f5e9270a81f077cd"
}
]
}
},
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "031f08c0a5aa1e9fb6995e26f5e9270a81f077cd",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8911909758471770496"
},
{
"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"
}
}
[21:19:37.258] Scheduled build:
{
"id": "8746479696351364129",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-windows-x64"
},
"createdBy": "project:fuchsia",
"createTime": "2024-05-30T21:19:36.828888244Z",
"updateTime": "2024-05-30T21:19:36.828888244Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "031f08c0a5aa1e9fb6995e26f5e9270a81f077cd",
"ref": "refs/heads/main"
}
}
}
[21:19:37.258] Task URL: https://cr-buildbucket.appspot.com/build/8746479696351364129
[21:19:37.258] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:2:0) after 4m51s
[21:19:38.145] Received PubSub notification, asking Buildbucket for the build status
[21:19:38.206] Build status: SCHEDULED
[21:19:42.827] Received PubSub notification, asking Buildbucket for the build status
[21:19:42.882] Build status: STARTED
[21:24:28.273] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:2:0)
[21:24:28.367] Build status: STARTED
[21:24:28.367] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:5:0) after 9m52s
[21:34:20.416] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:5:0)
[21:34:20.442] Build status: STARTED
[21:34:20.442] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:6:0) after 1m54s
[21:36:14.468] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:6:0)
[21:36:14.494] Build status: STARTED
[21:36:14.494] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:7:0) after 5m3s
[21:41:17.543] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:7:0)
[21:41:17.573] Build status: STARTED
[21:41:17.573] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:8:0) after 2m49s
[21:44:06.615] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:8:0)
[21:44:06.633] Build status: STARTED
[21:44:06.633] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:9:0) after 4m7s
[21:48:13.653] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:9:0)
[21:48:13.671] Build status: STARTED
[21:48:13.671] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:10:0) after 5m51s
[21:54:04.721] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:10:0)
[21:54:04.739] Build status: STARTED
[21:54:04.739] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:11:0) after 7m33s
[22:01:37.788] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:11:0)
[22:01:37.808] Build status: STARTED
[22:01:37.808] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:12:0) after 1m15s
[22:02:52.839] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:12:0)
[22:02:52.861] Build status: STARTED
[22:02:52.861] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:13:0) after 3m5s
[22:05:57.876] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:13:0)
[22:05:57.896] Build status: STARTED
[22:05:57.896] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:14:0) after 4m12s
[22:10:09.913] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:14:0)
[22:10:09.931] Build status: STARTED
[22:10:09.931] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:15:0) after 5m47s
[22:15:56.910] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:15:0)
[22:15:56.927] Build status: STARTED
[22:15:56.927] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:16:0) after 5m6s
[22:21:02.975] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:16:0)
[22:21:03.006] Build status: STARTED
[22:21:03.006] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:17:0) after 2m14s
[22:23:17.027] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:17:0)
[22:23:17.051] Build status: STARTED
[22:23:17.051] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:18:0) after 1m5s
[22:24:22.073] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:18:0)
[22:24:22.105] Build status: STARTED
[22:24:22.105] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:19:0) after 2m32s
[22:26:54.124] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:19:0)
[22:26:54.142] Build status: STARTED
[22:26:54.142] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:20:0) after 2m30s
[22:29:24.264] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:20:0)
[22:29:24.284] Build status: STARTED
[22:29:24.284] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:21:0) after 1m51s
[22:31:15.258] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:21:0)
[22:31:15.316] Build status: STARTED
[22:31:15.316] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-windows-x64-40be1bb5:8911909758471770496:22:0) after 5m54s
[22:33:14.540] Received PubSub notification, asking Buildbucket for the build status
[22:33:14.571] Build:
{
"id": "8746479696351364129",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-windows-x64"
},
"createdBy": "project:fuchsia",
"createTime": "2024-05-30T21:19:36.828888244Z",
"startTime": "2024-05-30T21:19:42.559143354Z",
"endTime": "2024-05-30T22:33:13.886075779Z",
"updateTime": "2024-05-30T22:33:13.886075779Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "031f08c0a5aa1e9fb6995e26f5e9270a81f077cd",
"ref": "refs/heads/main"
}
}
}
[22:33:14.571] Invocation finished in 1h13m39.147594972s with status SUCCEEDED