[23:42:24.123] New invocation is queued and will start shortly
[23:42:25.205] Starting the invocation (attempt 1)
[23:42:25.237] Popped buildset tag "buildset:commit/gitiles/fuchsia.googlesource.com/integration/+/7327b90dde2f9e31ad33b21f6ef77af792b73bd6"
[23:42:25.238] Popped gitiles commit info from properties and tags
[23:42:25.238] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[23:42:25.238] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[23:42:25.238] Buildbucket request:
{
"requestId": "8932285090985090928",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "firebase-docs"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8932285090985090928",
"job": "fuchsia/firebase-docs-e5a0ec7f",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "f14871f6e62907ce9fb856c4e79576515e3b0306"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@f14871f6e62907ce9fb856c4e79576515e3b0306",
"title": "f14871f6e62907ce9fb856c4e79576515e3b0306",
"url": "https://fuchsia.googlesource.com/integration/+/f14871f6e62907ce9fb856c4e79576515e3b0306"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "cb87a63b7b13f8ea54f2f12a7139707d747d579b"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@cb87a63b7b13f8ea54f2f12a7139707d747d579b",
"title": "cb87a63b7b13f8ea54f2f12a7139707d747d579b",
"url": "https://fuchsia.googlesource.com/integration/+/cb87a63b7b13f8ea54f2f12a7139707d747d579b"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "5fa5544aa89c9c153c77674445285297f2b8e155"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@5fa5544aa89c9c153c77674445285297f2b8e155",
"title": "5fa5544aa89c9c153c77674445285297f2b8e155",
"url": "https://fuchsia.googlesource.com/integration/+/5fa5544aa89c9c153c77674445285297f2b8e155"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "c2f9572fe828ea787ece2669977eb6c5c75b0322"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@c2f9572fe828ea787ece2669977eb6c5c75b0322",
"title": "c2f9572fe828ea787ece2669977eb6c5c75b0322",
"url": "https://fuchsia.googlesource.com/integration/+/c2f9572fe828ea787ece2669977eb6c5c75b0322"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "c18112e17ecdfd83b05d03dd0d2069e572095df3"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@c18112e17ecdfd83b05d03dd0d2069e572095df3",
"title": "c18112e17ecdfd83b05d03dd0d2069e572095df3",
"url": "https://fuchsia.googlesource.com/integration/+/c18112e17ecdfd83b05d03dd0d2069e572095df3"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "c887a01a006603815f71ecca91591af06a081382"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@c887a01a006603815f71ecca91591af06a081382",
"title": "c887a01a006603815f71ecca91591af06a081382",
"url": "https://fuchsia.googlesource.com/integration/+/c887a01a006603815f71ecca91591af06a081382"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "855a8404030359c29345879a079328be5f50ba24"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@855a8404030359c29345879a079328be5f50ba24",
"title": "855a8404030359c29345879a079328be5f50ba24",
"url": "https://fuchsia.googlesource.com/integration/+/855a8404030359c29345879a079328be5f50ba24"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "0bb37f9cdadc07c22bcf140f3d84c13a75c3ff8b"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@0bb37f9cdadc07c22bcf140f3d84c13a75c3ff8b",
"title": "0bb37f9cdadc07c22bcf140f3d84c13a75c3ff8b",
"url": "https://fuchsia.googlesource.com/integration/+/0bb37f9cdadc07c22bcf140f3d84c13a75c3ff8b"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "c1a26aaca7c079711d0cf045b32a58839b746fe8"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@c1a26aaca7c079711d0cf045b32a58839b746fe8",
"title": "c1a26aaca7c079711d0cf045b32a58839b746fe8",
"url": "https://fuchsia.googlesource.com/integration/+/c1a26aaca7c079711d0cf045b32a58839b746fe8"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "b1d79f1debca441e490746508ead7e530a9f3326"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@b1d79f1debca441e490746508ead7e530a9f3326",
"title": "b1d79f1debca441e490746508ead7e530a9f3326",
"url": "https://fuchsia.googlesource.com/integration/+/b1d79f1debca441e490746508ead7e530a9f3326"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "dba6038b45f2e83b26db3c3305b26daad06462c4"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@dba6038b45f2e83b26db3c3305b26daad06462c4",
"title": "dba6038b45f2e83b26db3c3305b26daad06462c4",
"url": "https://fuchsia.googlesource.com/integration/+/dba6038b45f2e83b26db3c3305b26daad06462c4"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "735ef7bbca514405adbda01f7071b81dc64ac9bc"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@735ef7bbca514405adbda01f7071b81dc64ac9bc",
"title": "735ef7bbca514405adbda01f7071b81dc64ac9bc",
"url": "https://fuchsia.googlesource.com/integration/+/735ef7bbca514405adbda01f7071b81dc64ac9bc"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "1973059aad1c804660d552cde11ad6c44f889603"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@1973059aad1c804660d552cde11ad6c44f889603",
"title": "1973059aad1c804660d552cde11ad6c44f889603",
"url": "https://fuchsia.googlesource.com/integration/+/1973059aad1c804660d552cde11ad6c44f889603"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "6aa2fbad3e68ea30c1e8e02f52a0e96c1b4819be"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@6aa2fbad3e68ea30c1e8e02f52a0e96c1b4819be",
"title": "6aa2fbad3e68ea30c1e8e02f52a0e96c1b4819be",
"url": "https://fuchsia.googlesource.com/integration/+/6aa2fbad3e68ea30c1e8e02f52a0e96c1b4819be"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "83a4161df59ff60c37a2e86a5a3b9ecfb026458b"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@83a4161df59ff60c37a2e86a5a3b9ecfb026458b",
"title": "83a4161df59ff60c37a2e86a5a3b9ecfb026458b",
"url": "https://fuchsia.googlesource.com/integration/+/83a4161df59ff60c37a2e86a5a3b9ecfb026458b"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "9c53f001a857af41ee90f15d865c0593fd26e3fc"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@9c53f001a857af41ee90f15d865c0593fd26e3fc",
"title": "9c53f001a857af41ee90f15d865c0593fd26e3fc",
"url": "https://fuchsia.googlesource.com/integration/+/9c53f001a857af41ee90f15d865c0593fd26e3fc"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "02adbd259fd7a71d17dda058c8abd702e4e559b0"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@02adbd259fd7a71d17dda058c8abd702e4e559b0",
"title": "02adbd259fd7a71d17dda058c8abd702e4e559b0",
"url": "https://fuchsia.googlesource.com/integration/+/02adbd259fd7a71d17dda058c8abd702e4e559b0"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "de7b52d523f4bcd1dfa0cc7b00bd1f8b1f20d365"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@de7b52d523f4bcd1dfa0cc7b00bd1f8b1f20d365",
"title": "de7b52d523f4bcd1dfa0cc7b00bd1f8b1f20d365",
"url": "https://fuchsia.googlesource.com/integration/+/de7b52d523f4bcd1dfa0cc7b00bd1f8b1f20d365"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "77ffda9ba9f93b3cf67d14c318ece95125341ba5"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@77ffda9ba9f93b3cf67d14c318ece95125341ba5",
"title": "77ffda9ba9f93b3cf67d14c318ece95125341ba5",
"url": "https://fuchsia.googlesource.com/integration/+/77ffda9ba9f93b3cf67d14c318ece95125341ba5"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "f9ada761535e6c140e6ebf3f20ff3d27c59066b4"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@f9ada761535e6c140e6ebf3f20ff3d27c59066b4",
"title": "f9ada761535e6c140e6ebf3f20ff3d27c59066b4",
"url": "https://fuchsia.googlesource.com/integration/+/f9ada761535e6c140e6ebf3f20ff3d27c59066b4"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "96c887d077cce6753e338fcf2000d876d55bcad2"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@96c887d077cce6753e338fcf2000d876d55bcad2",
"title": "96c887d077cce6753e338fcf2000d876d55bcad2",
"url": "https://fuchsia.googlesource.com/integration/+/96c887d077cce6753e338fcf2000d876d55bcad2"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://fuchsia.googlesource.com/integration",
"revision": "7327b90dde2f9e31ad33b21f6ef77af792b73bd6"
},
"id": "https://fuchsia.googlesource.com/integration/+/refs/heads/main@7327b90dde2f9e31ad33b21f6ef77af792b73bd6",
"title": "7327b90dde2f9e31ad33b21f6ef77af792b73bd6",
"url": "https://fuchsia.googlesource.com/integration/+/7327b90dde2f9e31ad33b21f6ef77af792b73bd6"
}
]
}
},
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "7327b90dde2f9e31ad33b21f6ef77af792b73bd6",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8932285090985090928"
},
{
"key": "scheduler_job_id",
"value": "fuchsia/firebase-docs-e5a0ec7f"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[23:42:25.703] Scheduled build:
{
"id": "8766855029100417313",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "firebase-docs"
},
"createdBy": "project:fuchsia",
"createTime": "2023-10-18T23:42:25.297185646Z",
"updateTime": "2023-10-18T23:42:25.297185646Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "7327b90dde2f9e31ad33b21f6ef77af792b73bd6",
"ref": "refs/heads/main"
}
}
}
[23:42:25.703] Task URL: https://cr-buildbucket.appspot.com/build/8766855029100417313
[23:42:25.703] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:2:0) after 5m39s
[23:42:26.699] Received PubSub notification, asking Buildbucket for the build status
[23:42:26.717] Build status: SCHEDULED
[23:43:11.872] Received PubSub notification, asking Buildbucket for the build status
[23:43:12.154] Build status: STARTED
[23:48:04.714] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:2:0)
[23:48:04.732] Build status: STARTED
[23:48:04.732] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:5:0) after 6m49s
[23:54:53.885] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:5:0)
[23:54:53.914] Build status: STARTED
[23:54:53.914] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:6:0) after 5m28s
[00:00:21.954] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:6:0)
[00:00:21.998] Build status: STARTED
[00:00:21.998] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:7:0) after 4m59s
[00:05:21.021] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:7:0)
[00:05:21.039] Build status: STARTED
[00:05:21.039] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:8:0) after 8m28s
[00:13:49.659] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:8:0)
[00:13:49.729] Build status: STARTED
[00:13:49.729] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:9:0) after 1m55s
[00:15:44.858] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:9:0)
[00:15:44.882] Build status: STARTED
[00:15:44.882] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:10:0) after 8m50s
[00:24:34.905] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:10:0)
[00:24:34.923] Build status: STARTED
[00:24:34.923] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:11:0) after 4m35s
[00:29:09.963] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:11:0)
[00:29:10.092] Build status: STARTED
[00:29:10.092] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:12:0) after 5m24s
[00:34:34.161] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:12:0)
[00:34:34.215] Build status: STARTED
[00:34:34.215] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:13:0) after 8m38s
[00:43:12.294] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:13:0)
[00:43:12.315] Build status: STARTED
[00:43:12.315] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:14:0) after 1m24s
[00:44:36.433] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:14:0)
[00:44:36.450] Build status: STARTED
[00:44:36.450] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:15:0) after 7m12s
[00:51:48.663] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:15:0)
[00:51:48.687] Build status: STARTED
[00:51:48.687] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:16:0) after 1m59s
[00:53:47.708] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:16:0)
[00:53:47.729] Build status: STARTED
[00:53:47.729] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:17:0) after 4m34s
[00:58:21.851] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:17:0)
[00:58:21.869] Build status: STARTED
[00:58:21.869] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:18:0) after 3m52s
[01:02:13.924] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:18:0)
[01:02:13.947] Build status: STARTED
[01:02:13.947] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:19:0) after 7m34s
[01:09:48.008] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:19:0)
[01:09:48.033] Build status: STARTED
[01:09:48.033] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:20:0) after 2m37s
[01:12:25.385] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:20:0)
[01:12:25.539] Build status: STARTED
[01:12:25.539] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:21:0) after 9m32s
[01:21:57.558] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:21:0)
[01:21:57.574] Build status: STARTED
[01:21:57.574] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:22:0) after 7m58s
[01:29:55.916] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:22:0)
[01:29:55.931] Build status: STARTED
[01:29:55.931] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:23:0) after 7m29s
[01:37:24.954] Handling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:23:0)
[01:37:24.977] Build status: STARTED
[01:37:24.977] Scheduling timer "check-buildbucket-build-status" (fuchsia/firebase-docs-e5a0ec7f:8932285090985090928:24:0) after 3m2s
[01:37:52.038] Received PubSub notification, asking Buildbucket for the build status
[01:37:52.118] Build:
{
"id": "8766855029100417313",
"builder": {
"project": "fuchsia",
"bucket": "global.ci",
"builder": "firebase-docs"
},
"createdBy": "project:fuchsia",
"createTime": "2023-10-18T23:42:25.297185646Z",
"startTime": "2023-10-18T23:43:11.352217Z",
"endTime": "2023-10-19T01:37:51.509314905Z",
"updateTime": "2023-10-19T01:37:51.509314905Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "fuchsia.googlesource.com",
"project": "integration",
"id": "7327b90dde2f9e31ad33b21f6ef77af792b73bd6",
"ref": "refs/heads/main"
}
}
}
[01:37:52.118] Invocation finished in 1h55m28.001620695s with status SUCCEEDED