[31.543215] Initializing watchdogs
[31.543340]   /dev/watchdog0
[31.550457] [001/160] (960s left) i915_module_load (load)
[31.641897] Starting subtest: load
[33.155917] Subtest load: SUCCESS (1.516s)
[33.176619] [002/160] (958s left) core_auth (basic-auth)
[33.265099] Starting subtest: basic-auth
[33.266259] Subtest basic-auth: SUCCESS (0.001s)
[33.331318] [003/160] (958s left) debugfs_test (read_all_entries)
[33.421830] Starting subtest: read_all_entries
[33.475930] Subtest read_all_entries: SUCCESS (0.054s)
[33.602197] [004/160] (958s left) debugfs_test (basic-hwmon)
[33.731989] Starting subtest: basic-hwmon
[33.742673] Subtest basic-hwmon: SKIP (0.001s)
[33.853992] [005/160] (958s left) fbdev (eof)
[33.945244] Starting subtest: eof
[33.946424] Subtest eof: SUCCESS (0.001s)
[34.002892] [006/160] (958s left) fbdev (info)
[34.083511] Starting subtest: info
[34.084752] Subtest info: SUCCESS (0.000s)
[34.152194] [007/160] (958s left) fbdev (nullptr)
[34.245765] Starting subtest: nullptr
[34.246982] Subtest nullptr: SUCCESS (0.000s)
[34.301165] [008/160] (957s left) fbdev (read)
[34.395251] Starting subtest: read
[34.625974] Subtest read: SUCCESS (0.231s)
[34.687428] [009/160] (957s left) fbdev (write)
[34.780028] Starting subtest: write
[34.897133] Subtest write: SUCCESS (0.117s)
[34.954849] [010/160] (957s left) gem_basic (bad-close)
[35.040296] Starting subtest: bad-close
[35.043957] Subtest bad-close: SUCCESS (0.000s)
[35.104378] [011/160] (957s left) gem_basic (create-close)
[35.187305] Starting subtest: create-close
[35.189923] Subtest create-close: SUCCESS (0.000s)
[35.255552] [012/160] (957s left) gem_basic (create-fd-close)
[35.342043] Starting subtest: create-fd-close
[35.344637] Subtest create-fd-close: SUCCESS (0.000s)
[35.405473] [013/160] (956s left) gem_busy (busy@all-engines)
[35.509154] Starting subtest: busy
[35.510216] Starting dynamic subtest: all-engines
[35.529321] Dynamic subtest all-engines: SUCCESS (0.025s)
[35.530354] Subtest busy: SUCCESS (0.025s)
[35.840280] [014/160] (956s left) gem_close_race (basic-process)
[35.947191] Starting subtest: basic-process
[35.994325] Subtest basic-process: SUCCESS (0.050s)
[36.175978] [015/160] (956s left) gem_close_race (basic-threads)
[36.274446] Starting subtest: basic-threads
[37.438914] Subtest basic-threads: SUCCESS (1.164s)
[37.624122] [016/160] (954s left) gem_ctx_create (basic)
[37.711912] Subtest basic: SKIP (0.000s)
[37.749339] [017/160] (954s left) gem_ctx_create (basic-files)
[37.839383] Subtest basic-files: SKIP (0.000s)
[37.864728] [018/160] (954s left) gem_ctx_exec (basic)
[37.953196] Subtest basic: SKIP (0.000s)
[37.999159] [019/160] (954s left) gem_exec_basic (basic)
[38.094853] Starting subtest: basic
[38.095964] Starting dynamic subtest: rcs0-smem
[38.097106] Dynamic subtest rcs0-smem: SUCCESS (0.000s)
[38.098228] Subtest basic: SUCCESS (0.001s)
[38.282310] [020/160] (954s left) gem_exec_create (basic)
[38.385848] Starting subtest: basic
[38.388848] Starting dynamic subtest: smem
[40.420623] Dynamic subtest smem: SUCCESS (2.036s)
[40.421883] Subtest basic: SUCCESS (2.037s)
[40.608420] [021/160] (951s left) gem_exec_fence (basic-busy)
[40.828811] Starting subtest: basic-busy
[40.830137] Starting dynamic subtest: rcs0
[40.840260] Dynamic subtest rcs0: SUCCESS (0.013s)
[40.841341] Subtest basic-busy: SUCCESS (0.014s)
[41.327397] [022/160] (951s left) gem_exec_fence (basic-wait)
[41.545126] Starting subtest: basic-wait
[41.546236] Starting dynamic subtest: rcs0
[41.555195] Dynamic subtest rcs0: SUCCESS (0.012s)
[41.556376] Subtest basic-wait: SUCCESS (0.012s)
[41.995220] [023/160] (950s left) gem_exec_fence (basic-await)
[42.217515] Starting subtest: basic-await
[42.218611] Starting dynamic subtest: rcs0
[42.279222] Dynamic subtest rcs0: SUCCESS (0.062s)
[42.280258] Subtest basic-await: SUCCESS (0.063s)
[42.715675] [024/160] (949s left) gem_exec_fence (nb-await)
[42.933932] Starting subtest: nb-await
[42.935142] Starting dynamic subtest: rcs0
[42.985337] Dynamic subtest rcs0: SUCCESS (0.053s)
[42.987684] Subtest nb-await: SUCCESS (0.053s)
[43.420001] [025/160] (949s left) gem_exec_gttfill (basic)
[43.518038] Starting subtest: basic
[46.869253] Subtest basic: SUCCESS (3.350s)
[47.052176] [026/160] (945s left) gem_exec_parallel (engines)
[47.268860] Starting subtest: engines
[47.271634] Starting dynamic subtest: basic
[48.922883] Dynamic subtest basic: SUCCESS (1.657s)
[48.940576] Starting dynamic subtest: contexts
[48.944563] Dynamic subtest contexts: SKIP (0.001s)
[48.960817] Starting dynamic subtest: fds
[48.963759] Dynamic subtest fds: SKIP (0.003s)
[48.979841] Starting dynamic subtest: userptr
[50.589602] Dynamic subtest userptr: SUCCESS (1.663s)
[50.590828] Subtest engines: SUCCESS (3.324s)
[50.777815] [027/160] (941s left) gem_exec_store (basic)
[50.875646] Starting subtest: basic
[50.891465] Subtest basic: SUCCESS (0.018s)
[51.077944] [028/160] (941s left) gem_flink_basic (bad-flink)
[51.162414] Starting subtest: bad-flink
[51.163558] Subtest bad-flink: SUCCESS (0.000s)
[51.228823] [029/160] (941s left) gem_flink_basic (bad-open)
[51.311674] Starting subtest: bad-open
[51.312872] Subtest bad-open: SUCCESS (0.000s)
[51.380308] [030/160] (941s left) gem_flink_basic (basic)
[51.467143] Starting subtest: basic
[51.468467] Subtest basic: SUCCESS (0.000s)
[51.544613] [031/160] (941s left) gem_flink_basic (double-flink)
[51.628474] Starting subtest: double-flink
[51.631145] Subtest double-flink: SUCCESS (0.000s)
[51.697917] [032/160] (941s left) gem_flink_basic (flink-lifetime)
[51.785357] Starting subtest: flink-lifetime
[51.786461] Subtest flink-lifetime: SUCCESS (0.002s)
[51.863876] [033/160] (940s left) gem_huc_copy (huc-copy)
[51.953968] Subtest huc-copy: SKIP (0.000s)
[51.986942] [034/160] (940s left) gem_linear_blits (basic)
[52.280845] Starting subtest: basic
[52.293436] Subtest basic: SUCCESS (0.013s)
[52.400332] [035/160] (940s left) gem_mmap (basic)
[52.604275] Starting subtest: basic
[52.609764] Subtest basic: SUCCESS (0.000s)
[52.682548] [036/160] (940s left) gem_mmap_gtt (basic)
[52.769196] Starting subtest: basic
[52.770331] Subtest basic: SUCCESS (0.001s)
[52.836911] [037/160] (939s left) gem_render_linear_blits (basic)
[52.935637] Starting subtest: basic
[52.986876] Subtest basic: SUCCESS (0.050s)
[53.037460] [038/160] (939s left) gem_render_tiled_blits (basic)
[53.124575] Starting subtest: basic
[53.169059] Subtest basic: SUCCESS (0.042s)
[53.202334] [039/160] (939s left) gem_ringfill (basic-all)
[53.315900] Starting subtest: basic-all
[54.422651] Subtest basic-all: SUCCESS (1.103s)
[54.489367] [040/160] (938s left) gem_softpin (allocator-basic)
[54.574473] Subtest allocator-basic: SKIP (0.000s)
[54.639244] [041/160] (938s left) gem_softpin (allocator-basic-reserve)
[54.725439] Subtest allocator-basic-reserve: SKIP (0.000s)
[54.790912] [042/160] (938s left) gem_softpin (safe-alignment)
[54.880564] Starting subtest: safe-alignment
[54.886984] Subtest safe-alignment: SUCCESS (0.009s)
[54.959812] [043/160] (937s left) gem_sync (basic-all)
[55.060172] Starting subtest: basic-all
[57.185387] Subtest basic-all: SUCCESS (2.128s)
[57.365399] [044/160] (935s left) gem_sync (basic-each)
[57.467041] Starting subtest: basic-each
[59.587881] Subtest basic-each: SUCCESS (2.118s)
[59.757813] [045/160] (933s left) gem_tiled_blits (basic)
[60.014241] Starting subtest: basic
[60.036454] Subtest basic: SUCCESS (0.024s)
[60.142982] [046/160] (932s left) gem_tiled_fence_blits (basic)
[60.527379] Starting subtest: basic
[60.541988] Subtest basic: SUCCESS (0.013s)
[60.648299] [047/160] (932s left) gem_tiled_pread_basic
[61.128341] [048/160] (931s left) gem_wait (busy@all-engines)
[61.232757] Starting subtest: busy
[61.234037] Starting dynamic subtest: all-engines
[61.744087] Dynamic subtest all-engines: SUCCESS (0.509s)
[61.745121] Subtest busy: SUCCESS (0.509s)
[61.949566] [049/160] (931s left) gem_wait (wait@all-engines)
[62.051131] Starting subtest: wait
[62.053629] Starting dynamic subtest: all-engines
[63.066492] Dynamic subtest all-engines: SUCCESS (1.013s)
[63.067598] Subtest wait: SUCCESS (1.014s)
[63.270698] [050/160] (929s left) i915_getparams_basic (basic-eu-total)
[63.355710] Starting subtest: basic-eu-total
[63.358744] Subtest basic-eu-total: SUCCESS (0.000s)
[63.417997] [051/160] (929s left) i915_getparams_basic (basic-subslice-total)
[63.502249] Starting subtest: basic-subslice-total
[63.504630] Subtest basic-subslice-total: SUCCESS (0.000s)
[63.572044] [052/160] (929s left) i915_hangman (error-state-basic)
[63.663303] Starting subtest: error-state-basic
[63.757706] Subtest error-state-basic: SUCCESS (0.097s)
[63.814080] [053/160] (929s left) i915_pciid
[63.963443] [054/160] (929s left) kms_addfb_basic (addfb25-4-tiled)
[64.089864] Starting subtest: addfb25-4-tiled
[64.091398] Subtest addfb25-4-tiled: SUCCESS (0.000s)
[64.164591] [055/160] (929s left) kms_addfb_basic (addfb25-bad-modifier)
[64.249232] Starting subtest: addfb25-bad-modifier
[64.250357] Subtest addfb25-bad-modifier: SUCCESS (0.000s)
[64.364865] [056/160] (928s left) kms_addfb_basic (addfb25-framebuffer-vs-set-tiling)
[64.452971] Starting subtest: addfb25-framebuffer-vs-set-tiling
[64.454513] Subtest addfb25-framebuffer-vs-set-tiling: SUCCESS (0.000s)
[64.549858] [057/160] (928s left) kms_addfb_basic (addfb25-modifier-no-flag)
[64.636738] Starting subtest: addfb25-modifier-no-flag
[64.638584] Subtest addfb25-modifier-no-flag: SUCCESS (0.000s)
[64.749821] [058/160] (928s left) kms_addfb_basic (addfb25-x-tiled-legacy)
[64.836111] Starting subtest: addfb25-x-tiled-legacy
[64.837138] Subtest addfb25-x-tiled-legacy: SUCCESS (0.000s)
[64.949367] [059/160] (928s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy)
[65.036894] Starting subtest: addfb25-x-tiled-mismatch-legacy
[65.038049] Subtest addfb25-x-tiled-mismatch-legacy: SUCCESS (0.000s)
[65.136332] [060/160] (928s left) kms_addfb_basic (addfb25-yf-tiled-legacy)
[65.261248] Starting subtest: addfb25-yf-tiled-legacy
[65.262345] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.001s)
[65.335296] [061/160] (928s left) kms_addfb_basic (addfb25-y-tiled-legacy)
[65.440811] Starting subtest: addfb25-y-tiled-legacy
[65.442289] Subtest addfb25-y-tiled-legacy: SUCCESS (0.000s)
[65.518201] [062/160] (927s left) kms_addfb_basic (addfb25-y-tiled-small-legacy)
[65.642233] Starting subtest: addfb25-y-tiled-small-legacy
[65.645930] Subtest addfb25-y-tiled-small-legacy: SKIP (0.000s)
[65.722557] [063/160] (927s left) kms_addfb_basic (bad-pitch-0)
[65.809138] Starting subtest: bad-pitch-0
[65.810341] Subtest bad-pitch-0: SUCCESS (0.000s)
[65.921390] [064/160] (927s left) kms_addfb_basic (bad-pitch-1024)
[66.009113] Starting subtest: bad-pitch-1024
[66.010286] Subtest bad-pitch-1024: SUCCESS (0.000s)
[66.122241] [065/160] (927s left) kms_addfb_basic (bad-pitch-128)
[66.209116] Starting subtest: bad-pitch-128
[66.210165] Subtest bad-pitch-128: SUCCESS (0.000s)
[66.320802] [066/160] (927s left) kms_addfb_basic (bad-pitch-256)
[66.405778] Starting subtest: bad-pitch-256
[66.406869] Subtest bad-pitch-256: SUCCESS (0.000s)
[66.523797] [067/160] (926s left) kms_addfb_basic (bad-pitch-32)
[66.611116] Starting subtest: bad-pitch-32
[66.612190] Subtest bad-pitch-32: SUCCESS (0.000s)
[66.724232] [068/160] (926s left) kms_addfb_basic (bad-pitch-63)
[66.810894] Starting subtest: bad-pitch-63
[66.812075] Subtest bad-pitch-63: SUCCESS (0.000s)
[66.923843] [069/160] (926s left) kms_addfb_basic (bad-pitch-65536)
[67.011917] Starting subtest: bad-pitch-65536
[67.013076] Subtest bad-pitch-65536: SUCCESS (0.000s)
[67.125286] [070/160] (926s left) kms_addfb_basic (bad-pitch-999)
[67.211074] Starting subtest: bad-pitch-999
[67.212895] Subtest bad-pitch-999: SUCCESS (0.000s)
[67.309503] [071/160] (926s left) kms_addfb_basic (basic)
[67.398718] Starting subtest: basic
[67.400844] Subtest basic: SUCCESS (0.000s)
[67.508579] [072/160] (926s left) kms_addfb_basic (basic-x-tiled-legacy)
[67.595923] Starting subtest: basic-x-tiled-legacy
[67.597264] Subtest basic-x-tiled-legacy: SUCCESS (0.000s)
[67.692460] [073/160] (925s left) kms_addfb_basic (basic-y-tiled-legacy)
[67.778205] Starting subtest: basic-y-tiled-legacy
[67.779298] Subtest basic-y-tiled-legacy: SUCCESS (0.000s)
[67.877921] [074/160] (925s left) kms_addfb_basic (bo-too-small)
[68.001273] Starting subtest: bo-too-small
[68.003023] Subtest bo-too-small: SUCCESS (0.000s)
[68.078915] [075/160] (925s left) kms_addfb_basic (bo-too-small-due-to-tiling)
[68.184182] Starting subtest: bo-too-small-due-to-tiling
[68.186100] Subtest bo-too-small-due-to-tiling: SUCCESS (0.000s)
[68.262808] [076/160] (925s left) kms_addfb_basic (clobberred-modifier)
[68.352702] Starting subtest: clobberred-modifier
[68.353878] Subtest clobberred-modifier: SUCCESS (0.000s)
[68.462991] [077/160] (925s left) kms_addfb_basic (framebuffer-vs-set-tiling)
[68.550140] Starting subtest: framebuffer-vs-set-tiling
[68.551291] Subtest framebuffer-vs-set-tiling: SUCCESS (0.000s)
[68.664649] [078/160] (925s left) kms_addfb_basic (invalid-get-prop)
[68.750748] Starting subtest: invalid-get-prop
[68.751910] Subtest invalid-get-prop: SUCCESS (0.000s)
[68.846290] [079/160] (924s left) kms_addfb_basic (invalid-get-prop-any)
[68.932207] Starting subtest: invalid-get-prop-any
[68.933332] Subtest invalid-get-prop-any: SUCCESS (0.000s)
[69.050137] [080/160] (924s left) kms_addfb_basic (invalid-set-prop)
[69.137932] Starting subtest: invalid-set-prop
[69.139106] Subtest invalid-set-prop: SUCCESS (0.000s)
[69.247398] [081/160] (924s left) kms_addfb_basic (invalid-set-prop-any)
[69.334320] Starting subtest: invalid-set-prop-any
[69.335519] Subtest invalid-set-prop-any: SUCCESS (0.000s)
[69.433201] [082/160] (924s left) kms_addfb_basic (no-handle)
[69.518788] Starting subtest: no-handle
[69.519913] Subtest no-handle: SUCCESS (0.000s)
[69.632319] [083/160] (924s left) kms_addfb_basic (size-max)
[69.737290] Starting subtest: size-max
[69.738774] Subtest size-max: SUCCESS (0.000s)
[69.818072] [084/160] (924s left) kms_addfb_basic (small-bo)
[69.942617] Starting subtest: small-bo
[69.944089] Subtest small-bo: SUCCESS (0.000s)
[70.018284] [085/160] (923s left) kms_addfb_basic (tile-pitch-mismatch)
[70.106832] Starting subtest: tile-pitch-mismatch
[70.107947] Subtest tile-pitch-mismatch: SUCCESS (0.000s)
[70.219438] [086/160] (923s left) kms_addfb_basic (too-high)
[70.324604] Starting subtest: too-high
[70.326066] Subtest too-high: SUCCESS (0.001s)
[70.403085] [087/160] (923s left) kms_addfb_basic (too-wide)
[70.526870] Starting subtest: too-wide
[70.528178] Subtest too-wide: SUCCESS (0.000s)
[70.603236] [088/160] (923s left) kms_addfb_basic (unused-handle)
[70.688195] Starting subtest: unused-handle
[70.689271] Subtest unused-handle: SUCCESS (0.000s)
[70.787343] [089/160] (923s left) kms_addfb_basic (unused-modifier)
[70.874107] Starting subtest: unused-modifier
[70.875230] Subtest unused-modifier: SUCCESS (0.000s)
[70.986511] [090/160] (922s left) kms_addfb_basic (unused-offsets)
[71.071321] Starting subtest: unused-offsets
[71.072530] Subtest unused-offsets: SUCCESS (0.000s)
[71.190353] [091/160] (922s left) kms_addfb_basic (unused-pitches)
[71.275363] Starting subtest: unused-pitches
[71.276505] Subtest unused-pitches: SUCCESS (0.000s)
[71.389251] [092/160] (922s left) kms_busy (basic)
[71.514199] Starting subtest: basic
[71.515437] Starting dynamic subtest: flip
[72.063265] Dynamic subtest flip: SUCCESS (0.551s)
[72.076574] Starting dynamic subtest: modeset
[72.078777] Dynamic subtest modeset: SKIP (0.000s)
[72.079872] Subtest basic: SUCCESS (0.553s)
[72.177359] [093/160] (921s left) kms_prop_blob (basic)
[72.263304] Starting subtest: basic
[72.264550] Subtest basic: SUCCESS (0.000s)
[72.340364] [094/160] (921s left) kms_cursor_legacy (basic-busy-flip-before-cursor-atomic)
[72.449110] Starting subtest: basic-busy-flip-before-cursor-atomic
[72.452220] Subtest basic-busy-flip-before-cursor-atomic: SKIP (0.004s)
[72.524775] [095/160] (921s left) kms_cursor_legacy (basic-busy-flip-before-cursor-legacy)
[72.633195] Starting subtest: basic-busy-flip-before-cursor-legacy
[73.634690] Subtest basic-busy-flip-before-cursor-legacy: SUCCESS (1.001s)
[73.755130] [096/160] (920s left) kms_cursor_legacy (basic-flip-after-cursor-atomic)
[73.876907] Starting subtest: basic-flip-after-cursor-atomic
[73.879148] Subtest basic-flip-after-cursor-atomic: SKIP (0.000s)
[73.954823] [097/160] (920s left) kms_cursor_legacy (basic-flip-after-cursor-legacy)
[74.059040] Starting subtest: basic-flip-after-cursor-legacy
[75.066352] Subtest basic-flip-after-cursor-legacy: SUCCESS (1.006s)
[75.174639] [098/160] (918s left) kms_cursor_legacy (basic-flip-after-cursor-varying-size)
[75.293859] Starting subtest: basic-flip-after-cursor-varying-size
[76.281719] Subtest basic-flip-after-cursor-varying-size: SUCCESS (1.000s)
[76.396802] [099/160] (917s left) kms_cursor_legacy (basic-flip-before-cursor-atomic)
[76.503690] Starting subtest: basic-flip-before-cursor-atomic
[76.506118] Subtest basic-flip-before-cursor-atomic: SKIP (0.000s)
[76.580271] [100/160] (917s left) kms_cursor_legacy (basic-flip-before-cursor-legacy)
[76.687731] Starting subtest: basic-flip-before-cursor-legacy
[77.686379] Subtest basic-flip-before-cursor-legacy: SUCCESS (0.998s)
[77.799582] [101/160] (916s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size)
[77.908625] Starting subtest: basic-flip-before-cursor-varying-size
[78.913085] Subtest basic-flip-before-cursor-varying-size: SUCCESS (1.002s)
[79.039593] [102/160] (915s left) kms_dsc (dsc-basic)
[79.146516] Subtest dsc-basic: SKIP (0.000s)
[79.176473] [103/160] (915s left) kms_flip (basic-flip-vs-dpms)
[79.301962] Starting subtest: basic-flip-vs-dpms
[79.303178] Starting dynamic subtest: A-VGA1
[80.561546] Dynamic subtest A-VGA1: SUCCESS (1.263s)
[80.575786] Starting dynamic subtest: B-VGA1
[81.739134] Dynamic subtest B-VGA1: SUCCESS (1.177s)
[81.741763] Subtest basic-flip-vs-dpms: SUCCESS (2.440s)
[81.865248] [104/160] (912s left) kms_flip (basic-flip-vs-modeset)
[81.993083] Starting subtest: basic-flip-vs-modeset
[81.994220] Starting dynamic subtest: A-VGA1
[83.263022] Dynamic subtest A-VGA1: SUCCESS (1.259s)
[83.283648] Starting dynamic subtest: B-VGA1
[84.413644] Dynamic subtest B-VGA1: SUCCESS (1.156s)
[84.414770] Subtest basic-flip-vs-modeset: SUCCESS (2.419s)
[84.542248] [105/160] (909s left) kms_flip (basic-flip-vs-wf_vblank)
[84.666232] Starting subtest: basic-flip-vs-wf_vblank
[84.669059] Starting dynamic subtest: A-VGA1
[86.194485] Dynamic subtest A-VGA1: SUCCESS (1.529s)
[86.204337] Starting dynamic subtest: B-VGA1
[87.693851] Dynamic subtest B-VGA1: SUCCESS (1.498s)
[87.694997] Subtest basic-flip-vs-wf_vblank: SUCCESS (3.028s)
[87.845994] [106/160] (906s left) kms_flip (basic-plain-flip)
[87.950793] Starting subtest: basic-plain-flip
[87.954632] Starting dynamic subtest: A-VGA1
[89.208186] Dynamic subtest A-VGA1: SUCCESS (1.254s)
[89.227623] Starting dynamic subtest: B-VGA1
[90.426308] Dynamic subtest B-VGA1: SUCCESS (1.216s)
[90.427407] Subtest basic-plain-flip: SUCCESS (2.473s)
[90.578846] [107/160] (903s left) kms_force_connector_basic (force-connector-state)
[90.717545] Starting subtest: force-connector-state
[90.889091] Subtest force-connector-state: SUCCESS (0.170s)
[91.149445] [108/160] (903s left) kms_force_connector_basic (force-edid)
[91.302962] Starting subtest: force-edid
[91.386424] Subtest force-edid: SUCCESS (0.083s)
[91.534247] [109/160] (902s left) kms_force_connector_basic (force-load-detect)
[91.674174] Starting subtest: force-load-detect
[91.843977] Subtest force-load-detect: SUCCESS (0.170s)
[92.059498] [110/160] (902s left) kms_force_connector_basic (prune-stale-modes)
[92.209139] Starting subtest: prune-stale-modes
[92.296085] Subtest prune-stale-modes: SUCCESS (0.085s)
[92.441192] [111/160] (901s left) kms_frontbuffer_tracking (basic)
[92.566941] Subtest basic: SKIP (0.000s)
[92.607491] [112/160] (901s left) kms_hdmi_inject (inject-audio)
[92.694059] Subtest inject-audio: SKIP (0.000s)
[92.726736] [113/160] (901s left) kms_pipe_crc_basic (compare-crc-sanitycheck-xr24)
[92.852494] Starting subtest: compare-crc-sanitycheck-xr24
[92.853608] Starting dynamic subtest: pipe-A-VGA-1
[93.151148] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.298s)
[93.182609] Starting dynamic subtest: pipe-B-VGA-1
[93.466642] Dynamic subtest pipe-B-VGA-1: SUCCESS (0.312s)
[93.468129] Subtest compare-crc-sanitycheck-xr24: SUCCESS (0.616s)
[93.595195] [114/160] (900s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12)
[93.717330] Starting subtest: compare-crc-sanitycheck-nv12
[93.718578] Starting dynamic subtest: pipe-A-VGA-1
[93.722108] Dynamic subtest pipe-A-VGA-1: SKIP (0.001s)
[93.731732] Starting dynamic subtest: pipe-B-VGA-1
[93.733931] Dynamic subtest pipe-B-VGA-1: SKIP (0.001s)
[93.736144] Subtest compare-crc-sanitycheck-nv12: SKIP (0.006s)
[93.792138] [115/160] (900s left) kms_pipe_crc_basic (hang-read-crc)
[93.902076] Starting subtest: hang-read-crc
[93.903221] Starting dynamic subtest: pipe-A-VGA-1
[94.734799] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.831s)
[94.753632] Starting dynamic subtest: pipe-B-VGA-1
[95.566392] Dynamic subtest pipe-B-VGA-1: SUCCESS (0.831s)
[95.569785] Subtest hang-read-crc: SUCCESS (1.665s)
[95.664264] [116/160] (898s left) kms_pipe_crc_basic (nonblocking-crc)
[95.776341] Starting subtest: nonblocking-crc
[95.778060] Starting dynamic subtest: pipe-A-VGA-1
[96.252895] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.478s)
[96.263965] Starting dynamic subtest: pipe-B-VGA-1
[96.739310] Dynamic subtest pipe-B-VGA-1: SUCCESS (0.484s)
[96.740875] Subtest nonblocking-crc: SUCCESS (0.966s)
[96.843125] [117/160] (897s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence)
[96.967901] Starting subtest: nonblocking-crc-frame-sequence
[96.969114] Starting dynamic subtest: pipe-A-VGA-1
[97.413511] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.447s)
[97.431917] Starting dynamic subtest: pipe-B-VGA-1
[97.886823] Dynamic subtest pipe-B-VGA-1: SUCCESS (0.470s)
[97.889042] Subtest nonblocking-crc-frame-sequence: SUCCESS (0.919s)
[97.996781] [118/160] (896s left) kms_pipe_crc_basic (read-crc)
[98.119974] Starting subtest: read-crc
[98.121404] Starting dynamic subtest: pipe-A-VGA-1
[98.523061] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.401s)
[98.532322] Starting dynamic subtest: pipe-B-VGA-1
[98.931259] Dynamic subtest pipe-B-VGA-1: SUCCESS (0.407s)
[98.933169] Subtest read-crc: SUCCESS (0.811s)
[99.031858] [119/160] (895s left) kms_pipe_crc_basic (read-crc-frame-sequence)
[99.142049] Starting subtest: read-crc-frame-sequence
[99.143134] Starting dynamic subtest: pipe-A-VGA-1
[99.538032] Dynamic subtest pipe-A-VGA-1: SUCCESS (0.398s)
[99.547793] Starting dynamic subtest: pipe-B-VGA-1
[99.931405] Dynamic subtest pipe-B-VGA-1: SUCCESS (0.393s)
[99.933078] Subtest read-crc-frame-sequence: SUCCESS (0.795s)
[100.045737] [120/160] (894s left) kms_pm_backlight (basic-brightness)
[100.152774] Subtest basic-brightness: SKIP (0.000s)
[100.179997] [121/160] (894s left) kms_pm_rpm (basic-pci-d3-state)
[111.430387] Subtest basic-pci-d3-state: SKIP (0.000s)
[111.469546] [122/160] (883s left) kms_pm_rpm (basic-rte)
[111.554120] Starting subtest: basic-rte
[122.732619] Subtest basic-rte: SKIP (11.175s)
[122.776221] [123/160] (871s left) kms_psr (psr-primary-page-flip)
[122.898980] Subtest psr-primary-page-flip: SKIP (0.000s)
[122.943417] [124/160] (871s left) kms_psr (psr-cursor-plane-move)
[123.067817] Subtest psr-cursor-plane-move: SKIP (0.000s)
[123.108206] [125/160] (871s left) kms_psr (psr-sprite-plane-onoff)
[123.214999] Subtest psr-sprite-plane-onoff: SKIP (0.000s)
[123.260742] [126/160] (871s left) kms_psr (psr-primary-mmap-gtt)
[123.383899] Subtest psr-primary-mmap-gtt: SKIP (0.000s)
[123.428815] [127/160] (871s left) kms_setmode (basic-clone-single-crtc)
[123.519088] Starting subtest: basic-clone-single-crtc
[123.522346] Subtest basic-clone-single-crtc: SKIP (0.000s)
[123.593755] [128/160] (871s left) i915_pm_rps (basic-api)
[123.682289] Subtest basic-api: SKIP (0.000s)
[123.711492] [129/160] (871s left) prime_self_import (basic-llseek-bad)
[123.797091] Starting subtest: basic-llseek-bad
[123.799268] Subtest basic-llseek-bad: SUCCESS (0.002s)
[123.877997] [130/160] (870s left) prime_self_import (basic-llseek-size)
[123.958109] Starting subtest: basic-llseek-size
[123.963780] Subtest basic-llseek-size: SUCCESS (0.006s)
[124.045279] [131/160] (870s left) prime_self_import (basic-with_fd_dup)
[124.129177] Starting subtest: basic-with_fd_dup
[124.131538] Subtest basic-with_fd_dup: SUCCESS (0.003s)
[124.213661] [132/160] (870s left) prime_self_import (basic-with_one_bo)
[124.298341] Starting subtest: basic-with_one_bo
[124.300657] Subtest basic-with_one_bo: SUCCESS (0.003s)
[124.382554] [133/160] (870s left) prime_self_import (basic-with_one_bo_two_files)
[124.469026] Starting subtest: basic-with_one_bo_two_files
[124.472692] Subtest basic-with_one_bo_two_files: SUCCESS (0.003s)
[124.545915] [134/160] (870s left) prime_self_import (basic-with_two_bos)
[124.628125] Starting subtest: basic-with_two_bos
[124.630315] Subtest basic-with_two_bos: SUCCESS (0.003s)
[124.697473] [135/160] (870s left) prime_vgem (basic-fence-flip)
[124.792227] Starting subtest: basic-fence-flip
[125.174906] Subtest basic-fence-flip: SUCCESS (0.382s)
[125.250429] [136/160] (869s left) prime_vgem (basic-fence-mmap)
[125.344382] Starting subtest: basic-fence-mmap
[125.386803] Subtest basic-fence-mmap: SUCCESS (0.043s)
[125.467353] [137/160] (869s left) prime_vgem (basic-fence-read)
[125.561020] Starting subtest: basic-fence-read
[125.621587] Subtest basic-fence-read: SUCCESS (0.061s)
[125.702111] [138/160] (869s left) prime_vgem (basic-gtt)
[125.794272] Starting subtest: basic-gtt
[125.814168] Subtest basic-gtt: SUCCESS (0.019s)
[125.901321] [139/160] (869s left) prime_vgem (basic-read)
[125.995270] Starting subtest: basic-read
[126.022100] Subtest basic-read: SUCCESS (0.027s)
[126.100895] [140/160] (868s left) prime_vgem (basic-write)
[126.198331] Starting subtest: basic-write
[126.226407] Subtest basic-write: SUCCESS (0.030s)
[126.302032] [141/160] (868s left) vgem_basic (setversion)
[126.394203] Starting subtest: setversion
[126.396603] Subtest setversion: SUCCESS (0.000s)
[126.453649] [142/160] (868s left) vgem_basic (create)
[126.544767] Starting subtest: create
[126.546000] Subtest create: SUCCESS (0.000s)
[126.602527] [143/160] (868s left) vgem_basic (debugfs)
[126.694641] Starting subtest: debugfs
[126.695787] Subtest debugfs: SUCCESS (0.001s)
[126.754115] [144/160] (868s left) vgem_basic (dmabuf-export)
[126.845245] Starting subtest: dmabuf-export
[126.847679] Subtest dmabuf-export: SUCCESS (0.003s)
[126.921257] [145/160] (868s left) vgem_basic (dmabuf-fence)
[127.014152] Starting subtest: dmabuf-fence
[127.015371] Subtest dmabuf-fence: SUCCESS (0.001s)
[127.071801] [146/160] (868s left) vgem_basic (dmabuf-fence-before)
[127.163128] Starting subtest: dmabuf-fence-before
[127.164331] Subtest dmabuf-fence-before: SUCCESS (0.001s)
[127.221407] [147/160] (867s left) vgem_basic (dmabuf-mmap)
[127.313372] Starting subtest: dmabuf-mmap
[127.333127] Subtest dmabuf-mmap: SUCCESS (0.021s)
[127.390222] [148/160] (867s left) vgem_basic (mmap)
[127.480341] Starting subtest: mmap
[127.494756] Subtest mmap: SUCCESS (0.015s)
[127.555820] [149/160] (867s left) vgem_basic (second-client)
[127.647196] Starting subtest: second-client
[127.681735] Subtest second-client: SUCCESS (0.033s)
[127.740125] [150/160] (867s left) vgem_basic (sysfs)
[127.832563] Starting subtest: sysfs
[127.833773] Subtest sysfs: SUCCESS (0.001s)
[127.891798] [151/160] (867s left) core_hotunplug (unbind-rebind)
[128.030724] Starting subtest: unbind-rebind
[130.722246] Subtest unbind-rebind: SUCCESS (2.691s)
[130.751306] [152/160] (864s left) vgem_basic (unload)
[130.838450] Starting subtest: unload
[159.712706] Subtest unload: SUCCESS (28.872s)
[159.816900] [153/160] (835s left) i915_module_load (reload)
[159.901074] Starting subtest: reload
[161.680969] Subtest reload: SUCCESS (1.778s)
[161.700671] [154/160] (833s left) gem_lmem_swapping (basic)
[161.797375] Subtest basic: SKIP (0.000s)
[161.821817] [155/160] (833s left) gem_lmem_swapping (parallel-random-engines)
[161.909305] Subtest parallel-random-engines: SKIP (0.000s)
[161.939318] [156/160] (833s left) gem_lmem_swapping (random-engines)
[162.052680] Subtest random-engines: SKIP (0.000s)
[162.099208] [157/160] (833s left) gem_lmem_swapping (verify-random)
[162.226446] Subtest verify-random: SKIP (0.000s)
[162.257689] [158/160] (833s left) i915_pm_rpm (module-reload)
[173.526703] Subtest module-reload: SKIP (0.000s)
[173.562697] [159/160] (821s left) i915_selftest (live)
[174.152484] Starting subtest: live
[174.153720] Starting dynamic subtest: sanitycheck
[174.835166] Dynamic subtest sanitycheck: SUCCESS (0.682s)
[174.844122] Starting dynamic subtest: uncore
[175.477165] Dynamic subtest uncore: SUCCESS (0.641s)
[175.486030] Starting dynamic subtest: workarounds
[176.098238] Dynamic subtest workarounds: SUCCESS (0.620s)
[176.106350] Starting dynamic subtest: gt_engines
[176.767218] Dynamic subtest gt_engines: SUCCESS (0.666s)
[176.774777] Starting dynamic subtest: gt_timelines
[179.509332] Dynamic subtest gt_timelines: SUCCESS (2.741s)
[179.517513] Starting dynamic subtest: gt_contexts
[180.167049] Dynamic subtest gt_contexts: SUCCESS (0.658s)
[180.175157] Starting dynamic subtest: gt_lrc
[180.809234] Dynamic subtest gt_lrc: SUCCESS (0.639s)
[180.817027] Starting dynamic subtest: gt_mocs
[181.434862] Dynamic subtest gt_mocs: SUCCESS (0.627s)
[181.443472] Starting dynamic subtest: gt_pm
[182.560127] Dynamic subtest gt_pm: SUCCESS (1.122s)
[182.568204] Starting dynamic subtest: gt_heartbeat
[183.215126] Dynamic subtest gt_heartbeat: SUCCESS (0.654s)
[183.222775] Starting dynamic subtest: gt_tlb
[183.829164] Dynamic subtest gt_tlb: SUCCESS (0.615s)
[183.837650] Starting dynamic subtest: requests
[187.008077] Dynamic subtest requests: SUCCESS (3.178s)
[187.016997] Starting dynamic subtest: migrate
[187.642149] Dynamic subtest migrate: SUCCESS (0.633s)
[187.650545] Starting dynamic subtest: active
[188.303033] Dynamic subtest active: SUCCESS (0.660s)
[188.311498] Starting dynamic subtest: objects
[189.274114] Dynamic subtest objects: SUCCESS (0.970s)
[189.282793] Starting dynamic subtest: mman
[194.174988] Dynamic subtest mman: SUCCESS (4.900s)
[194.183662] Starting dynamic subtest: dmabuf
[194.841251] Dynamic subtest dmabuf: SUCCESS (0.665s)
[194.850202] Starting dynamic subtest: vma
[195.503227] Dynamic subtest vma: SUCCESS (0.661s)
[195.511362] Starting dynamic subtest: coherency
[197.584323] Dynamic subtest coherency: SUCCESS (2.080s)
[197.592950] Starting dynamic subtest: gtt
[201.090483] Dynamic subtest gtt: SUCCESS (3.505s)
[201.098677] Starting dynamic subtest: gem
[201.767162] Dynamic subtest gem: SUCCESS (0.676s)
[201.775704] Starting dynamic subtest: evict
[202.410379] Dynamic subtest evict: SUCCESS (0.642s)
[202.419047] Starting dynamic subtest: hugepages
[203.032089] Dynamic subtest hugepages: SUCCESS (0.621s)
[203.041051] Starting dynamic subtest: gem_contexts
[203.650963] Dynamic subtest gem_contexts: SUCCESS (0.618s)
[203.660057] Starting dynamic subtest: client
[204.290189] Dynamic subtest client: SUCCESS (0.638s)
[204.298336] Starting dynamic subtest: gem_migrate
[204.924197] Dynamic subtest gem_migrate: SUCCESS (0.633s)
[204.932592] Starting dynamic subtest: reset
[205.901132] Dynamic subtest reset: SUCCESS (0.974s)
[205.909592] Starting dynamic subtest: memory_region
[206.562123] Dynamic subtest memory_region: SUCCESS (0.662s)
[206.570717] Starting dynamic subtest: hangcheck
[208.288241] Dynamic subtest hangcheck: SUCCESS (1.723s)
[208.295887] Starting dynamic subtest: execlists
[208.915905] Dynamic subtest execlists: SUCCESS (0.628s)
[208.925146] Starting dynamic subtest: ring_submission
[209.564090] Dynamic subtest ring_submission: SUCCESS (0.647s)
[209.572714] Starting dynamic subtest: perf
[210.181557] Dynamic subtest perf: SUCCESS (0.616s)
[210.188661] Starting dynamic subtest: slpc
[210.812038] Dynamic subtest slpc: SUCCESS (0.629s)
[210.820838] Starting dynamic subtest: guc
[211.440147] Dynamic subtest guc: SUCCESS (0.627s)
[211.448625] Starting dynamic subtest: guc_multi_lrc
[212.091184] Dynamic subtest guc_multi_lrc: SUCCESS (0.650s)
[212.099746] Starting dynamic subtest: guc_hang
[212.718276] Dynamic subtest guc_hang: SUCCESS (0.624s)
[212.726518] Starting dynamic subtest: late_gt_pm
[213.359076] Dynamic subtest late_gt_pm: SUCCESS (0.642s)
[213.360254] Subtest live: SUCCESS (39.207s)
[213.382711] [160/160] (782s left) dmabuf (all-tests)
[213.472046] Starting subtest: all-tests
[213.479119] Starting dynamic subtest: sanitycheck
[213.533135] Dynamic subtest sanitycheck: SUCCESS (0.059s)
[213.540321] Starting dynamic subtest: dma_fence
[213.711043] Dynamic subtest dma_fence: SUCCESS (0.177s)
[213.720248] Starting dynamic subtest: dma_fence_chain
[230.994461] Dynamic subtest dma_fence_chain: SUCCESS (17.280s)
[231.006055] Starting dynamic subtest: dma_fence_unwrap
[231.054075] Dynamic subtest dma_fence_unwrap: SUCCESS (0.060s)
[231.068294] Starting dynamic subtest: dma_resv
[231.112625] Dynamic subtest dma_resv: SUCCESS (0.059s)
[231.114358] Subtest all-tests: SUCCESS (17.643s)
[231.134235] Closing watchdogs
Done.