[07:42:30.786] New invocation is queued and will start shortly
[07:42:32.058] Starting the invocation (attempt 1)
[07:42:32.084] Popped buildset tag "buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/416884544e0210c32c113f02c3d3881e78aac6a4"
[07:42:32.084] Popped gitiles commit info from properties and tags
[07:42:32.084] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[07:42:32.084] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[07:42:32.085] Buildbucket request:
{
"requestId": "8932254885015793008",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-mac-x64"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8932254885015793008",
"job": "fuchsia/toolchain.ci-clang-mac-x64-40be1bb5",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "59d2dc239b053d124ebc82937da2e7a38d0ec11e"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@59d2dc239b053d124ebc82937da2e7a38d0ec11e",
"title": "59d2dc239b053d124ebc82937da2e7a38d0ec11e",
"url": "https://llvm.googlesource.com/llvm-project/+/59d2dc239b053d124ebc82937da2e7a38d0ec11e"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "e4ea0997486000b460c4875a00301b73b3c0d6a7"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@e4ea0997486000b460c4875a00301b73b3c0d6a7",
"title": "e4ea0997486000b460c4875a00301b73b3c0d6a7",
"url": "https://llvm.googlesource.com/llvm-project/+/e4ea0997486000b460c4875a00301b73b3c0d6a7"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "cd205efb9d788f55b8051f6ed5cf01dc1bba982e"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@cd205efb9d788f55b8051f6ed5cf01dc1bba982e",
"title": "cd205efb9d788f55b8051f6ed5cf01dc1bba982e",
"url": "https://llvm.googlesource.com/llvm-project/+/cd205efb9d788f55b8051f6ed5cf01dc1bba982e"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "39427b10985f034b85a12e8b229a4f816d844afb"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@39427b10985f034b85a12e8b229a4f816d844afb",
"title": "39427b10985f034b85a12e8b229a4f816d844afb",
"url": "https://llvm.googlesource.com/llvm-project/+/39427b10985f034b85a12e8b229a4f816d844afb"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "a3bbab18527b57c19ef0d55c68727af01ed55b1e"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@a3bbab18527b57c19ef0d55c68727af01ed55b1e",
"title": "a3bbab18527b57c19ef0d55c68727af01ed55b1e",
"url": "https://llvm.googlesource.com/llvm-project/+/a3bbab18527b57c19ef0d55c68727af01ed55b1e"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "7f1733a252cbbad74445bd54dc95aeec52bb3199"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@7f1733a252cbbad74445bd54dc95aeec52bb3199",
"title": "7f1733a252cbbad74445bd54dc95aeec52bb3199",
"url": "https://llvm.googlesource.com/llvm-project/+/7f1733a252cbbad74445bd54dc95aeec52bb3199"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "278e533ee9fddf0f8aa13964de07010426f55e52"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@278e533ee9fddf0f8aa13964de07010426f55e52",
"title": "278e533ee9fddf0f8aa13964de07010426f55e52",
"url": "https://llvm.googlesource.com/llvm-project/+/278e533ee9fddf0f8aa13964de07010426f55e52"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "e63ab13c82e78f65baca48d5b5e4f6ea8d55dbc7"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@e63ab13c82e78f65baca48d5b5e4f6ea8d55dbc7",
"title": "e63ab13c82e78f65baca48d5b5e4f6ea8d55dbc7",
"url": "https://llvm.googlesource.com/llvm-project/+/e63ab13c82e78f65baca48d5b5e4f6ea8d55dbc7"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "db9b6f4987394c56102d08566422a867cde01a6d"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@db9b6f4987394c56102d08566422a867cde01a6d",
"title": "db9b6f4987394c56102d08566422a867cde01a6d",
"url": "https://llvm.googlesource.com/llvm-project/+/db9b6f4987394c56102d08566422a867cde01a6d"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "4d8ea66d74cd355c267b27ca2dd04c821ae2331f"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@4d8ea66d74cd355c267b27ca2dd04c821ae2331f",
"title": "4d8ea66d74cd355c267b27ca2dd04c821ae2331f",
"url": "https://llvm.googlesource.com/llvm-project/+/4d8ea66d74cd355c267b27ca2dd04c821ae2331f"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "411c4edeef076bd2e01b104fe095ba381600a3d3"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@411c4edeef076bd2e01b104fe095ba381600a3d3",
"title": "411c4edeef076bd2e01b104fe095ba381600a3d3",
"url": "https://llvm.googlesource.com/llvm-project/+/411c4edeef076bd2e01b104fe095ba381600a3d3"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "416884544e0210c32c113f02c3d3881e78aac6a4"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@416884544e0210c32c113f02c3d3881e78aac6a4",
"title": "416884544e0210c32c113f02c3d3881e78aac6a4",
"url": "https://llvm.googlesource.com/llvm-project/+/416884544e0210c32c113f02c3d3881e78aac6a4"
}
]
}
},
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "416884544e0210c32c113f02c3d3881e78aac6a4",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8932254885015793008"
},
{
"key": "scheduler_job_id",
"value": "fuchsia/toolchain.ci-clang-mac-x64-40be1bb5"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[07:42:32.521] Scheduled build:
{
"id": "8766824822929840609",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-mac-x64"
},
"createdBy": "project:fuchsia",
"createTime": "2023-10-19T07:42:32.147803150Z",
"updateTime": "2023-10-19T07:42:32.147803150Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "416884544e0210c32c113f02c3d3881e78aac6a4",
"ref": "refs/heads/main"
}
}
}
[07:42:32.521] Task URL: https://cr-buildbucket.appspot.com/build/8766824822929840609
[07:42:32.521] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:2:0) after 8m24s
[07:42:33.466] Received PubSub notification, asking Buildbucket for the build status
[07:42:33.528] Build status: SCHEDULED
[07:50:56.540] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:2:0)
[07:50:56.573] Build status: SCHEDULED
[07:50:56.573] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:4:0) after 6m40s
[07:57:10.892] Received PubSub notification, asking Buildbucket for the build status
[07:57:10.931] Build status: STARTED
[07:57:36.622] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:4:0)
[07:57:36.642] Build status: STARTED
[07:57:36.642] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:6:0) after 2m50s
[08:00:26.664] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:6:0)
[08:00:26.714] Build status: STARTED
[08:00:26.714] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:7:0) after 3m59s
[08:04:26.114] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:7:0)
[08:04:26.134] Build status: STARTED
[08:04:26.134] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:8:0) after 9m7s
[08:13:33.241] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:8:0)
[08:13:33.289] Build status: STARTED
[08:13:33.289] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:9:0) after 9m26s
[08:22:59.493] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:9:0)
[08:22:59.513] Build status: STARTED
[08:22:59.513] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:10:0) after 4m6s
[08:27:05.533] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:10:0)
[08:27:05.561] Build status: STARTED
[08:27:05.561] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:11:0) after 2m10s
[08:29:15.602] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:11:0)
[08:29:15.621] Build status: STARTED
[08:29:15.621] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:12:0) after 4m26s
[08:33:41.659] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:12:0)
[08:33:41.679] Build status: STARTED
[08:33:41.679] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:13:0) after 7m2s
[08:40:43.709] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:13:0)
[08:40:43.735] Build status: STARTED
[08:40:43.735] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:14:0) after 5m8s
[08:45:51.828] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:14:0)
[08:45:51.849] Build status: STARTED
[08:45:51.849] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:15:0) after 1m32s
[08:47:23.983] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:15:0)
[08:47:24.063] Build status: STARTED
[08:47:24.063] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:16:0) after 4m33s
[08:51:57.119] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:16:0)
[08:51:57.147] Build status: STARTED
[08:51:57.147] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:17:0) after 2m3s
[08:54:00.171] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:17:0)
[08:54:00.219] Build status: STARTED
[08:54:00.219] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:18:0) after 5m47s
[08:59:47.268] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:18:0)
[08:59:47.295] Build status: STARTED
[08:59:47.295] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:19:0) after 1m20s
[09:01:07.340] Handling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:19:0)
[09:01:07.368] Build status: STARTED
[09:01:07.368] Scheduling timer "check-buildbucket-build-status" (fuchsia/toolchain.ci-clang-mac-x64-40be1bb5:8932254885015793008:20:0) after 6m34s
[09:06:26.264] Received PubSub notification, asking Buildbucket for the build status
[09:06:26.285] Build:
{
"id": "8766824822929840609",
"builder": {
"project": "fuchsia",
"bucket": "toolchain.ci",
"builder": "clang-mac-x64"
},
"createdBy": "project:fuchsia",
"createTime": "2023-10-19T07:42:32.147803150Z",
"startTime": "2023-10-19T07:57:10.362588Z",
"endTime": "2023-10-19T09:06:25.873913818Z",
"updateTime": "2023-10-19T09:06:25.873913818Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "416884544e0210c32c113f02c3d3881e78aac6a4",
"ref": "refs/heads/main"
}
}
}
[09:06:26.285] Invocation finished in 1h23m55.511769856s with status SUCCEEDED