[46.431889] Initializing watchdogs
[46.432048]   /dev/watchdog0
[46.438997] [001/171] (960s left) i915_module_load (load)
[46.900889] Starting subtest: load
[48.426957] Subtest load: SUCCESS (1.526s)
[48.469388] [002/171] (958s left) core_auth (basic-auth)
[48.649505] Starting subtest: basic-auth
[48.650693] Subtest basic-auth: SUCCESS (0.001s)
[48.687673] [003/171] (958s left) debugfs_test (read_all_entries)
[48.831581] Starting subtest: read_all_entries
[48.875256] Subtest read_all_entries: SUCCESS (0.044s)
[49.070279] [004/171] (957s left) debugfs_test (basic-hwmon)
[49.187820] Starting subtest: basic-hwmon
[49.190047] Subtest basic-hwmon: SKIP (0.000s)
[49.376155] [005/171] (957s left) fbdev (eof)
[50.649168] Subtest eof: SKIP (0.000s)
[50.662405] [006/171] (956s left) fbdev (info)
[50.806842] Subtest info: SKIP (0.000s)
[50.820753] [007/171] (956s left) fbdev (nullptr)
[50.942322] Subtest nullptr: SKIP (0.000s)
[50.956824] [008/171] (956s left) fbdev (read)
[51.088733] Subtest read: SKIP (0.000s)
[51.102812] [009/171] (956s left) fbdev (write)
[51.224454] Subtest write: SKIP (0.000s)
[51.238359] [010/171] (955s left) gem_basic (bad-close)
[51.344375] Starting subtest: bad-close
[51.346523] Subtest bad-close: SUCCESS (0.000s)
[51.361644] [011/171] (955s left) gem_basic (create-close)
[51.591736] Starting subtest: create-close
[51.595361] Subtest create-close: SUCCESS (0.000s)
[51.616443] [012/171] (955s left) gem_basic (create-fd-close)
[51.869950] Starting subtest: create-fd-close
[51.874222] Subtest create-fd-close: SUCCESS (0.001s)
[51.913405] [013/171] (955s left) gem_busy (busy@all-engines)
[52.039378] Starting subtest: busy
[52.040408] Starting dynamic subtest: all-engines
[52.094467] Dynamic subtest all-engines: SUCCESS (0.055s)
[52.095664] Subtest busy: SUCCESS (0.055s)
[52.435260] [014/171] (954s left) gem_close_race (basic-process)
[52.577814] Starting subtest: basic-process
[52.636826] Subtest basic-process: SUCCESS (0.059s)
[52.802749] [015/171] (954s left) gem_close_race (basic-threads)
[52.938220] Starting subtest: basic-threads
[54.095404] Subtest basic-threads: SUCCESS (1.157s)
[54.258361] [016/171] (953s left) gem_ctx_create (basic)
[54.504220] Starting subtest: basic
[54.505672] Subtest basic: SUCCESS (0.000s)
[54.646881] [017/171] (952s left) gem_ctx_create (basic-files)
[54.767491] Starting subtest: basic-files
[56.787996] Subtest basic-files: SUCCESS (2.020s)
[56.947087] [018/171] (950s left) gem_ctx_exec (basic)
[57.144352] Starting subtest: basic
[57.148489] Subtest basic: SUCCESS (0.005s)
[57.209375] [019/171] (950s left) gem_exec_basic (basic)
[57.336960] Starting subtest: basic
[57.338267] Starting dynamic subtest: rcs0-smem
[57.342109] Dynamic subtest rcs0-smem: SUCCESS (0.003s)
[57.351126] Starting dynamic subtest: bcs0-smem
[57.352914] Dynamic subtest bcs0-smem: SUCCESS (0.001s)
[57.358724] Starting dynamic subtest: vcs0-smem
[57.359837] Dynamic subtest vcs0-smem: SUCCESS (0.001s)
[57.365527] Starting dynamic subtest: vcs1-smem
[57.366714] Dynamic subtest vcs1-smem: SUCCESS (0.000s)
[57.372280] Starting dynamic subtest: vecs0-smem
[57.373463] Dynamic subtest vecs0-smem: SUCCESS (0.001s)
[57.374636] Subtest basic: SUCCESS (0.006s)
[57.496673] [020/171] (949s left) gem_exec_create (basic)
[57.627374] Starting subtest: basic
[57.628356] Starting dynamic subtest: smem
[59.712932] Dynamic subtest smem: SUCCESS (2.048s)
[59.715925] Subtest basic: SUCCESS (2.048s)
[59.823420] [021/171] (947s left) gem_exec_fence (basic-busy)
[60.096505] Starting subtest: basic-busy
[60.098971] Starting dynamic subtest: rcs0
[60.133681] Dynamic subtest rcs0: SUCCESS (0.038s)
[60.141439] Starting dynamic subtest: bcs0
[60.158781] Dynamic subtest bcs0: SUCCESS (0.025s)
[60.166555] Starting dynamic subtest: vcs0
[60.183880] Dynamic subtest vcs0: SUCCESS (0.025s)
[60.192653] Starting dynamic subtest: vcs1
[60.207547] Dynamic subtest vcs1: SUCCESS (0.023s)
[60.216420] Starting dynamic subtest: vecs0
[60.227573] Dynamic subtest vecs0: SUCCESS (0.021s)
[60.228914] Subtest basic-busy: SUCCESS (0.133s)
[60.852283] [022/171] (946s left) gem_exec_fence (basic-wait)
[61.117100] Starting subtest: basic-wait
[61.118942] Starting dynamic subtest: rcs0
[61.149432] Dynamic subtest rcs0: SUCCESS (0.032s)
[61.161525] Starting dynamic subtest: bcs0
[61.175526] Dynamic subtest bcs0: SUCCESS (0.026s)
[61.182416] Starting dynamic subtest: vcs0
[61.195553] Dynamic subtest vcs0: SUCCESS (0.020s)
[61.203293] Starting dynamic subtest: vcs1
[61.220579] Dynamic subtest vcs1: SUCCESS (0.025s)
[61.227729] Starting dynamic subtest: vecs0
[61.246798] Dynamic subtest vecs0: SUCCESS (0.026s)
[61.248241] Subtest basic-wait: SUCCESS (0.130s)
[61.845728] [023/171] (945s left) gem_exec_fence (basic-await)
[62.106973] Starting subtest: basic-await
[62.109348] Starting dynamic subtest: rcs0
[62.221647] Dynamic subtest rcs0: SUCCESS (0.108s)
[62.228655] Starting dynamic subtest: bcs0
[62.315653] Dynamic subtest bcs0: SUCCESS (0.101s)
[62.322772] Starting dynamic subtest: vcs0
[62.416831] Dynamic subtest vcs0: SUCCESS (0.101s)
[62.427081] Starting dynamic subtest: vcs1
[62.598861] Dynamic subtest vcs1: SUCCESS (0.121s)
[62.620308] Starting dynamic subtest: vecs0
[62.698467] Dynamic subtest vecs0: SUCCESS (0.160s)
[62.700943] Subtest basic-await: SUCCESS (0.592s)
[63.336048] [024/171] (944s left) gem_exec_fence (nb-await)
[63.611263] Starting subtest: nb-await
[63.613325] Starting dynamic subtest: rcs0
[63.684252] Dynamic subtest rcs0: SUCCESS (0.074s)
[63.705276] Starting dynamic subtest: bcs0
[63.776234] Dynamic subtest bcs0: SUCCESS (0.084s)
[63.808668] Starting dynamic subtest: vcs0
[63.866307] Dynamic subtest vcs0: SUCCESS (0.095s)
[63.885282] Starting dynamic subtest: vcs1
[63.949282] Dynamic subtest vcs1: SUCCESS (0.083s)
[63.972318] Starting dynamic subtest: vecs0
[64.035798] Dynamic subtest vecs0: SUCCESS (0.088s)
[64.038613] Subtest nb-await: SUCCESS (0.426s)
[64.662729] [025/171] (942s left) gem_exec_gttfill (basic)
[64.797952] Starting subtest: basic
[72.358861] Subtest basic: SUCCESS (7.505s)
[72.436925] [026/171] (935s left) gem_exec_parallel (engines)
[72.640958] Starting subtest: engines
[72.721448] Starting dynamic subtest: basic
[75.207488] Dynamic subtest basic: SUCCESS (2.519s)
[75.221658] Starting dynamic subtest: contexts
[78.172497] Dynamic subtest contexts: SUCCESS (2.956s)
[78.180294] Starting dynamic subtest: fds
[82.891139] Dynamic subtest fds: SUCCESS (4.745s)
[82.898977] Starting dynamic subtest: userptr
[85.395140] Dynamic subtest userptr: SUCCESS (2.486s)
[85.398270] Subtest engines: SUCCESS (12.707s)
[85.506801] [027/171] (922s left) gem_exec_store (basic)
[85.637632] Starting subtest: basic
[85.695052] Subtest basic: SUCCESS (0.057s)
[85.844174] [028/171] (921s left) gem_flink_basic (bad-flink)
[85.959229] Starting subtest: bad-flink
[85.960477] Subtest bad-flink: SUCCESS (0.000s)
[85.976441] [029/171] (921s left) gem_flink_basic (bad-open)
[86.076755] Starting subtest: bad-open
[86.078437] Subtest bad-open: SUCCESS (0.000s)
[86.197458] [030/171] (921s left) gem_flink_basic (basic)
[86.488318] Starting subtest: basic
[86.490849] Subtest basic: SUCCESS (0.000s)
[86.531354] [031/171] (921s left) gem_flink_basic (double-flink)
[86.636297] Starting subtest: double-flink
[86.637338] Subtest double-flink: SUCCESS (0.000s)
[86.663836] [032/171] (921s left) gem_flink_basic (flink-lifetime)
[86.761859] Starting subtest: flink-lifetime
[86.763225] Subtest flink-lifetime: SUCCESS (0.001s)
[86.798981] [033/171] (920s left) gem_huc_copy (huc-copy)
[86.907983] Starting subtest: huc-copy
[86.910086] Subtest huc-copy: SKIP (0.000s)
[86.945256] [034/171] (920s left) gem_linear_blits (basic)
[87.200477] Starting subtest: basic
[87.213210] Subtest basic: SUCCESS (0.013s)
[87.269997] [035/171] (920s left) gem_mmap (basic)
[87.482449] Starting subtest: basic
[87.495556] Subtest basic: SUCCESS (0.002s)
[87.524373] [036/171] (920s left) gem_mmap_gtt (basic)
[87.627958] Starting subtest: basic
[87.629312] Subtest basic: SUCCESS (0.001s)
[87.645382] [037/171] (920s left) gem_render_linear_blits (basic)
[87.756307] Starting subtest: basic
[87.798109] Subtest basic: SUCCESS (0.042s)
[87.825092] [038/171] (920s left) gem_render_tiled_blits (basic)
[87.933550] Starting subtest: basic
[87.978620] Subtest basic: SUCCESS (0.045s)
[88.032336] [039/171] (919s left) gem_ringfill (basic-all)
[88.371573] Starting subtest: basic-all
[89.602286] Subtest basic-all: SUCCESS (1.175s)
[89.618252] [040/171] (918s left) gem_softpin (allocator-basic)
[89.735236] Starting subtest: allocator-basic
[89.928219] Subtest allocator-basic: SUCCESS (0.137s)
[89.941979] [041/171] (918s left) gem_softpin (allocator-basic-reserve)
[90.053030] Starting subtest: allocator-basic-reserve
[90.250409] Subtest allocator-basic-reserve: SUCCESS (0.141s)
[90.277978] [042/171] (917s left) gem_softpin (safe-alignment)
[90.408016] Starting subtest: safe-alignment
[90.426561] Subtest safe-alignment: SUCCESS (0.019s)
[90.466181] [043/171] (917s left) gem_sync (basic-all)
[90.586745] Starting subtest: basic-all
[93.261819] Subtest basic-all: SUCCESS (2.636s)
[93.394384] [044/171] (914s left) gem_sync (basic-each)
[93.534511] Starting subtest: basic-each
[95.813619] Subtest basic-each: SUCCESS (2.279s)
[95.984124] [045/171] (912s left) gem_tiled_blits (basic)
[96.285254] Starting subtest: basic
[96.313171] Subtest basic: SUCCESS (0.028s)
[96.404805] [046/171] (911s left) gem_tiled_fence_blits (basic)
[97.119760] Starting subtest: basic
[97.134803] Subtest basic: SUCCESS (0.015s)
[97.190583] [047/171] (910s left) gem_tiled_pread_basic
[97.532769] [048/171] (910s left) gem_wait (busy@all-engines)
[97.680272] Starting subtest: busy
[97.681842] Starting dynamic subtest: all-engines
[98.264157] Dynamic subtest all-engines: SUCCESS (0.581s)
[98.266137] Subtest busy: SUCCESS (0.582s)
[98.419032] [049/171] (909s left) gem_wait (wait@all-engines)
[98.553419] Starting subtest: wait
[98.554899] Starting dynamic subtest: all-engines
[99.648624] Dynamic subtest all-engines: SUCCESS (1.052s)
[99.651140] Subtest wait: SUCCESS (1.053s)
[99.787332] [050/171] (908s left) i915_getparams_basic (basic-eu-total)
[99.916520] Starting subtest: basic-eu-total
[99.919431] Subtest basic-eu-total: SUCCESS (0.000s)
[99.941923] [051/171] (908s left) i915_getparams_basic (basic-subslice-total)
[100.041923] Starting subtest: basic-subslice-total
[100.044325] Subtest basic-subslice-total: SUCCESS (0.000s)
[100.062404] [052/171] (908s left) i915_hangman (error-state-basic)
[100.183127] Starting subtest: error-state-basic
[100.193893] Subtest error-state-basic: SUCCESS (0.010s)
[100.218575] [053/171] (908s left) i915_pciid
[100.545556] [054/171] (907s left) kms_addfb_basic (addfb25-bad-modifier)
[100.939185] Starting subtest: addfb25-bad-modifier
[100.940339] Subtest addfb25-bad-modifier: SUCCESS (0.000s)
[101.437761] [055/171] (906s left) kms_addfb_basic (addfb25-framebuffer-vs-set-tiling)
[101.777169] Starting subtest: addfb25-framebuffer-vs-set-tiling
[101.778347] Subtest addfb25-framebuffer-vs-set-tiling: SUCCESS (0.000s)
[102.283777] [056/171] (906s left) kms_addfb_basic (addfb25-modifier-no-flag)
[102.616998] Starting subtest: addfb25-modifier-no-flag
[102.618150] Subtest addfb25-modifier-no-flag: SUCCESS (0.000s)
[103.119387] [057/171] (905s left) kms_addfb_basic (addfb25-x-tiled-legacy)
[103.458126] Starting subtest: addfb25-x-tiled-legacy
[103.459296] Subtest addfb25-x-tiled-legacy: SUCCESS (0.000s)
[103.963405] [058/171] (904s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy)
[104.303071] Starting subtest: addfb25-x-tiled-mismatch-legacy
[104.304200] Subtest addfb25-x-tiled-mismatch-legacy: SUCCESS (0.000s)
[104.795535] [059/171] (903s left) kms_addfb_basic (addfb25-yf-tiled-legacy)
[105.363403] Starting subtest: addfb25-yf-tiled-legacy
[105.364370] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.000s)
[105.640876] [060/171] (902s left) kms_addfb_basic (addfb25-y-tiled-legacy)
[106.204953] Starting subtest: addfb25-y-tiled-legacy
[106.206660] Subtest addfb25-y-tiled-legacy: SUCCESS (0.000s)
[106.478967] [061/171] (901s left) kms_addfb_basic (addfb25-y-tiled-small-legacy)
[107.050361] Starting subtest: addfb25-y-tiled-small-legacy
[107.051774] Subtest addfb25-y-tiled-small-legacy: SUCCESS (0.000s)
[107.318277] [062/171] (901s left) kms_addfb_basic (bad-pitch-0)
[107.419207] Starting subtest: bad-pitch-0
[107.420352] Subtest bad-pitch-0: SUCCESS (0.000s)
[108.144080] [063/171] (900s left) kms_addfb_basic (bad-pitch-1024)
[108.245101] Starting subtest: bad-pitch-1024
[108.246759] Subtest bad-pitch-1024: SUCCESS (0.000s)
[108.976302] [064/171] (899s left) kms_addfb_basic (bad-pitch-128)
[109.076544] Starting subtest: bad-pitch-128
[109.077839] Subtest bad-pitch-128: SUCCESS (0.000s)
[109.816442] [065/171] (898s left) kms_addfb_basic (bad-pitch-256)
[109.917076] Starting subtest: bad-pitch-256
[109.918263] Subtest bad-pitch-256: SUCCESS (0.000s)
[110.645907] [066/171] (897s left) kms_addfb_basic (bad-pitch-32)
[110.748177] Starting subtest: bad-pitch-32
[110.749348] Subtest bad-pitch-32: SUCCESS (0.000s)
[111.491481] [067/171] (897s left) kms_addfb_basic (bad-pitch-63)
[111.590832] Starting subtest: bad-pitch-63
[111.591994] Subtest bad-pitch-63: SUCCESS (0.000s)
[112.345858] [068/171] (896s left) kms_addfb_basic (bad-pitch-65536)
[112.445991] Starting subtest: bad-pitch-65536
[112.447202] Subtest bad-pitch-65536: SUCCESS (0.000s)
[113.181503] [069/171] (895s left) kms_addfb_basic (bad-pitch-999)
[113.282257] Starting subtest: bad-pitch-999
[113.283473] Subtest bad-pitch-999: SUCCESS (0.000s)
[114.028389] [070/171] (894s left) kms_addfb_basic (basic)
[114.128903] Starting subtest: basic
[114.130039] Subtest basic: SUCCESS (0.000s)
[114.868713] [071/171] (893s left) kms_addfb_basic (basic-x-tiled-legacy)
[115.668730] Starting subtest: basic-x-tiled-legacy
[115.670040] Subtest basic-x-tiled-legacy: SUCCESS (0.000s)
[115.697313] [072/171] (892s left) kms_addfb_basic (basic-y-tiled-legacy)
[116.504557] Starting subtest: basic-y-tiled-legacy
[116.505805] Subtest basic-y-tiled-legacy: SUCCESS (0.000s)
[116.537783] [073/171] (892s left) kms_addfb_basic (bo-too-small)
[116.872086] Starting subtest: bo-too-small
[116.873256] Subtest bo-too-small: SUCCESS (0.000s)
[117.370166] [074/171] (891s left) kms_addfb_basic (bo-too-small-due-to-tiling)
[117.704373] Starting subtest: bo-too-small-due-to-tiling
[117.705510] Subtest bo-too-small-due-to-tiling: SUCCESS (0.000s)
[118.205925] [075/171] (890s left) kms_addfb_basic (clobberred-modifier)
[118.305332] Starting subtest: clobberred-modifier
[118.306471] Subtest clobberred-modifier: SUCCESS (0.000s)
[119.036403] [076/171] (889s left) kms_addfb_basic (framebuffer-vs-set-tiling)
[119.836593] Starting subtest: framebuffer-vs-set-tiling
[119.837861] Subtest framebuffer-vs-set-tiling: SUCCESS (0.000s)
[119.874274] [077/171] (888s left) kms_addfb_basic (invalid-get-prop)
[120.668789] Starting subtest: invalid-get-prop
[120.670599] Subtest invalid-get-prop: SUCCESS (0.000s)
[120.695869] [078/171] (888s left) kms_addfb_basic (invalid-get-prop-any)
[121.503647] Starting subtest: invalid-get-prop-any
[121.504806] Subtest invalid-get-prop-any: SUCCESS (0.000s)
[121.537840] [079/171] (887s left) kms_addfb_basic (invalid-set-prop)
[122.337410] Starting subtest: invalid-set-prop
[122.338412] Subtest invalid-set-prop: SUCCESS (0.000s)
[122.364931] [080/171] (886s left) kms_addfb_basic (invalid-set-prop-any)
[123.179566] Starting subtest: invalid-set-prop-any
[123.180757] Subtest invalid-set-prop-any: SUCCESS (0.000s)
[123.211668] [081/171] (885s left) kms_addfb_basic (no-handle)
[123.312570] Starting subtest: no-handle
[123.313813] Subtest no-handle: SUCCESS (0.000s)
[124.052693] [082/171] (884s left) kms_addfb_basic (size-max)
[124.387865] Starting subtest: size-max
[124.389122] Subtest size-max: SUCCESS (0.000s)
[124.893920] [083/171] (883s left) kms_addfb_basic (small-bo)
[125.232027] Starting subtest: small-bo
[125.233163] Subtest small-bo: SUCCESS (0.000s)
[125.730254] [084/171] (883s left) kms_addfb_basic (tile-pitch-mismatch)
[126.533992] Starting subtest: tile-pitch-mismatch
[126.535236] Subtest tile-pitch-mismatch: SUCCESS (0.000s)
[126.562265] [085/171] (882s left) kms_addfb_basic (too-high)
[126.899479] Starting subtest: too-high
[126.900633] Subtest too-high: SUCCESS (0.001s)
[127.399804] [086/171] (881s left) kms_addfb_basic (too-wide)
[127.735895] Starting subtest: too-wide
[127.737674] Subtest too-wide: SUCCESS (0.000s)
[128.239274] [087/171] (880s left) kms_addfb_basic (unused-handle)
[128.338788] Starting subtest: unused-handle
[128.340261] Subtest unused-handle: SUCCESS (0.000s)
[129.068927] [088/171] (879s left) kms_addfb_basic (unused-modifier)
[129.168237] Starting subtest: unused-modifier
[129.169369] Subtest unused-modifier: SUCCESS (0.000s)
[129.901601] [089/171] (878s left) kms_addfb_basic (unused-offsets)
[130.000951] Starting subtest: unused-offsets
[130.002139] Subtest unused-offsets: SUCCESS (0.000s)
[130.754632] [090/171] (878s left) kms_addfb_basic (unused-pitches)
[130.858105] Starting subtest: unused-pitches
[130.859299] Subtest unused-pitches: SUCCESS (0.000s)
[131.596383] [091/171] (877s left) kms_busy (basic)
[131.939480] Subtest basic: SKIP (0.000s)
[131.954854] [092/171] (876s left) kms_chamelium_hpd (dp-hpd-fast)
[132.296492] Subtest dp-hpd-fast: SKIP (0.000s)
[132.314064] [093/171] (876s left) kms_chamelium_edid (dp-edid-read)
[132.654403] Subtest dp-edid-read: SKIP (0.000s)
[132.671406] [094/171] (876s left) kms_chamelium_frames (dp-crc-fast)
[133.013761] Subtest dp-crc-fast: SKIP (0.000s)
[133.031448] [095/171] (875s left) kms_chamelium_hpd (hdmi-hpd-fast)
[133.369659] Subtest hdmi-hpd-fast: SKIP (0.000s)
[133.386717] [096/171] (875s left) kms_chamelium_edid (hdmi-edid-read)
[133.729440] Subtest hdmi-edid-read: SKIP (0.000s)
[133.746846] [097/171] (875s left) kms_chamelium_frames (hdmi-crc-fast)
[134.088379] Subtest hdmi-crc-fast: SKIP (0.000s)
[134.105968] [098/171] (874s left) kms_chamelium_hpd (vga-hpd-fast)
[134.450406] Subtest vga-hpd-fast: SKIP (0.000s)
[134.467693] [099/171] (874s left) kms_chamelium_edid (vga-edid-read)
[134.808225] Subtest vga-edid-read: SKIP (0.000s)
[134.825249] [100/171] (874s left) kms_prop_blob (basic)
[134.927487] Starting subtest: basic
[134.928709] Subtest basic: SUCCESS (0.000s)
[134.944822] [101/171] (874s left) kms_cursor_legacy (basic-busy-flip-before-cursor-atomic)
[135.291485] Subtest basic-busy-flip-before-cursor-atomic: SKIP (0.000s)
[135.305543] [102/171] (873s left) kms_cursor_legacy (basic-busy-flip-before-cursor-legacy)
[135.647541] Subtest basic-busy-flip-before-cursor-legacy: SKIP (0.000s)
[135.660877] [103/171] (873s left) kms_cursor_legacy (basic-flip-after-cursor-atomic)
[136.001685] Subtest basic-flip-after-cursor-atomic: SKIP (0.000s)
[136.015937] [104/171] (873s left) kms_cursor_legacy (basic-flip-after-cursor-legacy)
[136.358540] Subtest basic-flip-after-cursor-legacy: SKIP (0.000s)
[136.372344] [105/171] (872s left) kms_cursor_legacy (basic-flip-after-cursor-varying-size)
[136.714417] Subtest basic-flip-after-cursor-varying-size: SKIP (0.000s)
[136.727523] [106/171] (872s left) kms_cursor_legacy (basic-flip-before-cursor-atomic)
[137.074745] Subtest basic-flip-before-cursor-atomic: SKIP (0.000s)
[137.089491] [107/171] (872s left) kms_cursor_legacy (basic-flip-before-cursor-legacy)
[137.434411] Subtest basic-flip-before-cursor-legacy: SKIP (0.000s)
[137.447796] [108/171] (871s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size)
[137.796395] Subtest basic-flip-before-cursor-varying-size: SKIP (0.000s)
[137.810477] [109/171] (871s left) kms_flip (basic-flip-vs-dpms)
[138.030671] Starting subtest: basic-flip-vs-dpms
[138.032898] Subtest basic-flip-vs-dpms: SKIP (0.003s)
[138.061825] [110/171] (871s left) kms_flip (basic-flip-vs-modeset)
[138.276504] Starting subtest: basic-flip-vs-modeset
[138.280068] Subtest basic-flip-vs-modeset: SKIP (0.004s)
[138.314244] [111/171] (870s left) kms_flip (basic-flip-vs-wf_vblank)
[138.536841] Starting subtest: basic-flip-vs-wf_vblank
[138.540567] Subtest basic-flip-vs-wf_vblank: SKIP (0.003s)
[138.570693] [112/171] (870s left) kms_flip (basic-plain-flip)
[138.786147] Starting subtest: basic-plain-flip
[138.789833] Subtest basic-plain-flip: SKIP (0.003s)
[138.818309] [113/171] (870s left) kms_force_connector_basic (force-connector-state)
[139.199875] Starting subtest: force-connector-state
[139.933704] Subtest force-connector-state: SUCCESS (0.732s)
[140.455950] [114/171] (868s left) kms_force_connector_basic (force-edid)
[140.766366] Starting subtest: force-edid
[141.138217] Subtest force-edid: SUCCESS (0.370s)
[141.468506] [115/171] (867s left) kms_force_connector_basic (force-load-detect)
[141.785276] Starting subtest: force-load-detect
[141.799525] Subtest force-load-detect: SKIP (0.000s)
[142.119697] [116/171] (867s left) kms_force_connector_basic (prune-stale-modes)
[142.443289] Starting subtest: prune-stale-modes
[142.848575] Subtest prune-stale-modes: SUCCESS (0.405s)
[143.354906] [117/171] (866s left) kms_frontbuffer_tracking (basic)
[143.700669] Subtest basic: SKIP (0.000s)
[143.747068] [118/171] (865s left) kms_pipe_crc_basic (compare-crc-sanitycheck)
[144.054219] Subtest compare-crc-sanitycheck: SKIP (0.000s)
[144.083274] [119/171] (865s left) kms_pipe_crc_basic (hang-read-crc)
[144.389494] Subtest hang-read-crc: SKIP (0.000s)
[144.431050] [120/171] (865s left) kms_pipe_crc_basic (nonblocking-crc)
[144.735186] Subtest nonblocking-crc: SKIP (0.000s)
[144.777370] [121/171] (865s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence)
[145.096942] Subtest nonblocking-crc-frame-sequence: SKIP (0.000s)
[145.141258] [122/171] (864s left) kms_pipe_crc_basic (read-crc)
[145.462981] Subtest read-crc: SKIP (0.000s)
[145.510957] [123/171] (864s left) kms_pipe_crc_basic (read-crc-frame-sequence)
[145.827460] Subtest read-crc-frame-sequence: SKIP (0.000s)
[145.872921] [124/171] (864s left) kms_psr (primary_page_flip)
[146.021973] Subtest primary_page_flip: SKIP (0.000s)
[146.065161] [125/171] (863s left) kms_psr (cursor_plane_move)
[146.224705] Subtest cursor_plane_move: SKIP (0.000s)
[146.271160] [126/171] (863s left) kms_psr (sprite_plane_onoff)
[146.416505] Subtest sprite_plane_onoff: SKIP (0.000s)
[146.452701] [127/171] (863s left) kms_psr (primary_mmap_gtt)
[146.590830] Subtest primary_mmap_gtt: SKIP (0.000s)
[146.620484] [128/171] (863s left) kms_setmode (basic-clone-single-crtc)
[146.749028] Starting subtest: basic-clone-single-crtc
[146.771386] Subtest basic-clone-single-crtc: SKIP (0.001s)
[146.827148] [129/171] (863s left) i915_pm_backlight (basic-brightness)
[147.150688] Subtest basic-brightness: SKIP (0.000s)
[147.193518] [130/171] (862s left) i915_pm_rpm (basic-pci-d3-state)
[148.796429] Starting subtest: basic-pci-d3-state
[149.310146] Subtest basic-pci-d3-state: SUCCESS (0.507s)
[149.548600] [131/171] (860s left) i915_pm_rpm (basic-rte)
[149.690761] Starting subtest: basic-rte
[151.675817] Subtest basic-rte: SUCCESS (1.973s)
[152.526400] [132/171] (857s left) i915_pm_rps (basic-api)
[152.637140] Starting subtest: basic-api
[152.641966] Subtest basic-api: SUCCESS (0.005s)
[152.666639] [133/171] (857s left) prime_self_import (basic-llseek-bad)
[152.767774] Starting subtest: basic-llseek-bad
[152.770882] Subtest basic-llseek-bad: SUCCESS (0.002s)
[152.807648] [134/171] (857s left) prime_self_import (basic-llseek-size)
[152.909071] Starting subtest: basic-llseek-size
[152.912193] Subtest basic-llseek-size: SUCCESS (0.003s)
[152.949822] [135/171] (857s left) prime_self_import (basic-with_fd_dup)
[153.048137] Starting subtest: basic-with_fd_dup
[153.051222] Subtest basic-with_fd_dup: SUCCESS (0.003s)
[153.089132] [136/171] (857s left) prime_self_import (basic-with_one_bo)
[153.188584] Starting subtest: basic-with_one_bo
[153.192203] Subtest basic-with_one_bo: SUCCESS (0.004s)
[153.216242] [137/171] (857s left) prime_self_import (basic-with_one_bo_two_files)
[153.316281] Starting subtest: basic-with_one_bo_two_files
[153.319461] Subtest basic-with_one_bo_two_files: SUCCESS (0.002s)
[153.358965] [138/171] (857s left) prime_self_import (basic-with_two_bos)
[153.456904] Starting subtest: basic-with_two_bos
[153.460026] Subtest basic-with_two_bos: SUCCESS (0.003s)
[153.496688] [139/171] (856s left) prime_vgem (basic-fence-flip)
[153.606988] Starting subtest: basic-fence-flip
[153.842275] Subtest basic-fence-flip: SKIP (0.234s)
[153.868068] [140/171] (856s left) prime_vgem (basic-fence-mmap)
[153.982130] Starting subtest: basic-fence-mmap
[154.018363] Subtest basic-fence-mmap: SUCCESS (0.037s)
[154.067651] [141/171] (856s left) prime_vgem (basic-fence-read)
[154.180044] Starting subtest: basic-fence-read
[154.239506] Subtest basic-fence-read: SUCCESS (0.059s)
[154.266447] [142/171] (856s left) prime_vgem (basic-gtt)
[154.379660] Starting subtest: basic-gtt
[154.396791] Subtest basic-gtt: SUCCESS (0.017s)
[154.435635] [143/171] (856s left) prime_vgem (basic-read)
[154.547955] Starting subtest: basic-read
[154.574379] Subtest basic-read: SUCCESS (0.028s)
[154.620427] [144/171] (855s left) prime_vgem (basic-write)
[154.730769] Starting subtest: basic-write
[154.762113] Subtest basic-write: SUCCESS (0.031s)
[154.789897] [145/171] (855s left) prime_vgem (basic-userptr)
[154.902898] Starting subtest: basic-userptr
[154.914129] Subtest basic-userptr: SKIP (0.010s)
[154.965424] [146/171] (855s left) vgem_basic (setversion)
[155.070438] Starting subtest: setversion
[155.072319] Subtest setversion: SUCCESS (0.000s)
[155.093200] [147/171] (855s left) vgem_basic (create)
[155.193161] Starting subtest: create
[155.194365] Subtest create: SUCCESS (0.000s)
[155.213969] [148/171] (855s left) vgem_basic (debugfs)
[155.313432] Starting subtest: debugfs
[155.314422] Subtest debugfs: SUCCESS (0.001s)
[155.336376] [149/171] (855s left) vgem_basic (dmabuf-export)
[155.439690] Starting subtest: dmabuf-export
[155.441090] Subtest dmabuf-export: SUCCESS (0.002s)
[155.483711] [150/171] (855s left) vgem_basic (dmabuf-fence)
[155.585901] Starting subtest: dmabuf-fence
[155.587210] Subtest dmabuf-fence: SUCCESS (0.001s)
[155.607621] [151/171] (854s left) vgem_basic (dmabuf-fence-before)
[155.709157] Starting subtest: dmabuf-fence-before
[155.710379] Subtest dmabuf-fence-before: SUCCESS (0.000s)
[155.731197] [152/171] (854s left) vgem_basic (dmabuf-mmap)
[155.831907] Starting subtest: dmabuf-mmap
[155.852747] Subtest dmabuf-mmap: SUCCESS (0.021s)
[155.874365] [153/171] (854s left) vgem_basic (mmap)
[155.979247] Starting subtest: mmap
[155.997026] Subtest mmap: SUCCESS (0.018s)
[156.019573] [154/171] (854s left) vgem_basic (second-client)
[156.120913] Starting subtest: second-client
[156.126418] Subtest second-client: SUCCESS (0.005s)
[156.148600] [155/171] (854s left) vgem_basic (sysfs)
[156.249962] Starting subtest: sysfs
[156.251214] Subtest sysfs: SUCCESS (0.001s)
[156.273793] [156/171] (854s left) core_hotunplug (unbind-rebind)
[156.392247] Starting subtest: unbind-rebind
[157.876249] Subtest unbind-rebind: SUCCESS (1.485s)
[157.903627] [157/171] (852s left) vgem_basic (unload)
[158.112776] Starting subtest: unload
[186.925951] Subtest unload: SUCCESS (28.758s)
[186.960800] [158/171] (823s left) i915_module_load (reload)
[187.087527] Starting subtest: reload
[189.673046] Subtest reload: SUCCESS (2.474s)
[189.691099] [159/171] (821s left) gem_lmem_swapping (basic)
[189.986703] Subtest basic: SKIP (0.000s)
[190.007525] [160/171] (820s left) gem_lmem_swapping (parallel-random-engines)
[190.127757] Subtest parallel-random-engines: SKIP (0.000s)
[190.145126] [161/171] (820s left) gem_lmem_swapping (random-engines)
[190.297937] Subtest random-engines: SKIP (0.000s)
[190.410991] [162/171] (820s left) gem_lmem_swapping (verify-random)
[190.658999] Subtest verify-random: SKIP (0.000s)
[190.672122] [163/171] (820s left) i915_pm_rpm (module-reload)
[192.705437] Starting subtest: module-reload
[200.214504] Subtest module-reload: SUCCESS (7.452s)
[200.245428] [164/171] (810s left) i915_selftest (live)
[200.386465] Starting subtest: live
[200.387838] Starting dynamic subtest: sanitycheck
[201.869034] Dynamic subtest sanitycheck: SUCCESS (1.425s)
[201.876216] Starting dynamic subtest: uncore
[203.254437] Dynamic subtest uncore: SUCCESS (1.385s)
[203.262677] Starting dynamic subtest: workarounds
[204.883364] Dynamic subtest workarounds: SUCCESS (1.628s)
[204.891569] Starting dynamic subtest: gt_engines
[206.832656] Dynamic subtest gt_engines: SUCCESS (1.949s)
[206.840824] Starting dynamic subtest: gt_timelines
[221.130171] Dynamic subtest gt_timelines: SUCCESS (14.297s)
[221.137279] Starting dynamic subtest: gt_contexts
[222.606502] Dynamic subtest gt_contexts: SUCCESS (1.476s)
[222.614979] Starting dynamic subtest: gt_lrc
[227.119332] Dynamic subtest gt_lrc: SUCCESS (4.512s)
[227.127552] Starting dynamic subtest: gt_mocs
[228.614807] Dynamic subtest gt_mocs: SUCCESS (1.494s)
[228.621993] Starting dynamic subtest: gt_pm
[235.851918] Dynamic subtest gt_pm: SUCCESS (7.236s)
[235.859172] Starting dynamic subtest: gt_heartbeat
[237.360148] Dynamic subtest gt_heartbeat: SUCCESS (1.508s)
[237.368371] Starting dynamic subtest: requests
[246.252583] Dynamic subtest requests: SUCCESS (8.892s)
[246.260829] Starting dynamic subtest: migrate
[250.572907] Dynamic subtest migrate: SUCCESS (4.319s)
[250.581190] Starting dynamic subtest: active
[251.954648] Dynamic subtest active: SUCCESS (1.381s)
[251.962910] Starting dynamic subtest: objects
[254.911063] Dynamic subtest objects: SUCCESS (2.956s)
[254.918244] Starting dynamic subtest: mman
[260.908702] Dynamic subtest mman: SUCCESS (5.996s)
[260.916123] Starting dynamic subtest: dmabuf
[262.339655] Dynamic subtest dmabuf: SUCCESS (1.430s)
[262.347825] Starting dynamic subtest: vma
[263.749454] Dynamic subtest vma: SUCCESS (1.409s)
[263.756633] Starting dynamic subtest: coherency
[266.383697] Dynamic subtest coherency: SUCCESS (2.634s)
[266.392098] Starting dynamic subtest: gtt
[278.203544] Dynamic subtest gtt: SUCCESS (11.819s)
[278.211876] Starting dynamic subtest: gem
[279.827733] Dynamic subtest gem: SUCCESS (1.623s)
[279.835988] Starting dynamic subtest: evict
[283.312194] Dynamic subtest evict: SUCCESS (3.483s)
[283.319460] Starting dynamic subtest: hugepages
[290.390650] Dynamic subtest hugepages: SUCCESS (7.078s)
[290.397982] Starting dynamic subtest: gem_contexts
[309.313319] Dynamic subtest gem_contexts: SUCCESS (18.922s)
[309.320781] Starting dynamic subtest: client
[310.758606] Dynamic subtest client: SUCCESS (1.444s)
[310.767208] Starting dynamic subtest: gem_migrate
[312.147111] Dynamic subtest gem_migrate: SUCCESS (1.388s)
[312.155562] Starting dynamic subtest: reset
[314.393210] Dynamic subtest reset: SUCCESS (2.245s)
[314.400651] Starting dynamic subtest: memory_region
[315.771198] Dynamic subtest memory_region: SUCCESS (1.377s)
[315.779628] Starting dynamic subtest: hangcheck
[345.884437] Dynamic subtest hangcheck: SUCCESS (30.112s)
[345.891816] Starting dynamic subtest: execlists
[360.142025] Dynamic subtest execlists: SUCCESS (14.257s)
[360.150543] Starting dynamic subtest: ring_submission
[361.551758] Dynamic subtest ring_submission: SUCCESS (1.408s)
[361.559477] Starting dynamic subtest: perf
[363.031172] Dynamic subtest perf: SUCCESS (1.479s)
[363.038755] Starting dynamic subtest: slpc
[364.434558] Dynamic subtest slpc: SUCCESS (1.402s)
[364.443102] Starting dynamic subtest: guc
[365.832178] Dynamic subtest guc: SUCCESS (1.397s)
[365.839495] Starting dynamic subtest: guc_multi_lrc
[367.237802] Dynamic subtest guc_multi_lrc: SUCCESS (1.404s)
[367.245244] Starting dynamic subtest: guc_hang
[368.649221] Dynamic subtest guc_hang: SUCCESS (1.411s)
[368.656702] Starting dynamic subtest: late_gt_pm
[370.079365] Dynamic subtest late_gt_pm: SUCCESS (1.429s)
[370.081464] Subtest live: SUCCESS (169.637s)
[370.106914] [165/171] (640s left) dmabuf (all-tests)
[370.222066] Starting subtest: all-tests
[370.223635] Starting dynamic subtest: sanitycheck
[370.254715] Dynamic subtest sanitycheck: SUCCESS (0.032s)
[370.262504] Starting dynamic subtest: dma_fence
[370.389763] Dynamic subtest dma_fence: SUCCESS (0.134s)
[370.397763] Starting dynamic subtest: dma_fence_chain
[390.536718] Dynamic subtest dma_fence_chain: SUCCESS (20.089s)
[390.553130] Starting dynamic subtest: dma_fence_unwrap
[390.555391] Dynamic subtest dma_fence_unwrap: SUCCESS (0.024s)
[390.565841] Starting dynamic subtest: dma_resv
[390.567472] Dynamic subtest dma_resv: SUCCESS (0.036s)
[390.569041] Subtest all-tests: SUCCESS (20.319s)
[390.594536] [166/171] (620s left) i915_suspend (basic-s2idle-without-i915)
[390.704207] Starting subtest: basic-s2idle-without-i915
[409.925185] Subtest basic-s2idle-without-i915: SUCCESS (4.027s)
[414.016381] [167/171] (616s left) i915_suspend (basic-s3-without-i915)
[414.127367] Starting subtest: basic-s3-without-i915
[433.272841] Subtest basic-s3-without-i915: SUCCESS (3.011s)
[438.367929] [168/171] (613s left) gem_exec_suspend (basic-s0)
[438.503548] Starting subtest: basic-S0
[438.505713] Starting dynamic subtest: smem
[457.620897] Dynamic subtest smem: SUCCESS (3.133s)
[457.623930] Subtest basic-S0: SUCCESS (3.134s)
[461.827927] [169/171] (609s left) gem_exec_suspend (basic-s3)
[461.951537] Starting subtest: basic-S3
[461.952814] Starting dynamic subtest: smem
[482.028344] Dynamic subtest smem: SUCCESS (3.467s)
[482.030960] Subtest basic-S3: SUCCESS (3.468s)
[487.208156] [170/171] (606s left) kms_chamelium_hpd (common-hpd-after-suspend)
[487.560927] Subtest common-hpd-after-suspend: SKIP (0.000s)
[487.582019] [171/171] (605s left) kms_pipe_crc_basic (suspend-read-crc)
[487.922351] Subtest suspend-read-crc: SKIP (0.000s)
[487.978941] Closing watchdogs
Done.