[84.676881] Initializing watchdogs
[84.677302]   /dev/watchdog0
[84.743579] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:22b1 Intel Cherryview (Gen8) Atom/Celeron/Pentium Processor x5-E8000/J3xxx/N3xxx Integrated Graphics Controller
[84.768449] [001/161] (960s left) i915_module_load (load)
[85.681599] Starting subtest: load
[91.112402] Subtest load: SUCCESS (5.428s)
[91.480687] [FACT i915_module_load (load)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[91.506311] [FACT i915_module_load (load)] new: kernel.kmod_is_loaded.i915: true
[91.537965] [002/161] (954s left) core_auth (basic-auth)
[92.127140] Starting subtest: basic-auth
[92.140162] Subtest basic-auth: SUCCESS (0.009s)
[92.397718] [003/161] (953s left) debugfs_test (read_all_entries)
[92.747794] Starting subtest: read_all_entries
[93.014933] Subtest read_all_entries: SUCCESS (0.269s)
[93.718876] [004/161] (952s left) debugfs_test (basic-hwmon)
[93.991394] Starting subtest: basic-hwmon
[93.997352] Subtest basic-hwmon: SKIP (0.000s)
[94.649430] [005/161] (951s left) debugfs_test (sysfs)
[94.936312] Starting subtest: sysfs
[95.304125] Subtest sysfs: SUCCESS (0.372s)
[96.099912] [006/161] (950s left) fbdev (eof)
[96.381359] Starting subtest: eof
[96.384456] Subtest eof: SUCCESS (0.005s)
[96.582141] [007/161] (950s left) fbdev (info)
[96.835556] Starting subtest: info
[96.838065] Subtest info: SUCCESS (0.000s)
[97.048859] [008/161] (949s left) fbdev (nullptr)
[97.323717] Starting subtest: nullptr
[97.325406] Subtest nullptr: SUCCESS (0.000s)
[97.515694] [009/161] (949s left) fbdev (read)
[97.791461] Starting subtest: read
[99.868074] Subtest read: SUCCESS (2.071s)
[100.066574] [010/161] (947s left) fbdev (write)
[100.321998] Starting subtest: write
[101.417714] Subtest write: SUCCESS (1.094s)
[101.626751] [011/161] (945s left) gem_basic (bad-close)
[101.882294] Starting subtest: bad-close
[101.887439] Subtest bad-close: SUCCESS (0.000s)
[102.099946] [012/161] (945s left) gem_basic (create-close)
[102.359645] Starting subtest: create-close
[102.365263] Subtest create-close: SUCCESS (0.001s)
[102.591386] [013/161] (945s left) gem_basic (create-fd-close)
[102.858961] Starting subtest: create-fd-close
[102.862454] Subtest create-fd-close: SUCCESS (0.001s)
[103.078995] [014/161] (944s left) gem_busy (busy@all-engines)
[103.397122] Starting subtest: busy
[103.398666] Starting dynamic subtest: all-engines
[103.609314] Dynamic subtest all-engines: SUCCESS (0.210s)
[103.610964] Subtest busy: SUCCESS (0.215s)
[104.274723] [015/161] (943s left) gem_close_race (basic-process)
[104.612679] Starting subtest: basic-process
[104.753911] Subtest basic-process: SUCCESS (0.146s)
[105.105726] [016/161] (943s left) gem_close_race (basic-threads)
[105.439221] Starting subtest: basic-threads
[106.756967] Subtest basic-threads: SUCCESS (1.321s)
[107.099541] [017/161] (941s left) gem_ctx_create (basic)
[107.407311] Starting subtest: basic
[107.409587] Subtest basic: SUCCESS (0.000s)
[107.762312] [018/161] (940s left) gem_ctx_create (basic-files)
[108.067342] Starting subtest: basic-files
[110.153549] Subtest basic-files: SUCCESS (2.081s)
[110.511262] [019/161] (938s left) gem_ctx_exec (basic)
[110.770870] Starting subtest: basic
[110.786091] Subtest basic: SUCCESS (0.014s)
[111.038476] [020/161] (937s left) gem_exec_basic (basic)
[111.329094] Starting subtest: basic
[111.330952] Starting dynamic subtest: rcs0-smem
[111.334974] Dynamic subtest rcs0-smem: SUCCESS (0.005s)
[111.359952] Starting dynamic subtest: bcs0-smem
[111.362993] Dynamic subtest bcs0-smem: SUCCESS (0.028s)
[111.392285] Starting dynamic subtest: vcs0-smem
[111.394110] Dynamic subtest vcs0-smem: SUCCESS (0.024s)
[111.418362] Starting dynamic subtest: vecs0-smem
[111.421250] Dynamic subtest vecs0-smem: SUCCESS (0.026s)
[111.422881] Subtest basic: SUCCESS (0.096s)
[111.788540] [021/161] (937s left) gem_exec_create (basic)
[112.103508] Starting subtest: basic
[112.106268] Starting dynamic subtest: smem
[114.205843] Dynamic subtest smem: SUCCESS (2.100s)
[114.209298] Subtest basic: SUCCESS (2.102s)
[114.578938] [022/161] (934s left) gem_exec_fence (basic-busy)
[115.055621] Starting subtest: basic-busy
[115.060200] Starting dynamic subtest: rcs0
[115.095358] Dynamic subtest rcs0: SUCCESS (0.038s)
[115.122496] Starting dynamic subtest: bcs0
[115.137475] Dynamic subtest bcs0: SUCCESS (0.038s)
[115.161654] Starting dynamic subtest: vcs0
[115.182998] Dynamic subtest vcs0: SUCCESS (0.046s)
[115.220772] Starting dynamic subtest: vecs0
[115.223956] Dynamic subtest vecs0: SUCCESS (0.036s)
[115.225534] Subtest basic-busy: SUCCESS (0.162s)
[116.231313] [FACT gem_exec_fence (basic-busy)] new: kernel.kmod_is_loaded.vgem: true
[116.243230] [023/161] (933s left) gem_exec_fence (basic-wait)
[116.741192] Starting subtest: basic-wait
[116.742861] Starting dynamic subtest: rcs0
[116.770284] Dynamic subtest rcs0: SUCCESS (0.029s)
[116.802039] Starting dynamic subtest: bcs0
[116.809188] Dynamic subtest bcs0: SUCCESS (0.036s)
[116.836893] Starting dynamic subtest: vcs0
[116.848734] Dynamic subtest vcs0: SUCCESS (0.036s)
[116.873741] Starting dynamic subtest: vecs0
[116.884461] Dynamic subtest vecs0: SUCCESS (0.034s)
[116.885945] Subtest basic-wait: SUCCESS (0.144s)
[117.724699] [024/161] (931s left) gem_exec_fence (basic-await)
[118.210196] Starting subtest: basic-await
[118.214146] Starting dynamic subtest: rcs0
[118.440186] Dynamic subtest rcs0: SUCCESS (0.221s)
[118.465567] Starting dynamic subtest: bcs0
[118.672313] Dynamic subtest bcs0: SUCCESS (0.232s)
[118.704711] Starting dynamic subtest: vcs0
[118.931303] Dynamic subtest vcs0: SUCCESS (0.255s)
[118.960188] Starting dynamic subtest: vecs0
[119.159865] Dynamic subtest vecs0: SUCCESS (0.231s)
[119.162156] Subtest basic-await: SUCCESS (0.946s)
[120.011455] [025/161] (929s left) gem_exec_fence (nb-await)
[120.498308] Starting subtest: nb-await
[120.499914] Starting dynamic subtest: rcs0
[120.602085] Dynamic subtest rcs0: SUCCESS (0.096s)
[120.628668] Starting dynamic subtest: bcs0
[120.706587] Dynamic subtest bcs0: SUCCESS (0.103s)
[120.732432] Starting dynamic subtest: vcs0
[120.802882] Dynamic subtest vcs0: SUCCESS (0.095s)
[120.828441] Starting dynamic subtest: vecs0
[120.900702] Dynamic subtest vecs0: SUCCESS (0.097s)
[120.902848] Subtest nb-await: SUCCESS (0.399s)
[121.760084] [026/161] (928s left) gem_exec_gttfill (basic)
[122.071960] Starting subtest: basic
[124.052268] Subtest basic: SKIP (1.954s)
[124.453119] [027/161] (925s left) gem_exec_parallel (engines)
[124.961912] Starting subtest: engines
[124.964037] Starting dynamic subtest: basic
[131.299453] Dynamic subtest basic: SUCCESS (6.342s)
[131.328636] Starting dynamic subtest: contexts
[142.266160] Dynamic subtest contexts: SUCCESS (10.966s)
[142.294795] Starting dynamic subtest: fds
[153.100431] Dynamic subtest fds: SUCCESS (10.824s)
[153.147713] Starting dynamic subtest: userptr
[159.378251] Dynamic subtest userptr: SUCCESS (6.285s)
[159.380037] Subtest engines: SUCCESS (34.423s)
[159.799989] [028/161] (890s left) gem_exec_store (basic)
[160.115144] Starting subtest: basic
[160.192824] Subtest basic: SUCCESS (0.081s)
[160.574687] [029/161] (890s left) gem_flink_basic (bad-flink)
[160.837319] Starting subtest: bad-flink
[160.840475] Subtest bad-flink: SUCCESS (0.000s)
[161.086591] [030/161] (889s left) gem_flink_basic (bad-open)
[161.342254] Starting subtest: bad-open
[161.346774] Subtest bad-open: SUCCESS (0.000s)
[161.586460] [031/161] (889s left) gem_flink_basic (basic)
[161.841908] Starting subtest: basic
[161.844325] Subtest basic: SUCCESS (0.000s)
[162.103783] [032/161] (889s left) gem_flink_basic (double-flink)
[162.360317] Starting subtest: double-flink
[162.364715] Subtest double-flink: SUCCESS (0.000s)
[162.621687] [033/161] (888s left) gem_flink_basic (flink-lifetime)
[162.874573] Starting subtest: flink-lifetime
[162.881577] Subtest flink-lifetime: SUCCESS (0.007s)
[163.131819] [034/161] (888s left) gem_huc_copy (huc-copy)
[163.412914] Subtest huc-copy: SKIP (0.000s)
[163.624524] [035/161] (888s left) gem_linear_blits (basic)
[164.247201] Subtest basic: SKIP (0.000s)
[164.480479] [036/161] (887s left) gem_mmap (basic)
[164.926754] Starting subtest: basic
[164.936094] Subtest basic: SUCCESS (0.001s)
[165.177162] [037/161] (887s left) gem_mmap_gtt (basic)
[165.439318] Starting subtest: basic
[165.449996] Subtest basic: SUCCESS (0.004s)
[165.702643] [038/161] (886s left) gem_render_linear_blits (basic)
[165.977503] Starting subtest: basic
[166.091346] Subtest basic: SUCCESS (0.107s)
[166.331549] [039/161] (886s left) gem_render_tiled_blits (basic)
[166.598595] Starting subtest: basic
[166.777299] Subtest basic: SUCCESS (0.163s)
[166.978934] [040/161] (885s left) gem_ringfill (basic-all)
[167.490974] Starting subtest: basic-all
[168.885445] Subtest basic-all: SUCCESS (1.393s)
[169.149804] [041/161] (883s left) gem_softpin (allocator-basic)
[169.415651] Starting subtest: allocator-basic
[169.801218] Subtest allocator-basic: SUCCESS (0.367s)
[170.102343] [042/161] (883s left) gem_softpin (allocator-basic-reserve)
[170.369245] Starting subtest: allocator-basic-reserve
[170.736162] Subtest allocator-basic-reserve: SUCCESS (0.357s)
[171.030766] [043/161] (882s left) gem_softpin (safe-alignment)
[171.312508] Starting subtest: safe-alignment
[171.375499] Subtest safe-alignment: SUCCESS (0.056s)
[171.624480] [044/161] (881s left) gem_sync (basic-all)
[171.944206] Starting subtest: basic-all
[175.083681] Subtest basic-all: SUCCESS (3.139s)
[175.445777] [045/161] (878s left) gem_sync (basic-each)
[175.768058] Starting subtest: basic-each
[178.426491] Subtest basic-each: SUCCESS (2.662s)
[178.822833] [046/161] (875s left) gem_tiled_blits (basic)
[179.362692] Subtest basic: SKIP (0.000s)
[179.556064] [047/161] (874s left) gem_tiled_fence_blits (basic)
[180.229742] Starting subtest: basic
[180.296482] Subtest basic: SUCCESS (0.063s)
[180.605738] [048/161] (873s left) gem_tiled_pread_basic
[182.101425] [049/161] (872s left) gem_wait (busy@all-engines)
[182.445764] Starting subtest: busy
[182.449602] Starting dynamic subtest: all-engines
[182.984111] Dynamic subtest all-engines: SUCCESS (0.538s)
[182.988592] Subtest busy: SUCCESS (0.541s)
[183.462574] [050/161] (871s left) gem_wait (wait@all-engines)
[183.810860] Starting subtest: wait
[183.812703] Starting dynamic subtest: all-engines
[184.851375] Dynamic subtest all-engines: SUCCESS (1.044s)
[184.853194] Subtest wait: SUCCESS (1.046s)
[185.356882] [051/161] (869s left) i915_getparams_basic (basic-eu-total)
[185.613303] Starting subtest: basic-eu-total
[185.617316] Subtest basic-eu-total: SUCCESS (0.000s)
[185.860413] [052/161] (869s left) i915_getparams_basic (basic-subslice-total)
[186.132593] Starting subtest: basic-subslice-total
[186.140967] Subtest basic-subslice-total: SUCCESS (0.000s)
[186.361457] [053/161] (869s left) i915_hangman (error-state-basic)
[186.668678] Starting subtest: error-state-basic
[186.711142] Subtest error-state-basic: SUCCESS (0.029s)
[187.008422] [054/161] (868s left) i915_pciid
[187.492990] [055/161] (868s left) kms_addfb_basic (addfb25-4-tiled)
[188.199080] Starting subtest: addfb25-4-tiled
[188.208382] Subtest addfb25-4-tiled: SUCCESS (0.001s)
[188.466669] [056/161] (867s left) kms_addfb_basic (addfb25-bad-modifier)
[189.198285] Starting subtest: addfb25-bad-modifier
[189.202506] Subtest addfb25-bad-modifier: SUCCESS (0.004s)
[189.439698] [057/161] (866s left) kms_addfb_basic (addfb25-framebuffer-vs-set-tiling)
[190.182061] Starting subtest: addfb25-framebuffer-vs-set-tiling
[190.185605] Subtest addfb25-framebuffer-vs-set-tiling: SUCCESS (0.000s)
[190.432745] [058/161] (865s left) kms_addfb_basic (addfb25-modifier-no-flag)
[191.160885] Starting subtest: addfb25-modifier-no-flag
[191.163682] Subtest addfb25-modifier-no-flag: SUCCESS (0.000s)
[191.401478] [059/161] (865s left) kms_addfb_basic (addfb25-x-tiled-legacy)
[192.101054] Starting subtest: addfb25-x-tiled-legacy
[192.102685] Subtest addfb25-x-tiled-legacy: SUCCESS (0.000s)
[192.343392] [060/161] (864s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy)
[193.073074] Starting subtest: addfb25-x-tiled-mismatch-legacy
[193.077594] Subtest addfb25-x-tiled-mismatch-legacy: SUCCESS (0.001s)
[193.336679] [061/161] (863s left) kms_addfb_basic (addfb25-yf-tiled-legacy)
[194.051324] Starting subtest: addfb25-yf-tiled-legacy
[194.055054] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.002s)
[194.305554] [062/161] (862s left) kms_addfb_basic (addfb25-y-tiled-legacy)
[195.014513] Starting subtest: addfb25-y-tiled-legacy
[195.018375] Subtest addfb25-y-tiled-legacy: SUCCESS (0.002s)
[195.275999] [063/161] (862s left) kms_addfb_basic (addfb25-y-tiled-small-legacy)
[195.979841] Starting subtest: addfb25-y-tiled-small-legacy
[195.986769] Subtest addfb25-y-tiled-small-legacy: SKIP (0.000s)
[196.236557] [064/161] (861s left) kms_addfb_basic (bad-pitch-0)
[196.494785] Starting subtest: bad-pitch-0
[196.498348] Subtest bad-pitch-0: SUCCESS (0.000s)
[197.216787] [065/161] (860s left) kms_addfb_basic (bad-pitch-1024)
[197.511038] Starting subtest: bad-pitch-1024
[197.513674] Subtest bad-pitch-1024: SUCCESS (0.000s)
[198.247526] [066/161] (859s left) kms_addfb_basic (bad-pitch-128)
[198.506244] Starting subtest: bad-pitch-128
[198.507752] Subtest bad-pitch-128: SUCCESS (0.000s)
[199.204832] [067/161] (858s left) kms_addfb_basic (bad-pitch-256)
[199.464529] Starting subtest: bad-pitch-256
[199.466592] Subtest bad-pitch-256: SUCCESS (0.000s)
[200.178686] [068/161] (858s left) kms_addfb_basic (bad-pitch-32)
[200.444282] Starting subtest: bad-pitch-32
[200.447992] Subtest bad-pitch-32: SUCCESS (0.000s)
[201.241505] [069/161] (857s left) kms_addfb_basic (bad-pitch-63)
[201.500772] Starting subtest: bad-pitch-63
[201.503542] Subtest bad-pitch-63: SUCCESS (0.000s)
[202.207150] [070/161] (856s left) kms_addfb_basic (bad-pitch-65536)
[202.459862] Starting subtest: bad-pitch-65536
[202.463193] Subtest bad-pitch-65536: SUCCESS (0.001s)
[203.145439] [071/161] (855s left) kms_addfb_basic (bad-pitch-999)
[203.407335] Starting subtest: bad-pitch-999
[203.411495] Subtest bad-pitch-999: SUCCESS (0.000s)
[204.135084] [072/161] (854s left) kms_addfb_basic (basic)
[204.397581] Starting subtest: basic
[204.400513] Subtest basic: SUCCESS (0.000s)
[205.134208] [073/161] (854s left) kms_addfb_basic (basic-x-tiled-legacy)
[205.404369] Starting subtest: basic-x-tiled-legacy
[205.407304] Subtest basic-x-tiled-legacy: SUCCESS (0.000s)
[206.113755] [074/161] (853s left) kms_addfb_basic (basic-y-tiled-legacy)
[206.372489] Starting subtest: basic-y-tiled-legacy
[206.374342] Subtest basic-y-tiled-legacy: SUCCESS (0.001s)
[207.091110] [075/161] (852s left) kms_addfb_basic (bo-too-small)
[207.824343] Starting subtest: bo-too-small
[207.832811] Subtest bo-too-small: SUCCESS (0.005s)
[208.086548] [076/161] (851s left) kms_addfb_basic (bo-too-small-due-to-tiling)
[208.782256] Starting subtest: bo-too-small-due-to-tiling
[208.784214] Subtest bo-too-small-due-to-tiling: SUCCESS (0.002s)
[209.032735] [077/161] (851s left) kms_addfb_basic (clobberred-modifier)
[209.301246] Starting subtest: clobberred-modifier
[209.303791] Subtest clobberred-modifier: SUCCESS (0.001s)
[210.025706] [078/161] (850s left) kms_addfb_basic (framebuffer-vs-set-tiling)
[210.288629] Starting subtest: framebuffer-vs-set-tiling
[210.291267] Subtest framebuffer-vs-set-tiling: SUCCESS (0.001s)
[211.003657] [079/161] (849s left) kms_addfb_basic (invalid-get-prop)
[211.274218] Starting subtest: invalid-get-prop
[211.275738] Subtest invalid-get-prop: SUCCESS (0.000s)
[211.977920] [080/161] (848s left) kms_addfb_basic (invalid-get-prop-any)
[212.232838] Starting subtest: invalid-get-prop-any
[212.234543] Subtest invalid-get-prop-any: SUCCESS (0.000s)
[212.985420] [081/161] (847s left) kms_addfb_basic (invalid-set-prop)
[213.241983] Starting subtest: invalid-set-prop
[213.243539] Subtest invalid-set-prop: SUCCESS (0.000s)
[213.942897] [082/161] (847s left) kms_addfb_basic (invalid-set-prop-any)
[214.217247] Starting subtest: invalid-set-prop-any
[214.220319] Subtest invalid-set-prop-any: SUCCESS (0.000s)
[214.928910] [083/161] (846s left) kms_addfb_basic (no-handle)
[215.190720] Starting subtest: no-handle
[215.194487] Subtest no-handle: SUCCESS (0.001s)
[215.915807] [084/161] (845s left) kms_addfb_basic (size-max)
[216.668614] Starting subtest: size-max
[216.671156] Subtest size-max: SUCCESS (0.003s)
[216.937490] [085/161] (844s left) kms_addfb_basic (small-bo)
[217.654978] Starting subtest: small-bo
[217.658484] Subtest small-bo: SUCCESS (0.000s)
[217.892475] [086/161] (843s left) kms_addfb_basic (tile-pitch-mismatch)
[218.158305] Starting subtest: tile-pitch-mismatch
[218.161187] Subtest tile-pitch-mismatch: SUCCESS (0.001s)
[218.905547] [087/161] (843s left) kms_addfb_basic (too-high)
[219.645510] Starting subtest: too-high
[219.654974] Subtest too-high: SUCCESS (0.006s)
[219.916443] [088/161] (842s left) kms_addfb_basic (too-wide)
[220.642882] Starting subtest: too-wide
[220.644538] Subtest too-wide: SUCCESS (0.000s)
[220.915681] [089/161] (841s left) kms_addfb_basic (unused-handle)
[221.194782] Starting subtest: unused-handle
[221.197248] Subtest unused-handle: SUCCESS (0.000s)
[221.964547] [090/161] (840s left) kms_addfb_basic (unused-modifier)
[222.225108] Starting subtest: unused-modifier
[222.227163] Subtest unused-modifier: SUCCESS (0.000s)
[222.972737] [091/161] (839s left) kms_addfb_basic (unused-offsets)
[223.235649] Starting subtest: unused-offsets
[223.239785] Subtest unused-offsets: SUCCESS (0.000s)
[223.947649] [092/161] (839s left) kms_addfb_basic (unused-pitches)
[224.217923] Starting subtest: unused-pitches
[224.220928] Subtest unused-pitches: SUCCESS (0.000s)
[225.008552] [093/161] (838s left) kms_busy (basic)
[225.728934] Starting subtest: basic
[225.734685] Starting dynamic subtest: flip
[226.711995] Dynamic subtest flip: SUCCESS (0.979s)
[226.775790] Starting dynamic subtest: modeset
[228.639655] Dynamic subtest modeset: SUCCESS (1.923s)
[228.644262] Subtest basic: SUCCESS (2.915s)
[229.350277] [094/161] (834s left) kms_prop_blob (basic)
[229.609519] Starting subtest: basic
[229.612237] Subtest basic: SUCCESS (0.000s)
[229.872571] [095/161] (833s left) kms_cursor_legacy (basic-busy-flip-before-cursor-atomic)
[230.627811] Starting subtest: basic-busy-flip-before-cursor-atomic
[231.709754] Subtest basic-busy-flip-before-cursor-atomic: SUCCESS (1.076s)
[232.285688] [096/161] (831s left) kms_cursor_legacy (basic-busy-flip-before-cursor-legacy)
[233.069296] Starting subtest: basic-busy-flip-before-cursor-legacy
[234.143325] Subtest basic-busy-flip-before-cursor-legacy: SUCCESS (1.064s)
[234.786206] [097/161] (829s left) kms_cursor_legacy (basic-flip-after-cursor-atomic)
[235.534549] Starting subtest: basic-flip-after-cursor-atomic
[236.584201] Subtest basic-flip-after-cursor-atomic: SUCCESS (1.043s)
[237.187419] [098/161] (827s left) kms_cursor_legacy (basic-flip-after-cursor-legacy)
[237.865886] Starting subtest: basic-flip-after-cursor-legacy
[238.910254] Subtest basic-flip-after-cursor-legacy: SUCCESS (1.045s)
[239.515395] [099/161] (824s left) kms_cursor_legacy (basic-flip-after-cursor-varying-size)
[240.244126] Starting subtest: basic-flip-after-cursor-varying-size
[241.282979] Subtest basic-flip-after-cursor-varying-size: SUCCESS (1.036s)
[241.898380] [100/161] (822s left) kms_cursor_legacy (basic-flip-before-cursor-atomic)
[242.621780] Starting subtest: basic-flip-before-cursor-atomic
[243.665982] Subtest basic-flip-before-cursor-atomic: SUCCESS (1.036s)
[244.327699] [101/161] (820s left) kms_cursor_legacy (basic-flip-before-cursor-legacy)
[245.075919] Starting subtest: basic-flip-before-cursor-legacy
[246.117775] Subtest basic-flip-before-cursor-legacy: SUCCESS (1.037s)
[246.738290] [102/161] (818s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size)
[247.489276] Starting subtest: basic-flip-before-cursor-varying-size
[248.534558] Subtest basic-flip-before-cursor-varying-size: SUCCESS (1.043s)
[249.164958] [103/161] (816s left) kms_dsc (dsc-basic)
[249.912122] Subtest dsc-basic: SKIP (0.000s)
[250.124659] [104/161] (815s left) kms_flip (basic-flip-vs-dpms)
[250.895354] Starting subtest: basic-flip-vs-dpms
[250.908780] Starting dynamic subtest: C-HDMI-A2
[253.737239] Dynamic subtest C-HDMI-A2: SUCCESS (2.814s)
[253.740621] Subtest basic-flip-vs-dpms: SUCCESS (2.837s)
[254.365915] [105/161] (811s left) kms_flip (basic-flip-vs-modeset)
[255.129086] Starting subtest: basic-flip-vs-modeset
[255.142216] Starting dynamic subtest: C-HDMI-A2
[257.929218] Dynamic subtest C-HDMI-A2: SUCCESS (2.769s)
[257.936209] Subtest basic-flip-vs-modeset: SUCCESS (2.795s)
[258.618865] [106/161] (807s left) kms_flip (basic-flip-vs-wf_vblank)
[259.396132] Starting subtest: basic-flip-vs-wf_vblank
[259.419810] Starting dynamic subtest: C-HDMI-A2
[262.342767] Dynamic subtest C-HDMI-A2: SUCCESS (2.925s)
[262.348339] Subtest basic-flip-vs-wf_vblank: SUCCESS (2.950s)
[262.679428] [107/161] (803s left) kms_flip (basic-plain-flip)
[263.439232] Starting subtest: basic-plain-flip
[263.447532] Starting dynamic subtest: C-HDMI-A2
[265.952152] Dynamic subtest C-HDMI-A2: SUCCESS (2.499s)
[265.959040] Subtest basic-plain-flip: SUCCESS (2.518s)
[266.282250] [108/161] (800s left) kms_force_connector_basic (force-connector-state)
[266.672186] Starting subtest: force-connector-state
[267.642414] Subtest force-connector-state: SUCCESS (0.962s)
[269.241973] [109/161] (797s left) kms_force_connector_basic (force-edid)
[269.648267] Starting subtest: force-edid
[269.754530] Subtest force-edid: SUCCESS (0.110s)
[270.720809] [110/161] (795s left) kms_force_connector_basic (force-load-detect)
[271.111453] Starting subtest: force-load-detect
[271.119753] Subtest force-load-detect: SKIP (0.000s)
[271.713535] [111/161] (795s left) kms_force_connector_basic (prune-stale-modes)
[272.154476] Starting subtest: prune-stale-modes
[272.323617] Subtest prune-stale-modes: SUCCESS (0.161s)
[273.282132] [112/161] (793s left) kms_frontbuffer_tracking (basic)
[274.067339] Starting subtest: basic
[279.101368] Subtest basic: SUCCESS (5.032s)
[279.382738] [113/161] (787s left) kms_hdmi_inject (inject-audio)
[279.756574] Starting subtest: inject-audio
[280.343087] Subtest inject-audio: SUCCESS (0.572s)
[281.065127] [114/161] (786s left) kms_pipe_crc_basic (compare-crc-sanitycheck-xr24)
[281.842535] Starting subtest: compare-crc-sanitycheck-xr24
[281.855520] Starting dynamic subtest: pipe-C-HDMI-A-2
[282.425306] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.552s)
[282.441337] Subtest compare-crc-sanitycheck-xr24: SUCCESS (0.569s)
[283.033387] [115/161] (784s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12)
[283.811581] Starting subtest: compare-crc-sanitycheck-nv12
[283.814360] Starting dynamic subtest: pipe-C-HDMI-A-2
[283.820580] Dynamic subtest pipe-C-HDMI-A-2: SKIP (0.002s)
[283.826764] Subtest compare-crc-sanitycheck-nv12: SKIP (0.010s)
[284.073720] [116/161] (783s left) kms_pipe_crc_basic (hang-read-crc)
[284.833703] Starting subtest: hang-read-crc
[284.836023] Starting dynamic subtest: pipe-C-HDMI-A-2
[286.447803] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (1.617s)
[286.452441] Subtest hang-read-crc: SUCCESS (1.627s)
[287.048750] [117/161] (780s left) kms_pipe_crc_basic (nonblocking-crc)
[287.745655] Starting subtest: nonblocking-crc
[287.759949] Starting dynamic subtest: pipe-C-HDMI-A-2
[288.462229] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.708s)
[288.465757] Subtest nonblocking-crc: SUCCESS (0.720s)
[289.089688] [118/161] (779s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence)
[289.851276] Starting subtest: nonblocking-crc-frame-sequence
[289.854969] Starting dynamic subtest: pipe-C-HDMI-A-2
[290.587943] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.733s)
[290.589705] Subtest nonblocking-crc-frame-sequence: SUCCESS (0.742s)
[291.322193] [119/161] (777s left) kms_pipe_crc_basic (read-crc)
[292.073537] Starting subtest: read-crc
[292.083650] Starting dynamic subtest: pipe-C-HDMI-A-2
[292.759846] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.672s)
[292.764696] Subtest read-crc: SUCCESS (0.689s)
[293.440315] [120/161] (775s left) kms_pipe_crc_basic (read-crc-frame-sequence)
[294.242986] Starting subtest: read-crc-frame-sequence
[294.244600] Starting dynamic subtest: pipe-C-HDMI-A-2
[294.907439] Dynamic subtest pipe-C-HDMI-A-2: SUCCESS (0.666s)
[294.920634] Subtest read-crc-frame-sequence: SUCCESS (0.681s)
[295.551710] [121/161] (773s left) kms_pm_backlight (basic-brightness)
[296.298489] Subtest basic-brightness: SKIP (0.000s)
[296.506151] [122/161] (772s left) kms_pm_rpm (basic-pci-d3-state)
[298.875233] Starting subtest: basic-pci-d3-state
[299.207520] Subtest basic-pci-d3-state: SUCCESS (0.335s)
[299.731658] [123/161] (769s left) kms_pm_rpm (basic-rte)
[299.981396] Starting subtest: basic-rte
[302.435739] Subtest basic-rte: SUCCESS (2.441s)
[303.546380] [124/161] (765s left) kms_psr (psr-primary-page-flip)
[304.347221] Subtest psr-primary-page-flip: SKIP (0.000s)
[304.582958] [125/161] (765s left) kms_psr (psr-cursor-plane-move)
[305.367853] Subtest psr-cursor-plane-move: SKIP (0.000s)
[305.601974] [126/161] (764s left) kms_psr (psr-sprite-plane-onoff)
[306.481730] Subtest psr-sprite-plane-onoff: SKIP (0.000s)
[306.718213] [127/161] (763s left) kms_psr (psr-primary-mmap-gtt)
[307.517722] Subtest psr-primary-mmap-gtt: SKIP (0.000s)
[307.747746] [128/161] (762s left) kms_setmode (basic-clone-single-crtc)
[308.017056] Starting subtest: basic-clone-single-crtc
[308.024178] Subtest basic-clone-single-crtc: SKIP (0.001s)
[308.279366] [129/161] (762s left) i915_pm_rps (basic-api)
[308.557636] Starting subtest: basic-api
[308.571662] Subtest basic-api: SUCCESS (0.015s)
[308.826947] [130/161] (761s left) prime_self_import (basic-llseek-bad)
[309.090410] Starting subtest: basic-llseek-bad
[309.097734] Subtest basic-llseek-bad: SUCCESS (0.009s)
[309.356712] [131/161] (761s left) prime_self_import (basic-llseek-size)
[309.610301] Starting subtest: basic-llseek-size
[309.623566] Subtest basic-llseek-size: SUCCESS (0.016s)
[309.906211] [132/161] (761s left) prime_self_import (basic-with_fd_dup)
[310.170236] Starting subtest: basic-with_fd_dup
[310.214123] Subtest basic-with_fd_dup: SUCCESS (0.044s)
[310.477313] [133/161] (760s left) prime_self_import (basic-with_one_bo)
[310.760112] Starting subtest: basic-with_one_bo
[310.774591] Subtest basic-with_one_bo: SUCCESS (0.027s)
[311.041154] [134/161] (760s left) prime_self_import (basic-with_one_bo_two_files)
[311.298297] Starting subtest: basic-with_one_bo_two_files
[311.302892] Subtest basic-with_one_bo_two_files: SUCCESS (0.012s)
[311.572823] [135/161] (760s left) prime_self_import (basic-with_two_bos)
[311.823651] Starting subtest: basic-with_two_bos
[311.837244] Subtest basic-with_two_bos: SUCCESS (0.014s)
[312.100119] [136/161] (759s left) prime_vgem (basic-fence-flip)
[312.396714] Starting subtest: basic-fence-flip
[313.143937] Subtest basic-fence-flip: SKIP (0.734s)
[313.415820] [137/161] (758s left) prime_vgem (basic-fence-mmap)
[313.730799] Starting subtest: basic-fence-mmap
[313.856057] Subtest basic-fence-mmap: SUCCESS (0.126s)
[314.124522] [138/161] (758s left) prime_vgem (basic-fence-read)
[314.419638] Starting subtest: basic-fence-read
[314.681193] Subtest basic-fence-read: SUCCESS (0.261s)
[314.950554] [139/161] (757s left) prime_vgem (basic-gtt)
[315.258862] Starting subtest: basic-gtt
[315.321779] Subtest basic-gtt: SUCCESS (0.048s)
[315.633674] [140/161] (757s left) prime_vgem (basic-read)
[315.941783] Starting subtest: basic-read
[316.060562] Subtest basic-read: SUCCESS (0.113s)
[316.326973] [141/161] (756s left) prime_vgem (basic-write)
[316.649518] Starting subtest: basic-write
[316.818850] Subtest basic-write: SUCCESS (0.164s)
[317.081895] [142/161] (756s left) vgem_basic (setversion)
[317.366100] Starting subtest: setversion
[317.370698] Subtest setversion: SUCCESS (0.000s)
[317.596518] [143/161] (755s left) vgem_basic (create)
[317.880158] Starting subtest: create
[317.881563] Subtest create: SUCCESS (0.001s)
[318.113517] [144/161] (755s left) vgem_basic (debugfs)
[318.398865] Starting subtest: debugfs
[318.401977] Subtest debugfs: SUCCESS (0.002s)
[318.635051] [145/161] (755s left) vgem_basic (dmabuf-export)
[318.904250] Starting subtest: dmabuf-export
[318.917293] Subtest dmabuf-export: SUCCESS (0.011s)
[319.167413] [146/161] (754s left) vgem_basic (dmabuf-fence)
[319.443531] Starting subtest: dmabuf-fence
[319.445437] Subtest dmabuf-fence: SUCCESS (0.004s)
[319.686084] [147/161] (754s left) vgem_basic (dmabuf-fence-before)
[319.957097] Starting subtest: dmabuf-fence-before
[319.959302] Subtest dmabuf-fence-before: SUCCESS (0.003s)
[320.190940] [148/161] (754s left) vgem_basic (dmabuf-mmap)
[320.479512] Starting subtest: dmabuf-mmap
[320.524252] Subtest dmabuf-mmap: SUCCESS (0.047s)
[320.761700] [149/161] (753s left) vgem_basic (mmap)
[321.057640] Starting subtest: mmap
[321.098297] Subtest mmap: SUCCESS (0.042s)
[321.358522] [150/161] (753s left) vgem_basic (second-client)
[321.636648] Starting subtest: second-client
[321.677412] Subtest second-client: SUCCESS (0.034s)
[321.963468] [151/161] (753s left) vgem_basic (sysfs)
[322.247340] Starting subtest: sysfs
[322.251154] Subtest sysfs: SUCCESS (0.002s)
[322.479316] [152/161] (752s left) core_hotunplug (unbind-rebind)
[322.962059] Starting subtest: unbind-rebind
[329.051548] Subtest unbind-rebind: SUCCESS (6.083s)
[329.308753] [153/161] (746s left) vgem_basic (unload)
[329.579697] Starting subtest: unload
[358.905097] Subtest unload: SUCCESS (29.320s)
[359.382997] [154/161] (716s left) i915_module_load (reload)
[359.646378] Starting subtest: reload
[367.012231] Subtest reload: SUCCESS (7.367s)
[367.422124] [155/161] (708s left) gem_lmem_swapping (basic)
[368.098680] Subtest basic: SKIP (0.000s)
[368.548147] [156/161] (707s left) gem_lmem_swapping (parallel-random-engines)
[368.967092] Subtest parallel-random-engines: SKIP (0.000s)
[369.193927] [157/161] (707s left) gem_lmem_swapping (random-engines)
[369.480194] Subtest random-engines: SKIP (0.000s)
[369.702254] [158/161] (707s left) gem_lmem_swapping (verify-random)
[369.987847] Subtest verify-random: SKIP (0.000s)
[370.199225] [159/161] (706s left) i915_pm_rpm (module-reload)
[373.005628] Starting subtest: module-reload
[391.544108] Subtest module-reload: SUCCESS (18.547s)
[391.685826] [FACT i915_pm_rpm (module-reload)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[391.691536] [FACT i915_pm_rpm (module-reload)] deleted: kernel.kmod_is_loaded.i915: true
[391.702888] [160/161] (685s left) i915_selftest (live)
[391.986977] Starting subtest: live
[391.990306] Starting dynamic subtest: sanitycheck
[396.544709] Dynamic subtest sanitycheck: SUCCESS (4.550s)
[396.599321] Starting dynamic subtest: uncore
[400.773829] Dynamic subtest uncore: SUCCESS (4.223s)
[400.808161] Starting dynamic subtest: workarounds
[405.301225] Dynamic subtest workarounds: SUCCESS (4.522s)
[405.331124] Starting dynamic subtest: gt_engines
[410.197398] Dynamic subtest gt_engines: SUCCESS (4.883s)
[410.228172] Starting dynamic subtest: gt_timelines
[441.744171] Dynamic subtest gt_timelines: SUCCESS (31.532s)
[441.794281] Starting dynamic subtest: gt_contexts
[446.039630] Dynamic subtest gt_contexts: SUCCESS (4.293s)
[446.093341] Starting dynamic subtest: gt_lrc
[453.815815] Dynamic subtest gt_lrc: SUCCESS (7.747s)
[453.858857] Starting dynamic subtest: gt_mocs
[458.231665] Dynamic subtest gt_mocs: SUCCESS (4.396s)
[458.258552] Starting dynamic subtest: gt_pm
[463.695419] Dynamic subtest gt_pm: SUCCESS (5.458s)
[463.723232] Starting dynamic subtest: gt_heartbeat
[468.012361] Dynamic subtest gt_heartbeat: SUCCESS (4.307s)
[468.063535] Starting dynamic subtest: gt_tlb
[472.974547] Dynamic subtest gt_tlb: SUCCESS (4.956s)
[473.024505] Starting dynamic subtest: requests
[483.709620] Dynamic subtest requests: SUCCESS (10.725s)
[483.764276] Starting dynamic subtest: migrate
[491.660121] Dynamic subtest migrate: SUCCESS (7.943s)
[491.694361] Starting dynamic subtest: active
[496.050252] Dynamic subtest active: SUCCESS (4.383s)
[496.086095] Starting dynamic subtest: objects
[501.937753] Dynamic subtest objects: SUCCESS (5.881s)
[501.963700] Starting dynamic subtest: mman
[513.516593] Dynamic subtest mman: SUCCESS (11.577s)
[513.555333] Starting dynamic subtest: dmabuf
[517.966488] Dynamic subtest dmabuf: SUCCESS (4.440s)
[517.992629] Starting dynamic subtest: vma
[522.309838] Dynamic subtest vma: SUCCESS (4.334s)
[522.363657] Starting dynamic subtest: coherency
[531.773363] Dynamic subtest coherency: SUCCESS (9.457s)
[531.798333] Starting dynamic subtest: gtt
[543.270390] Dynamic subtest gtt: SUCCESS (11.492s)
[543.321422] Starting dynamic subtest: gem
[548.781823] Dynamic subtest gem: SUCCESS (5.501s)
[548.817686] Starting dynamic subtest: evict
[559.934922] Dynamic subtest evict: SUCCESS (11.117s)
[560.028603] Starting dynamic subtest: hugepages
[564.771845] Dynamic subtest hugepages: SUCCESS (4.822s)
[564.802390] Starting dynamic subtest: gem_contexts
[594.309621] Dynamic subtest gem_contexts: SUCCESS (29.520s)
[594.335413] Starting dynamic subtest: client
[598.744190] Dynamic subtest client: SUCCESS (4.427s)
[598.795992] Starting dynamic subtest: gem_migrate
[603.179972] Dynamic subtest gem_migrate: SUCCESS (4.422s)
[603.213975] Starting dynamic subtest: reset
[615.474528] Dynamic subtest reset: SUCCESS (12.283s)
[615.509746] Starting dynamic subtest: memory_region
[619.901685] Dynamic subtest memory_region: SUCCESS (4.421s)
[619.942534] Starting dynamic subtest: hangcheck
[647.790437] Dynamic subtest hangcheck: SUCCESS (27.870s)
[647.824963] Starting dynamic subtest: execlists
[658.321830] Dynamic subtest execlists: SUCCESS (10.523s)
[658.347709] Starting dynamic subtest: ring_submission
[662.618096] Dynamic subtest ring_submission: SUCCESS (4.285s)
[662.680087] Starting dynamic subtest: perf
[667.540915] Dynamic subtest perf: SUCCESS (4.922s)
[667.574097] Starting dynamic subtest: slpc
[671.941772] Dynamic subtest slpc: SUCCESS (4.390s)
[671.975786] Starting dynamic subtest: guc
[676.340162] Dynamic subtest guc: SUCCESS (4.384s)
[676.390595] Starting dynamic subtest: guc_multi_lrc
[680.765137] Dynamic subtest guc_multi_lrc: SUCCESS (4.416s)
[680.797198] Starting dynamic subtest: guc_hang
[685.163262] Dynamic subtest guc_hang: SUCCESS (4.394s)
[685.190703] Starting dynamic subtest: late_gt_pm
[689.547325] Dynamic subtest late_gt_pm: SUCCESS (4.379s)
[689.549288] Subtest live: SUCCESS (297.558s)
[689.709838] [161/161] (387s left) dmabuf (all-tests)
[689.997410] Starting subtest: all-tests
[689.999983] Starting dynamic subtest: sanitycheck
[690.057127] Dynamic subtest sanitycheck: SUCCESS (0.054s)
[690.103096] Starting dynamic subtest: dma_fence
[690.432406] Dynamic subtest dma_fence: SUCCESS (0.368s)
[690.459105] Starting dynamic subtest: dma_fence_chain
[716.120103] Dynamic subtest dma_fence_chain: SUCCESS (25.681s)
[716.151063] Starting dynamic subtest: dma_fence_unwrap
[716.220596] Dynamic subtest dma_fence_unwrap: SUCCESS (0.093s)
[716.258188] Starting dynamic subtest: dma_resv
[716.338952] Dynamic subtest dma_resv: SUCCESS (0.106s)
[716.345320] Subtest all-tests: SUCCESS (26.347s)
[716.483381] Closing watchdogs
Done.