[09:58:12.792] New invocation is queued and will start shortly
[09:58:12.792] Triggered by user:fuchsia-ci-builder@fuchsia-infra.iam.gserviceaccount.com
[09:58:13.906] Starting the invocation (attempt 1)
[09:58:13.934] Popped buildset tag "buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/ad35d916cd34154fd88757374d26491611f60cff"
[09:58:13.934] Reconstructed gitiles commit from tags
[09:58:13.934] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[09:58:13.935] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[09:58:13.935] Buildbucket request:
{
"requestId": "8937410374586753616",
"builder": {
"project": "fuchsia",
"bucket": "ci",
"builder": "clang_toolchain.ci.core.x64-debug"
},
"properties": {
"$fuchsia/build": {
"clang_toolchain": {
"source": "isolated",
"version": "2f242d502ce90518a7986aa0a97eb5ce7f3dff091fd661407bd6104607b809bc/577"
}
},
"$fuchsia/checkout": {
"gitiles_commit": {
"host": "fuchsia.googlesource.com",
"id": "8254d137f7cced45d239e20ef1b5b3aa04b0f5ca",
"project": "integration"
}
},
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8937410374586753616",
"job": "fuchsia/clang_toolchain.ci.core.x64-debug",
"triggers": [
{
"buildbucket": {
"properties": {
"$fuchsia/build": {
"clang_toolchain": {
"source": "isolated",
"version": "c2c1fc1dc62516bf2f2c00b44d6d7c90eff580e604375f1ff7cc2ff1da29ea83/577"
}
},
"$fuchsia/checkout": {
"gitiles_commit": {
"host": "fuchsia.googlesource.com",
"id": "8254d137f7cced45d239e20ef1b5b3aa04b0f5ca",
"project": "integration"
}
},
"clang_toolchain": {
"git_repository": "https://llvm.googlesource.com/llvm-project",
"git_revision": "7c540c07a299c7cb02319545995d1005fba9f60f"
}
},
"tags": [
"buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/7c540c07a299c7cb02319545995d1005fba9f60f",
"gitiles_ref:refs/heads/main",
"parent_buildername:clang-linux-x64",
"user_agent:recipe"
]
},
"id": "69c43d7e-e75c-478b-abdc-8017993cad73",
"title": "clang-linux-x64/0"
},
{
"buildbucket": {
"properties": {
"$fuchsia/build": {
"clang_toolchain": {
"source": "isolated",
"version": "82b69141b64e71984fb90b408be699b71a1f4466f05fa197e9ec56298eefc879/577"
}
},
"$fuchsia/checkout": {
"gitiles_commit": {
"host": "fuchsia.googlesource.com",
"id": "8254d137f7cced45d239e20ef1b5b3aa04b0f5ca",
"project": "integration"
}
},
"clang_toolchain": {
"git_repository": "https://llvm.googlesource.com/llvm-project",
"git_revision": "96b5ea6e00bea5cc40dc7c00c495aeb94eced888"
}
},
"tags": [
"buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/96b5ea6e00bea5cc40dc7c00c495aeb94eced888",
"gitiles_ref:refs/heads/main",
"parent_buildername:clang-linux-x64",
"user_agent:recipe"
]
},
"id": "575820c3-a9f2-46d0-82c0-70c4df191478",
"title": "clang-linux-x64/0"
},
{
"buildbucket": {
"properties": {
"$fuchsia/build": {
"clang_toolchain": {
"source": "isolated",
"version": "5a56594ec0cb3593a8024a02e33073d0a8eebed8ac8d73fe4d8b2e19a2c77779/577"
}
},
"$fuchsia/checkout": {
"gitiles_commit": {
"host": "fuchsia.googlesource.com",
"id": "8254d137f7cced45d239e20ef1b5b3aa04b0f5ca",
"project": "integration"
}
},
"clang_toolchain": {
"git_repository": "https://llvm.googlesource.com/llvm-project",
"git_revision": "879e801a916627fab9a90e2b51c9917b629c3392"
}
},
"tags": [
"buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/879e801a916627fab9a90e2b51c9917b629c3392",
"gitiles_ref:refs/heads/main",
"parent_buildername:clang-linux-x64",
"user_agent:recipe"
]
},
"id": "bc331a4e-23c7-482e-a5d6-78989484ba58",
"title": "clang-linux-x64/0"
},
{
"buildbucket": {
"properties": {
"$fuchsia/build": {
"clang_toolchain": {
"source": "isolated",
"version": "2f242d502ce90518a7986aa0a97eb5ce7f3dff091fd661407bd6104607b809bc/577"
}
},
"$fuchsia/checkout": {
"gitiles_commit": {
"host": "fuchsia.googlesource.com",
"id": "8254d137f7cced45d239e20ef1b5b3aa04b0f5ca",
"project": "integration"
}
},
"clang_toolchain": {
"git_repository": "https://llvm.googlesource.com/llvm-project",
"git_revision": "ad35d916cd34154fd88757374d26491611f60cff"
}
},
"tags": [
"buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/ad35d916cd34154fd88757374d26491611f60cff",
"gitiles_ref:refs/heads/main",
"parent_buildername:clang-linux-x64",
"user_agent:recipe"
]
},
"id": "b4eb1993-aab5-4b63-a1ca-05dbc79a261e",
"title": "clang-linux-x64/0"
}
]
},
"clang_toolchain": {
"git_repository": "https://llvm.googlesource.com/llvm-project",
"git_revision": "ad35d916cd34154fd88757374d26491611f60cff"
}
},
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "ad35d916cd34154fd88757374d26491611f60cff",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8937410374586753616"
},
{
"key": "scheduler_job_id",
"value": "fuchsia/clang_toolchain.ci.core.x64-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"
}
}
[09:58:14.447] Scheduled build:
{
"id": "8771980312668053233",
"builder": {
"project": "fuchsia",
"bucket": "ci",
"builder": "clang_toolchain.ci.core.x64-debug"
},
"createdBy": "project:fuchsia",
"createTime": "2023-08-23T09:58:13.995323026Z",
"updateTime": "2023-08-23T09:58:13.995323026Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "ad35d916cd34154fd88757374d26491611f60cff",
"ref": "refs/heads/main"
}
}
}
[09:58:14.447] Task URL: https://cr-buildbucket.appspot.com/build/8771980312668053233
[09:58:14.447] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:2:0) after 1m37s
[09:58:15.205] Received PubSub notification, asking Buildbucket for the build status
[09:58:15.260] Build status: SCHEDULED
[09:58:21.609] Received PubSub notification, asking Buildbucket for the build status
[09:58:21.648] Build status: STARTED
[09:59:51.528] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:2:0)
[09:59:51.631] Build status: STARTED
[09:59:51.631] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:5:0) after 4m31s
[10:04:22.658] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:5:0)
[10:04:22.688] Build status: STARTED
[10:04:22.688] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:6:0) after 8m34s
[10:12:56.986] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:6:0)
[10:12:57.020] Build status: STARTED
[10:12:57.020] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:7:0) after 8m21s
[10:21:18.121] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:7:0)
[10:21:18.151] Build status: STARTED
[10:21:18.151] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:8:0) after 7m26s
[10:28:44.312] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:8:0)
[10:28:44.331] Build status: STARTED
[10:28:44.331] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:9:0) after 7m51s
[10:36:35.355] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:9:0)
[10:36:35.377] Build status: STARTED
[10:36:35.378] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:10:0) after 8m33s
[10:45:08.551] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:10:0)
[10:45:08.567] Build status: STARTED
[10:45:08.567] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:11:0) after 3m54s
[10:49:02.685] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:11:0)
[10:49:02.701] Build status: STARTED
[10:49:02.701] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:12:0) after 5m50s
[10:54:52.725] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:12:0)
[10:54:52.747] Build status: STARTED
[10:54:52.747] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:13:0) after 6m17s
[11:01:09.902] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:13:0)
[11:01:09.928] Build status: STARTED
[11:01:09.928] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:14:0) after 3m36s
[11:04:46.037] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:14:0)
[11:04:46.066] Build status: STARTED
[11:04:46.066] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:15:0) after 5m6s
[11:09:52.087] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:15:0)
[11:09:52.119] Build status: STARTED
[11:09:52.119] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:16:0) after 1m53s
[11:11:45.229] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:16:0)
[11:11:45.252] Build status: STARTED
[11:11:45.252] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:17:0) after 8m6s
[11:19:51.341] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:17:0)
[11:19:51.360] Build status: STARTED
[11:19:51.360] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:18:0) after 6m1s
[11:25:52.480] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:18:0)
[11:25:52.622] Build status: STARTED
[11:25:52.622] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:19:0) after 4m16s
[11:30:08.654] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:19:0)
[11:30:08.673] Build status: STARTED
[11:30:08.673] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:20:0) after 3m8s
[11:33:16.813] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:20:0)
[11:33:16.885] Build status: STARTED
[11:33:16.885] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:21:0) after 6m1s
[11:39:18.141] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:21:0)
[11:39:18.176] Build status: STARTED
[11:39:18.176] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:22:0) after 3m35s
[11:42:54.264] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:22:0)
[11:42:54.287] Build status: STARTED
[11:42:54.287] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:23:0) after 6m3s
[11:48:57.607] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:23:0)
[11:48:57.642] Build status: STARTED
[11:48:57.642] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:24:0) after 4m52s
[11:53:49.921] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:24:0)
[11:53:49.942] Build status: STARTED
[11:53:49.942] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:25:0) after 3m55s
[11:57:44.957] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:25:0)
[11:57:45.016] Build status: STARTED
[11:57:45.016] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:26:0) after 5m46s
[12:03:31.195] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:26:0)
[12:03:31.245] Build status: STARTED
[12:03:31.245] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:27:0) after 4m46s
[12:08:17.839] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:27:0)
[12:08:17.865] Build status: STARTED
[12:08:17.866] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8937410374586753616:28:0) after 9m54s
[12:12:34.192] Received PubSub notification, asking Buildbucket for the build status
[12:12:34.214] Build:
{
"id": "8771980312668053233",
"builder": {
"project": "fuchsia",
"bucket": "ci",
"builder": "clang_toolchain.ci.core.x64-debug"
},
"createdBy": "project:fuchsia",
"createTime": "2023-08-23T09:58:13.995323026Z",
"startTime": "2023-08-23T09:58:19.410640Z",
"endTime": "2023-08-23T12:12:33.799862831Z",
"updateTime": "2023-08-23T12:12:33.799862831Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "ad35d916cd34154fd88757374d26491611f60cff",
"ref": "refs/heads/main"
}
}
}
[12:12:34.214] Invocation finished in 2h14m21.432669492s with status SUCCEEDED