[31.281796] Initializing watchdogs
[31.281840]   /dev/watchdog0
[31.286677] [001/165] (960s left) i915_module_load (load)
[31.315466] Starting subtest: load
[33.222485] Subtest load: SUCCESS (1.907s)
[33.240149] [002/165] (958s left) core_auth (basic-auth)
[33.288566] Starting subtest: basic-auth
[33.289289] Subtest basic-auth: SUCCESS (0.000s)
[33.377273] [003/165] (958s left) debugfs_test (read_all_entries)
[33.411802] Starting subtest: read_all_entries
[33.540241] Subtest read_all_entries: SUCCESS (0.128s)
[33.791632] [004/165] (958s left) debugfs_test (basic-hwmon)
[33.830442] Starting subtest: basic-hwmon
[33.831915] Subtest basic-hwmon: SKIP (0.000s)
[34.074320] [005/165] (957s left) fbdev (eof)
[34.106178] Starting subtest: eof
[34.106887] Subtest eof: SUCCESS (0.000s)
[34.155908] [006/165] (957s left) fbdev (info)
[34.181251] Starting subtest: info
[34.182057] Subtest info: SUCCESS (0.000s)
[34.238163] [007/165] (957s left) fbdev (nullptr)
[34.272775] Starting subtest: nullptr
[34.273622] Subtest nullptr: SUCCESS (0.000s)
[34.323333] [008/165] (957s left) fbdev (read)
[34.355970] Starting subtest: read
[36.869174] Subtest read: SUCCESS (2.504s)
[36.906394] [009/165] (954s left) fbdev (write)
[36.939378] Starting subtest: write
[38.812980] Subtest write: SUCCESS (1.864s)
[38.855045] [010/165] (953s left) gem_basic (bad-close)
[38.881601] Starting subtest: bad-close
[38.883775] Subtest bad-close: SUCCESS (0.000s)
[38.943746] [011/165] (952s left) gem_basic (create-close)
[38.971681] Starting subtest: create-close
[38.973049] Subtest create-close: SUCCESS (0.000s)
[39.062419] [012/165] (952s left) gem_basic (create-fd-close)
[39.087980] Starting subtest: create-fd-close
[39.090115] Subtest create-fd-close: SUCCESS (0.000s)
[39.177082] [013/165] (952s left) gem_busy (busy@all-engines)
[39.209792] Starting subtest: busy
[39.210565] Starting dynamic subtest: all-engines
[39.230665] Dynamic subtest all-engines: SUCCESS (0.021s)
[39.231457] Subtest busy: SUCCESS (0.021s)
[39.560568] [014/165] (952s left) gem_close_race (basic-process)
[39.594902] Starting subtest: basic-process
[39.633689] Subtest basic-process: SUCCESS (0.038s)
[39.810425] [015/165] (952s left) gem_close_race (basic-threads)
[39.843694] Starting subtest: basic-threads
[41.079171] Subtest basic-threads: SUCCESS (1.235s)
[41.244014] [016/165] (950s left) gem_ctx_create (basic)
[41.276612] Starting subtest: basic
[41.277556] Subtest basic: SUCCESS (0.000s)
[41.461798] [017/165] (950s left) gem_ctx_create (basic-files)
[41.494081] Starting subtest: basic-files
[43.502236] Subtest basic-files: SUCCESS (2.008s)
[43.671947] [018/165] (948s left) gem_ctx_exec (basic)
[43.700935] Starting subtest: basic
[43.702853] Subtest basic: SUCCESS (0.002s)
[43.795165] [019/165] (948s left) gem_exec_basic (basic)
[43.826390] Starting subtest: basic
[43.827318] Starting dynamic subtest: rcs0-smem
[43.828074] Dynamic subtest rcs0-smem: SUCCESS (0.001s)
[43.831290] Starting dynamic subtest: bcs0-smem
[43.831963] Dynamic subtest bcs0-smem: SUCCESS (0.000s)
[43.835176] Starting dynamic subtest: vcs0-smem
[43.835848] Dynamic subtest vcs0-smem: SUCCESS (0.000s)
[43.838941] Starting dynamic subtest: vcs1-smem
[43.839668] Dynamic subtest vcs1-smem: SUCCESS (0.000s)
[43.842807] Starting dynamic subtest: vecs0-smem
[43.843543] Dynamic subtest vecs0-smem: SUCCESS (0.000s)
[43.844216] Subtest basic: SUCCESS (0.002s)
[43.995999] [020/165] (947s left) gem_exec_create (basic)
[44.027789] Starting subtest: basic
[44.028718] Starting dynamic subtest: smem
[46.118262] Dynamic subtest smem: SUCCESS (2.090s)
[46.119354] Subtest basic: SUCCESS (2.090s)
[46.280667] [021/165] (945s left) gem_exec_fence (basic-busy)
[46.438228] Starting subtest: basic-busy
[46.439343] Starting dynamic subtest: rcs0
[46.475387] Dynamic subtest rcs0: SUCCESS (0.045s)
[46.484083] Starting dynamic subtest: bcs0
[46.527094] Dynamic subtest bcs0: SUCCESS (0.052s)
[46.540779] Starting dynamic subtest: vcs0
[46.576249] Dynamic subtest vcs0: SUCCESS (0.049s)
[46.580552] Starting dynamic subtest: vcs1
[46.628046] Dynamic subtest vcs1: SUCCESS (0.051s)
[46.640927] Starting dynamic subtest: vecs0
[46.676092] Dynamic subtest vecs0: SUCCESS (0.048s)
[46.677823] Subtest basic-busy: SUCCESS (0.247s)
[47.178966] [022/165] (944s left) gem_exec_fence (basic-wait)
[47.339106] Starting subtest: basic-wait
[47.340270] Starting dynamic subtest: rcs0
[47.402632] Dynamic subtest rcs0: SUCCESS (0.072s)
[47.411814] Starting dynamic subtest: bcs0
[47.451164] Dynamic subtest bcs0: SUCCESS (0.048s)
[47.462815] Starting dynamic subtest: vcs0
[47.503403] Dynamic subtest vcs0: SUCCESS (0.052s)
[47.515854] Starting dynamic subtest: vcs1
[47.552079] Dynamic subtest vcs1: SUCCESS (0.048s)
[47.560832] Starting dynamic subtest: vecs0
[47.603984] Dynamic subtest vecs0: SUCCESS (0.052s)
[47.606109] Subtest basic-wait: SUCCESS (0.274s)
[48.078346] [023/165] (943s left) gem_exec_fence (basic-await)
[48.238054] Starting subtest: basic-await
[48.238943] Starting dynamic subtest: rcs0
[48.303537] Dynamic subtest rcs0: SUCCESS (0.072s)
[48.308735] Starting dynamic subtest: bcs0
[48.371651] Dynamic subtest bcs0: SUCCESS (0.070s)
[48.379219] Starting dynamic subtest: vcs0
[48.443607] Dynamic subtest vcs0: SUCCESS (0.071s)
[48.452443] Starting dynamic subtest: vcs1
[48.515730] Dynamic subtest vcs1: SUCCESS (0.073s)
[48.525109] Starting dynamic subtest: vecs0
[48.588743] Dynamic subtest vecs0: SUCCESS (0.073s)
[48.590718] Subtest basic-await: SUCCESS (0.360s)
[49.065614] [024/165] (942s left) gem_exec_fence (nb-await)
[49.226072] Starting subtest: nb-await
[49.226972] Starting dynamic subtest: rcs0
[49.274231] Dynamic subtest rcs0: SUCCESS (0.057s)
[49.281186] Starting dynamic subtest: bcs0
[49.332293] Dynamic subtest bcs0: SUCCESS (0.058s)
[49.339964] Starting dynamic subtest: vcs0
[49.390568] Dynamic subtest vcs0: SUCCESS (0.058s)
[49.396974] Starting dynamic subtest: vcs1
[49.448674] Dynamic subtest vcs1: SUCCESS (0.058s)
[49.460933] Starting dynamic subtest: vecs0
[49.509435] Dynamic subtest vecs0: SUCCESS (0.061s)
[49.510615] Subtest nb-await: SUCCESS (0.293s)
[49.980722] [025/165] (942s left) gem_exec_gttfill (basic)
[50.014577] Starting subtest: basic
[52.114896] Subtest basic: SUCCESS (2.100s)
[52.274573] [026/165] (939s left) gem_exec_parallel (engines)
[52.338305] Starting subtest: engines
[52.339117] Starting dynamic subtest: basic
[53.633757] Dynamic subtest basic: SUCCESS (1.295s)
[53.642133] Starting dynamic subtest: contexts
[55.294091] Dynamic subtest contexts: SUCCESS (1.651s)
[55.298181] Starting dynamic subtest: fds
[57.155466] Dynamic subtest fds: SUCCESS (1.871s)
[57.159909] Starting dynamic subtest: userptr
[58.431702] Dynamic subtest userptr: SUCCESS (1.276s)
[58.433338] Subtest engines: SUCCESS (6.093s)
[58.616358] [027/165] (933s left) gem_exec_store (basic)
[58.651619] Starting subtest: basic
[58.733872] Subtest basic: SUCCESS (0.082s)
[58.912953] [028/165] (933s left) gem_flink_basic (bad-flink)
[58.940982] Starting subtest: bad-flink
[58.941855] Subtest bad-flink: SUCCESS (0.000s)
[59.010314] [029/165] (933s left) gem_flink_basic (bad-open)
[59.044904] Starting subtest: bad-open
[59.045622] Subtest bad-open: SUCCESS (0.000s)
[59.107208] [030/165] (932s left) gem_flink_basic (basic)
[59.131898] Starting subtest: basic
[59.132661] Subtest basic: SUCCESS (0.000s)
[59.209260] [031/165] (932s left) gem_flink_basic (double-flink)
[59.234964] Starting subtest: double-flink
[59.235814] Subtest double-flink: SUCCESS (0.000s)
[59.312013] [032/165] (932s left) gem_flink_basic (flink-lifetime)
[59.338918] Starting subtest: flink-lifetime
[59.339942] Subtest flink-lifetime: SUCCESS (0.001s)
[59.430325] [033/165] (932s left) gem_huc_copy (huc-copy)
[59.460869] Starting subtest: huc-copy
[59.462515] Subtest huc-copy: SUCCESS (0.002s)
[59.565751] [034/165] (932s left) gem_linear_blits (basic)
[59.661025] Starting subtest: basic
[59.664502] Subtest basic: SUCCESS (0.004s)
[59.773205] [035/165] (932s left) gem_mmap (basic)
[59.835774] Starting subtest: basic
[59.839261] Subtest basic: SUCCESS (0.000s)
[59.909981] [036/165] (932s left) gem_mmap_gtt (basic)
[59.938932] Starting subtest: basic
[59.939851] Subtest basic: SUCCESS (0.000s)
[59.979409] [037/165] (932s left) gem_render_linear_blits (basic)
[60.009240] Starting subtest: basic
[60.022223] Subtest basic: SUCCESS (0.013s)
[60.082932] [038/165] (932s left) gem_render_tiled_blits (basic)
[60.120586] Starting subtest: basic
[60.139286] Subtest basic: SUCCESS (0.019s)
[60.196546] [039/165] (931s left) gem_ringfill (basic-all)
[60.506780] Starting subtest: basic-all
[61.638065] Subtest basic-all: SUCCESS (1.123s)
[61.730109] [040/165] (930s left) gem_softpin (allocator-basic)
[61.757935] Starting subtest: allocator-basic
[61.803175] Subtest allocator-basic: SUCCESS (0.045s)
[61.893410] [041/165] (930s left) gem_softpin (allocator-basic-reserve)
[61.920297] Starting subtest: allocator-basic-reserve
[61.965423] Subtest allocator-basic-reserve: SUCCESS (0.045s)
[62.065807] [042/165] (930s left) gem_softpin (safe-alignment)
[62.100085] Starting subtest: safe-alignment
[62.105860] Subtest safe-alignment: SUCCESS (0.006s)
[62.212263] [043/165] (930s left) gem_sync (basic-all)
[62.250160] Starting subtest: basic-all
[64.663260] Subtest basic-all: SUCCESS (2.412s)
[64.831243] [044/165] (927s left) gem_sync (basic-each)
[64.867485] Starting subtest: basic-each
[67.051801] Subtest basic-each: SUCCESS (2.184s)
[67.231843] [045/165] (925s left) gem_tiled_blits (basic)
[67.320548] Starting subtest: basic
[67.329756] Subtest basic: SUCCESS (0.009s)
[67.443750] [046/165] (924s left) gem_tiled_fence_blits (basic)
[67.565321] Starting subtest: basic
[67.585185] Subtest basic: SUCCESS (0.020s)
[67.688381] [047/165] (924s left) gem_tiled_pread_basic
[67.801950] [048/165] (924s left) gem_wait (busy@all-engines)
[67.836070] Starting subtest: busy
[67.836985] Starting dynamic subtest: all-engines
[68.385380] Dynamic subtest all-engines: SUCCESS (0.548s)
[68.386905] Subtest busy: SUCCESS (0.549s)
[68.579915] [049/165] (923s left) gem_wait (wait@all-engines)
[68.613263] Starting subtest: wait
[68.613934] Starting dynamic subtest: all-engines
[69.661703] Dynamic subtest all-engines: SUCCESS (1.048s)
[69.663498] Subtest wait: SUCCESS (1.048s)
[69.862654] [050/165] (922s left) i915_getparams_basic (basic-eu-total)
[69.891865] Starting subtest: basic-eu-total
[69.893492] Subtest basic-eu-total: SUCCESS (0.000s)
[69.943269] [051/165] (922s left) i915_getparams_basic (basic-subslice-total)
[69.969624] Starting subtest: basic-subslice-total
[69.971069] Subtest basic-subslice-total: SUCCESS (0.000s)
[70.030516] [052/165] (922s left) i915_hangman (error-state-basic)
[70.062936] Starting subtest: error-state-basic
[70.152936] Subtest error-state-basic: SUCCESS (0.089s)
[70.211278] [053/165] (922s left) i915_pciid
[70.291826] [054/165] (922s left) kms_addfb_basic (addfb25-4-tiled)
[70.513636] Starting subtest: addfb25-4-tiled
[70.514708] Subtest addfb25-4-tiled: SUCCESS (0.000s)
[70.578694] [055/165] (921s left) kms_addfb_basic (addfb25-bad-modifier)
[70.607547] Starting subtest: addfb25-bad-modifier
[70.608447] Subtest addfb25-bad-modifier: SUCCESS (0.000s)
[70.880149] [056/165] (921s left) kms_addfb_basic (addfb25-framebuffer-vs-set-tiling)
[70.909146] Starting subtest: addfb25-framebuffer-vs-set-tiling
[70.909992] Subtest addfb25-framebuffer-vs-set-tiling: SUCCESS (0.000s)
[71.179865] [057/165] (921s left) kms_addfb_basic (addfb25-modifier-no-flag)
[71.209943] Starting subtest: addfb25-modifier-no-flag
[71.210724] Subtest addfb25-modifier-no-flag: SUCCESS (0.000s)
[71.478934] [058/165] (920s left) kms_addfb_basic (addfb25-x-tiled-legacy)
[71.506735] Starting subtest: addfb25-x-tiled-legacy
[71.507767] Subtest addfb25-x-tiled-legacy: SUCCESS (0.000s)
[71.780243] [059/165] (920s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy)
[71.809227] Starting subtest: addfb25-x-tiled-mismatch-legacy
[71.810052] Subtest addfb25-x-tiled-mismatch-legacy: SUCCESS (0.000s)
[72.079928] [060/165] (920s left) kms_addfb_basic (addfb25-yf-tiled-legacy)
[72.294629] Starting subtest: addfb25-yf-tiled-legacy
[72.296156] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.000s)
[72.381526] [061/165] (920s left) kms_addfb_basic (addfb25-y-tiled-legacy)
[72.596886] Starting subtest: addfb25-y-tiled-legacy
[72.597720] Subtest addfb25-y-tiled-legacy: SUCCESS (0.000s)
[72.684833] [062/165] (919s left) kms_addfb_basic (addfb25-y-tiled-small-legacy)
[72.903908] Starting subtest: addfb25-y-tiled-small-legacy
[72.905305] Subtest addfb25-y-tiled-small-legacy: SUCCESS (0.000s)
[72.977881] [063/165] (919s left) kms_addfb_basic (bad-pitch-0)
[73.006476] Starting subtest: bad-pitch-0
[73.007142] Subtest bad-pitch-0: SUCCESS (0.000s)
[73.282127] [064/165] (919s left) kms_addfb_basic (bad-pitch-1024)
[73.310413] Starting subtest: bad-pitch-1024
[73.311349] Subtest bad-pitch-1024: SUCCESS (0.000s)
[73.582691] [065/165] (918s left) kms_addfb_basic (bad-pitch-128)
[73.612091] Starting subtest: bad-pitch-128
[73.612779] Subtest bad-pitch-128: SUCCESS (0.000s)
[73.881166] [066/165] (918s left) kms_addfb_basic (bad-pitch-256)
[73.908919] Starting subtest: bad-pitch-256
[73.909688] Subtest bad-pitch-256: SUCCESS (0.000s)
[74.183792] [067/165] (918s left) kms_addfb_basic (bad-pitch-32)
[74.214164] Starting subtest: bad-pitch-32
[74.214846] Subtest bad-pitch-32: SUCCESS (0.000s)
[74.480240] [068/165] (918s left) kms_addfb_basic (bad-pitch-63)
[74.507920] Starting subtest: bad-pitch-63
[74.508593] Subtest bad-pitch-63: SUCCESS (0.000s)
[74.782641] [069/165] (917s left) kms_addfb_basic (bad-pitch-65536)
[74.814279] Starting subtest: bad-pitch-65536
[74.815052] Subtest bad-pitch-65536: SUCCESS (0.000s)
[75.081206] [070/165] (917s left) kms_addfb_basic (bad-pitch-999)
[75.110695] Starting subtest: bad-pitch-999
[75.112613] Subtest bad-pitch-999: SUCCESS (0.000s)
[75.381112] [071/165] (917s left) kms_addfb_basic (basic)
[75.408528] Starting subtest: basic
[75.409304] Subtest basic: SUCCESS (0.000s)
[75.699274] [072/165] (916s left) kms_addfb_basic (basic-x-tiled-legacy)
[75.728829] Starting subtest: basic-x-tiled-legacy
[75.729585] Subtest basic-x-tiled-legacy: SUCCESS (0.000s)
[75.997066] [073/165] (916s left) kms_addfb_basic (basic-y-tiled-legacy)
[76.024690] Starting subtest: basic-y-tiled-legacy
[76.025359] Subtest basic-y-tiled-legacy: SUCCESS (0.000s)
[76.298109] [074/165] (916s left) kms_addfb_basic (bo-too-small)
[76.514328] Starting subtest: bo-too-small
[76.515356] Subtest bo-too-small: SUCCESS (0.000s)
[76.598201] [075/165] (915s left) kms_addfb_basic (bo-too-small-due-to-tiling)
[76.816723] Starting subtest: bo-too-small-due-to-tiling
[76.817387] Subtest bo-too-small-due-to-tiling: SUCCESS (0.000s)
[76.897796] [076/165] (915s left) kms_addfb_basic (clobberred-modifier)
[76.925077] Starting subtest: clobberred-modifier
[76.925773] Subtest clobberred-modifier: SUCCESS (0.000s)
[77.199663] [077/165] (915s left) kms_addfb_basic (framebuffer-vs-set-tiling)
[77.228331] Starting subtest: framebuffer-vs-set-tiling
[77.229109] Subtest framebuffer-vs-set-tiling: SUCCESS (0.000s)
[77.516597] [078/165] (915s left) kms_addfb_basic (invalid-get-prop)
[77.546577] Starting subtest: invalid-get-prop
[77.547276] Subtest invalid-get-prop: SUCCESS (0.000s)
[77.816127] [079/165] (914s left) kms_addfb_basic (invalid-get-prop-any)
[77.845855] Starting subtest: invalid-get-prop-any
[77.846630] Subtest invalid-get-prop-any: SUCCESS (0.000s)
[78.115472] [080/165] (914s left) kms_addfb_basic (invalid-set-prop)
[78.151554] Starting subtest: invalid-set-prop
[78.152357] Subtest invalid-set-prop: SUCCESS (0.000s)
[78.433211] [081/165] (914s left) kms_addfb_basic (invalid-set-prop-any)
[78.466210] Starting subtest: invalid-set-prop-any
[78.466959] Subtest invalid-set-prop-any: SUCCESS (0.000s)
[78.736500] [082/165] (913s left) kms_addfb_basic (no-handle)
[78.765977] Starting subtest: no-handle
[78.766778] Subtest no-handle: SUCCESS (0.000s)
[79.033813] [083/165] (913s left) kms_addfb_basic (size-max)
[79.249536] Starting subtest: size-max
[79.250528] Subtest size-max: SUCCESS (0.000s)
[79.314577] [084/165] (913s left) kms_addfb_basic (small-bo)
[79.536071] Starting subtest: small-bo
[79.537044] Subtest small-bo: SUCCESS (0.000s)
[79.615799] [085/165] (913s left) kms_addfb_basic (tile-pitch-mismatch)
[79.644766] Starting subtest: tile-pitch-mismatch
[79.645665] Subtest tile-pitch-mismatch: SUCCESS (0.000s)
[79.916224] [086/165] (912s left) kms_addfb_basic (too-high)
[80.131503] Starting subtest: too-high
[80.132833] Subtest too-high: SUCCESS (0.000s)
[80.217531] [087/165] (912s left) kms_addfb_basic (too-wide)
[80.434501] Starting subtest: too-wide
[80.435470] Subtest too-wide: SUCCESS (0.000s)
[80.515345] [088/165] (912s left) kms_addfb_basic (unused-handle)
[80.543030] Starting subtest: unused-handle
[80.543688] Subtest unused-handle: SUCCESS (0.000s)
[80.816312] [089/165] (911s left) kms_addfb_basic (unused-modifier)
[80.849111] Starting subtest: unused-modifier
[80.849871] Subtest unused-modifier: SUCCESS (0.000s)
[81.131838] [090/165] (911s left) kms_addfb_basic (unused-offsets)
[81.158873] Starting subtest: unused-offsets
[81.159738] Subtest unused-offsets: SUCCESS (0.000s)
[81.414405] [091/165] (911s left) kms_addfb_basic (unused-pitches)
[81.444802] Starting subtest: unused-pitches
[81.445630] Subtest unused-pitches: SUCCESS (0.000s)
[81.716319] [092/165] (911s left) kms_busy (basic)
[81.929665] Starting subtest: basic
[81.930727] Starting dynamic subtest: flip
[82.489079] Dynamic subtest flip: SUCCESS (0.559s)
[82.494050] Starting dynamic subtest: modeset
[83.269504] Dynamic subtest modeset: SUCCESS (0.781s)
[83.270264] Subtest basic: SUCCESS (1.341s)
[83.453562] [093/165] (909s left) kms_prop_blob (basic)
[83.483438] Starting subtest: basic
[83.484195] Subtest basic: SUCCESS (0.000s)
[83.551193] [094/165] (909s left) kms_cursor_legacy (basic-busy-flip-before-cursor-atomic)
[83.766899] Starting subtest: basic-busy-flip-before-cursor-atomic
[83.769225] Subtest basic-busy-flip-before-cursor-atomic: SKIP (0.000s)
[83.836211] [095/165] (908s left) kms_cursor_legacy (basic-busy-flip-before-cursor-legacy)
[84.050319] Starting subtest: basic-busy-flip-before-cursor-legacy
[84.052263] Subtest basic-busy-flip-before-cursor-legacy: SKIP (0.000s)
[84.119615] [096/165] (908s left) kms_cursor_legacy (basic-flip-after-cursor-atomic)
[84.337302] Starting subtest: basic-flip-after-cursor-atomic
[85.322984] Subtest basic-flip-after-cursor-atomic: SUCCESS (0.986s)
[85.494199] [097/165] (907s left) kms_cursor_legacy (basic-flip-after-cursor-legacy)
[85.709192] Starting subtest: basic-flip-after-cursor-legacy
[86.698525] Subtest basic-flip-after-cursor-legacy: SUCCESS (0.989s)
[86.867863] [098/165] (905s left) kms_cursor_legacy (basic-flip-after-cursor-varying-size)
[87.087178] Starting subtest: basic-flip-after-cursor-varying-size
[88.056236] Subtest basic-flip-after-cursor-varying-size: SUCCESS (0.970s)
[88.219216] [099/165] (904s left) kms_cursor_legacy (basic-flip-before-cursor-atomic)
[88.434462] Starting subtest: basic-flip-before-cursor-atomic
[89.406445] Subtest basic-flip-before-cursor-atomic: SUCCESS (0.973s)
[89.575295] [100/165] (903s left) kms_cursor_legacy (basic-flip-before-cursor-legacy)
[89.793146] Starting subtest: basic-flip-before-cursor-legacy
[90.776224] Subtest basic-flip-before-cursor-legacy: SUCCESS (0.984s)
[90.954114] [101/165] (901s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size)
[91.167969] Starting subtest: basic-flip-before-cursor-varying-size
[92.160130] Subtest basic-flip-before-cursor-varying-size: SUCCESS (0.993s)
[92.323432] [102/165] (900s left) kms_dsc (dsc-basic)
[92.543224] Starting subtest: dsc-basic
[92.544663] Subtest dsc-basic: SKIP (0.000s)
[92.605120] [103/165] (900s left) kms_flip (basic-flip-vs-dpms)
[92.755065] Starting subtest: basic-flip-vs-dpms
[92.756900] Starting dynamic subtest: A-DP1
[93.659399] Dynamic subtest A-DP1: SUCCESS (0.902s)
[93.665763] Starting dynamic subtest: B-DP1
[94.400069] Dynamic subtest B-DP1: SUCCESS (0.741s)
[94.404828] Starting dynamic subtest: C-DP1
[95.139064] Dynamic subtest C-DP1: SUCCESS (0.738s)
[95.143673] Starting dynamic subtest: D-DP1
[95.878911] Dynamic subtest D-DP1: SUCCESS (0.739s)
[95.880808] Subtest basic-flip-vs-dpms: SUCCESS (3.126s)
[96.058184] [104/165] (896s left) kms_flip (basic-flip-vs-modeset)
[96.200461] Starting subtest: basic-flip-vs-modeset
[96.202167] Starting dynamic subtest: A-DP1
[97.107276] Dynamic subtest A-DP1: SUCCESS (0.905s)
[97.111852] Starting dynamic subtest: B-DP1
[97.847932] Dynamic subtest B-DP1: SUCCESS (0.740s)
[97.852964] Starting dynamic subtest: C-DP1
[98.586356] Dynamic subtest C-DP1: SUCCESS (0.738s)
[98.591898] Starting dynamic subtest: D-DP1
[99.323789] Dynamic subtest D-DP1: SUCCESS (0.737s)
[99.326728] Subtest basic-flip-vs-modeset: SUCCESS (3.127s)
[99.484123] [105/165] (893s left) kms_flip (basic-flip-vs-wf_vblank)
[99.625516] Starting subtest: basic-flip-vs-wf_vblank
[99.626297] Starting dynamic subtest: A-DP1
[100.699153] Dynamic subtest A-DP1: SUCCESS (1.072s)
[100.712041] Starting dynamic subtest: B-DP1
[101.709685] Dynamic subtest B-DP1: SUCCESS (1.008s)
[101.719847] Starting dynamic subtest: C-DP1
[102.721412] Dynamic subtest C-DP1: SUCCESS (1.010s)
[102.730181] Starting dynamic subtest: D-DP1
[103.738057] Dynamic subtest D-DP1: SUCCESS (1.013s)
[103.742252] Subtest basic-flip-vs-wf_vblank: SUCCESS (4.118s)
[103.957186] [106/165] (888s left) kms_flip (basic-plain-flip)
[104.098022] Starting subtest: basic-plain-flip
[104.100246] Starting dynamic subtest: A-DP1
[104.882321] Dynamic subtest A-DP1: SUCCESS (0.781s)
[104.894201] Starting dynamic subtest: B-DP1
[105.615428] Dynamic subtest B-DP1: SUCCESS (0.728s)
[105.621219] Starting dynamic subtest: C-DP1
[106.341175] Dynamic subtest C-DP1: SUCCESS (0.725s)
[106.348212] Starting dynamic subtest: D-DP1
[107.076214] Dynamic subtest D-DP1: SUCCESS (0.731s)
[107.079282] Subtest basic-plain-flip: SUCCESS (2.982s)
[107.298902] [107/165] (885s left) kms_force_connector_basic (force-connector-state)
[107.541502] Starting subtest: force-connector-state
[108.234153] Subtest force-connector-state: SUCCESS (0.694s)
[108.891102] [108/165] (884s left) kms_force_connector_basic (force-edid)
[109.121637] Starting subtest: force-edid
[109.530632] Subtest force-edid: SUCCESS (0.409s)
[110.028907] [109/165] (882s left) kms_force_connector_basic (force-load-detect)
[110.263580] Starting subtest: force-load-detect
[110.265484] Subtest force-load-detect: SKIP (0.000s)
[110.644457] [110/165] (882s left) kms_force_connector_basic (prune-stale-modes)
[110.883130] Starting subtest: prune-stale-modes
[111.347982] Subtest prune-stale-modes: SUCCESS (0.465s)
[111.846221] [111/165] (881s left) kms_frontbuffer_tracking (basic)
[112.066391] Starting subtest: basic
[115.556274] Subtest basic: SUCCESS (3.492s)
[115.663170] [112/165] (877s left) kms_hdmi_inject (inject-audio)
[115.781546] Starting subtest: inject-audio
[116.315772] Subtest inject-audio: SUCCESS (0.534s)
[116.709752] [113/165] (876s left) kms_pipe_crc_basic (compare-crc-sanitycheck-xr24)
[116.922152] Starting subtest: compare-crc-sanitycheck-xr24
[116.923059] Starting dynamic subtest: pipe-A-DP-1
[117.333089] Dynamic subtest pipe-A-DP-1: SUCCESS (0.409s)
[117.338279] Starting dynamic subtest: pipe-B-DP-1
[117.728340] Dynamic subtest pipe-B-DP-1: SUCCESS (0.394s)
[117.733522] Starting dynamic subtest: pipe-C-DP-1
[118.131103] Dynamic subtest pipe-C-DP-1: SUCCESS (0.402s)
[118.136884] Starting dynamic subtest: pipe-D-DP-1
[118.534891] Dynamic subtest pipe-D-DP-1: SUCCESS (0.402s)
[118.535648] Subtest compare-crc-sanitycheck-xr24: SUCCESS (1.612s)
[118.693654] [114/165] (874s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12)
[118.912576] Starting subtest: compare-crc-sanitycheck-nv12
[118.913581] Starting dynamic subtest: pipe-A-DP-1
[119.495045] Dynamic subtest pipe-A-DP-1: SUCCESS (0.582s)
[119.502095] Starting dynamic subtest: pipe-B-DP-1
[120.054092] Dynamic subtest pipe-B-DP-1: SUCCESS (0.557s)
[120.058835] Starting dynamic subtest: pipe-C-DP-1
[120.606169] Dynamic subtest pipe-C-DP-1: SUCCESS (0.551s)
[120.612122] Starting dynamic subtest: pipe-D-DP-1
[121.163646] Dynamic subtest pipe-D-DP-1: SUCCESS (0.557s)
[121.164304] Subtest compare-crc-sanitycheck-nv12: SUCCESS (2.252s)
[121.327486] [115/165] (871s left) kms_pipe_crc_basic (hang-read-crc)
[121.543042] Starting subtest: hang-read-crc
[121.544071] Starting dynamic subtest: pipe-A-DP-1
[122.695171] Dynamic subtest pipe-A-DP-1: SUCCESS (1.151s)
[122.700175] Starting dynamic subtest: pipe-B-DP-1
[123.807095] Dynamic subtest pipe-B-DP-1: SUCCESS (1.110s)
[123.811941] Starting dynamic subtest: pipe-C-DP-1
[124.917664] Dynamic subtest pipe-C-DP-1: SUCCESS (1.110s)
[124.923994] Starting dynamic subtest: pipe-D-DP-1
[126.003724] Dynamic subtest pipe-D-DP-1: SUCCESS (1.084s)
[126.004735] Subtest hang-read-crc: SUCCESS (4.460s)
[126.147838] [116/165] (866s left) kms_pipe_crc_basic (nonblocking-crc)
[126.364960] Starting subtest: nonblocking-crc
[126.365949] Starting dynamic subtest: pipe-A-DP-1
[126.950086] Dynamic subtest pipe-A-DP-1: SUCCESS (0.585s)
[126.956151] Starting dynamic subtest: pipe-B-DP-1
[127.510179] Dynamic subtest pipe-B-DP-1: SUCCESS (0.559s)
[127.516396] Starting dynamic subtest: pipe-C-DP-1
[128.090528] Dynamic subtest pipe-C-DP-1: SUCCESS (0.579s)
[128.096058] Starting dynamic subtest: pipe-D-DP-1
[128.667754] Dynamic subtest pipe-D-DP-1: SUCCESS (0.575s)
[128.668589] Subtest nonblocking-crc: SUCCESS (2.304s)
[128.811902] [117/165] (864s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence)
[129.026286] Starting subtest: nonblocking-crc-frame-sequence
[129.027073] Starting dynamic subtest: pipe-A-DP-1
[129.648662] Dynamic subtest pipe-A-DP-1: SUCCESS (0.621s)
[129.654893] Starting dynamic subtest: pipe-B-DP-1
[130.222963] Dynamic subtest pipe-B-DP-1: SUCCESS (0.573s)
[130.228556] Starting dynamic subtest: pipe-C-DP-1
[130.801307] Dynamic subtest pipe-C-DP-1: SUCCESS (0.576s)
[130.806317] Starting dynamic subtest: pipe-D-DP-1
[131.382102] Dynamic subtest pipe-D-DP-1: SUCCESS (0.580s)
[131.382904] Subtest nonblocking-crc-frame-sequence: SUCCESS (2.355s)
[131.525162] [118/165] (861s left) kms_pipe_crc_basic (read-crc)
[131.749045] Starting subtest: read-crc
[131.749848] Starting dynamic subtest: pipe-A-DP-1
[132.297912] Dynamic subtest pipe-A-DP-1: SUCCESS (0.549s)
[132.303901] Starting dynamic subtest: pipe-B-DP-1
[132.806647] Dynamic subtest pipe-B-DP-1: SUCCESS (0.507s)
[132.811537] Starting dynamic subtest: pipe-C-DP-1
[133.317018] Dynamic subtest pipe-C-DP-1: SUCCESS (0.509s)
[133.321990] Starting dynamic subtest: pipe-D-DP-1
[133.812026] Dynamic subtest pipe-D-DP-1: SUCCESS (0.494s)
[133.812770] Subtest read-crc: SUCCESS (2.063s)
[133.954167] [119/165] (859s left) kms_pipe_crc_basic (read-crc-frame-sequence)
[134.179864] Starting subtest: read-crc-frame-sequence
[134.180987] Starting dynamic subtest: pipe-A-DP-1
[134.730684] Dynamic subtest pipe-A-DP-1: SUCCESS (0.550s)
[134.735517] Starting dynamic subtest: pipe-B-DP-1
[135.239966] Dynamic subtest pipe-B-DP-1: SUCCESS (0.509s)
[135.245035] Starting dynamic subtest: pipe-C-DP-1
[135.733556] Dynamic subtest pipe-C-DP-1: SUCCESS (0.493s)
[135.739329] Starting dynamic subtest: pipe-D-DP-1
[136.246311] Dynamic subtest pipe-D-DP-1: SUCCESS (0.510s)
[136.247156] Subtest read-crc-frame-sequence: SUCCESS (2.067s)
[136.387033] [120/165] (856s left) kms_pm_backlight (basic-brightness)
[136.599872] Subtest basic-brightness: SKIP (0.000s)
[136.622447] [121/165] (856s left) kms_psr (primary_page_flip)
[136.659829] Subtest primary_page_flip: SKIP (0.000s)
[136.689479] [122/165] (856s left) kms_psr (cursor_plane_move)
[136.717035] Subtest cursor_plane_move: SKIP (0.000s)
[136.739742] [123/165] (856s left) kms_psr (sprite_plane_onoff)
[136.773382] Subtest sprite_plane_onoff: SKIP (0.000s)
[136.789354] [124/165] (856s left) kms_psr (primary_mmap_gtt)
[136.817322] Subtest primary_mmap_gtt: SKIP (0.000s)
[136.842675] [125/165] (856s left) kms_setmode (basic-clone-single-crtc)
[136.871477] Starting subtest: basic-clone-single-crtc
[136.873272] Subtest basic-clone-single-crtc: SKIP (0.000s)
[136.936359] [126/165] (856s left) i915_pm_rpm (basic-pci-d3-state)
[138.481180] Starting subtest: basic-pci-d3-state
[140.775275] Subtest basic-pci-d3-state: SUCCESS (2.293s)
[140.992290] [127/165] (852s left) i915_pm_rpm (basic-rte)
[141.017710] Starting subtest: basic-rte
[147.525389] Subtest basic-rte: SUCCESS (6.507s)
[148.091781] [128/165] (845s left) i915_pm_rps (basic-api)
[148.124279] Starting subtest: basic-api
[148.125807] Subtest basic-api: SKIP (0.000s)
[148.190748] [129/165] (844s left) prime_self_import (basic-llseek-bad)
[148.218562] Starting subtest: basic-llseek-bad
[148.220187] Subtest basic-llseek-bad: SUCCESS (0.001s)
[148.292479] [130/165] (844s left) prime_self_import (basic-llseek-size)
[148.319288] Starting subtest: basic-llseek-size
[148.320968] Subtest basic-llseek-size: SUCCESS (0.001s)
[148.410545] [131/165] (844s left) prime_self_import (basic-with_fd_dup)
[148.438007] Starting subtest: basic-with_fd_dup
[148.439719] Subtest basic-with_fd_dup: SUCCESS (0.002s)
[148.526497] [132/165] (844s left) prime_self_import (basic-with_one_bo)
[148.552831] Starting subtest: basic-with_one_bo
[148.554907] Subtest basic-with_one_bo: SUCCESS (0.002s)
[148.609261] [133/165] (844s left) prime_self_import (basic-with_one_bo_two_files)
[148.635952] Starting subtest: basic-with_one_bo_two_files
[148.637673] Subtest basic-with_one_bo_two_files: SUCCESS (0.001s)
[148.726582] [134/165] (844s left) prime_self_import (basic-with_two_bos)
[148.760009] Starting subtest: basic-with_two_bos
[148.761646] Subtest basic-with_two_bos: SUCCESS (0.002s)
[148.842825] [135/165] (844s left) prime_vgem (basic-fence-flip)
[148.889633] Starting subtest: basic-fence-flip
[149.470067] Subtest basic-fence-flip: SUCCESS (0.580s)
[149.559459] [136/165] (843s left) prime_vgem (basic-fence-mmap)
[149.610562] Starting subtest: basic-fence-mmap
[149.629141] Subtest basic-fence-mmap: SUCCESS (0.017s)
[149.718050] [137/165] (843s left) prime_vgem (basic-fence-read)
[149.755307] Starting subtest: basic-fence-read
[149.759244] Subtest basic-fence-read: SKIP (0.003s)
[149.841282] [138/165] (843s left) prime_vgem (basic-gtt)
[149.894876] Starting subtest: basic-gtt
[149.895621] Subtest basic-gtt: SUCCESS (0.007s)
[149.974490] [139/165] (843s left) prime_vgem (basic-read)
[150.005626] Starting subtest: basic-read
[150.009278] Subtest basic-read: SKIP (0.003s)
[150.107509] [140/165] (843s left) prime_vgem (basic-write)
[150.141034] Starting subtest: basic-write
[150.143398] Subtest basic-write: SKIP (0.003s)
[150.224219] [141/165] (843s left) vgem_basic (setversion)
[150.254648] Starting subtest: setversion
[150.255859] Subtest setversion: SUCCESS (0.000s)
[150.303677] [142/165] (842s left) vgem_basic (create)
[150.337140] Starting subtest: create
[150.338035] Subtest create: SUCCESS (0.000s)
[150.389701] [143/165] (842s left) vgem_basic (debugfs)
[150.420699] Starting subtest: debugfs
[150.421462] Subtest debugfs: SUCCESS (0.000s)
[150.473660] [144/165] (842s left) vgem_basic (dmabuf-export)
[150.509647] Starting subtest: dmabuf-export
[150.511088] Subtest dmabuf-export: SUCCESS (0.001s)
[150.592389] [145/165] (842s left) vgem_basic (dmabuf-fence)
[150.620912] Starting subtest: dmabuf-fence
[150.621930] Subtest dmabuf-fence: SUCCESS (0.000s)
[150.673493] [146/165] (842s left) vgem_basic (dmabuf-fence-before)
[150.703919] Starting subtest: dmabuf-fence-before
[150.704815] Subtest dmabuf-fence-before: SUCCESS (0.000s)
[150.757579] [147/165] (842s left) vgem_basic (dmabuf-mmap)
[150.804126] Starting subtest: dmabuf-mmap
[150.809821] Subtest dmabuf-mmap: SUCCESS (0.007s)
[150.854366] [148/165] (842s left) vgem_basic (mmap)
[150.887040] Starting subtest: mmap
[150.890851] Subtest mmap: SUCCESS (0.004s)
[150.938354] [149/165] (842s left) vgem_basic (second-client)
[150.974828] Starting subtest: second-client
[151.004960] Subtest second-client: SUCCESS (0.034s)
[151.057215] [150/165] (842s left) vgem_basic (sysfs)
[151.087109] Starting subtest: sysfs
[151.087895] Subtest sysfs: SUCCESS (0.000s)
[151.140350] [151/165] (842s left) core_hotunplug (unbind-rebind)
[151.191133] Starting subtest: unbind-rebind
[155.351528] Subtest unbind-rebind: SUCCESS (4.165s)
[155.363134] [152/165] (838s left) vgem_basic (unload)
[155.391765] Starting subtest: unload
[184.330610] Subtest unload: SUCCESS (28.904s)
[184.374857] [153/165] (809s left) i915_module_load (reload)
[184.402759] Starting subtest: reload
[187.277810] Subtest reload: SUCCESS (2.875s)
[187.287307] [154/165] (806s left) gem_lmem_swapping (basic)
[187.319456] Subtest basic: SKIP (0.000s)
[187.350833] [155/165] (806s left) gem_lmem_swapping (parallel-random-engines)
[187.383390] Subtest parallel-random-engines: SKIP (0.000s)
[187.400932] [156/165] (806s left) gem_lmem_swapping (random-engines)
[187.429304] Subtest random-engines: SKIP (0.000s)
[187.450768] [157/165] (806s left) gem_lmem_swapping (verify-random)
[187.477654] Subtest verify-random: SKIP (0.000s)
[187.500302] [158/165] (805s left) i915_pm_rpm (module-reload)
[189.370940] Starting subtest: module-reload
[200.309510] Subtest module-reload: SUCCESS (10.932s)
[200.321652] [159/165] (793s left) i915_selftest (live)
[200.358031] Starting subtest: live
[200.358935] Starting dynamic subtest: sanitycheck
[202.039564] Dynamic subtest sanitycheck: SUCCESS (1.672s)
[202.044510] Starting dynamic subtest: uncore
[203.702488] Dynamic subtest uncore: SUCCESS (1.662s)
[203.706129] Starting dynamic subtest: workarounds
[206.282224] Dynamic subtest workarounds: SUCCESS (2.580s)
[206.286210] Starting dynamic subtest: gt_engines
[208.489875] Dynamic subtest gt_engines: SUCCESS (2.207s)
[208.493786] Starting dynamic subtest: gt_timelines
[219.146449] Dynamic subtest gt_timelines: SUCCESS (10.653s)
[219.151704] Starting dynamic subtest: gt_contexts
[220.829264] Dynamic subtest gt_contexts: SUCCESS (1.682s)
[220.832952] Starting dynamic subtest: gt_lrc
[225.394517] Dynamic subtest gt_lrc: SUCCESS (4.564s)
[225.398317] Starting dynamic subtest: gt_mocs
[227.536215] Dynamic subtest gt_mocs: SUCCESS (2.141s)
[227.539730] Starting dynamic subtest: gt_pm
[230.078620] Dynamic subtest gt_pm: SUCCESS (2.541s)
[230.084163] Starting dynamic subtest: gt_heartbeat
[231.907776] Dynamic subtest gt_heartbeat: SUCCESS (1.828s)
[231.911598] Starting dynamic subtest: gt_tlb
[235.078480] Dynamic subtest gt_tlb: SUCCESS (3.169s)
[235.084072] Starting dynamic subtest: requests
[244.606555] Dynamic subtest requests: SUCCESS (9.527s)
[244.610210] Starting dynamic subtest: migrate
[248.999665] Dynamic subtest migrate: SUCCESS (4.392s)
[249.003707] Starting dynamic subtest: active
[250.655537] Dynamic subtest active: SUCCESS (1.655s)
[250.659429] Starting dynamic subtest: objects
[252.721567] Dynamic subtest objects: SUCCESS (2.065s)
[252.725576] Starting dynamic subtest: mman
[258.006333] Dynamic subtest mman: SUCCESS (5.284s)
[258.010048] Starting dynamic subtest: dmabuf
[259.756620] Dynamic subtest dmabuf: SUCCESS (1.749s)
[259.760646] Starting dynamic subtest: vma
[261.477748] Dynamic subtest vma: SUCCESS (1.720s)
[261.483665] Starting dynamic subtest: coherency
[265.310700] Dynamic subtest coherency: SUCCESS (3.831s)
[265.316531] Starting dynamic subtest: gtt
[274.032774] Dynamic subtest gtt: SUCCESS (8.721s)
[274.038263] Starting dynamic subtest: gem
[275.811830] Dynamic subtest gem: SUCCESS (1.778s)
[275.815919] Starting dynamic subtest: evict
[278.974536] Dynamic subtest evict: SUCCESS (3.161s)
[278.978561] Starting dynamic subtest: hugepages
[287.164851] Dynamic subtest hugepages: SUCCESS (8.189s)
[287.168772] Starting dynamic subtest: gem_contexts
[303.653130] Dynamic subtest gem_contexts: SUCCESS (16.486s)
[303.658596] Starting dynamic subtest: client
[305.380165] Dynamic subtest client: SUCCESS (1.730s)
[305.385327] Starting dynamic subtest: gem_migrate
[307.037414] Dynamic subtest gem_migrate: SUCCESS (1.653s)
[307.041336] Starting dynamic subtest: reset
[312.453804] Dynamic subtest reset: SUCCESS (5.415s)
[312.457765] Starting dynamic subtest: memory_region
[314.142496] Dynamic subtest memory_region: SUCCESS (1.687s)
[314.147436] Starting dynamic subtest: hangcheck
[333.194791] Dynamic subtest hangcheck: SUCCESS (19.051s)
[333.198333] Starting dynamic subtest: execlists
[334.845494] Dynamic subtest execlists: SUCCESS (1.649s)
[334.851205] Starting dynamic subtest: ring_submission
[336.486329] Dynamic subtest ring_submission: SUCCESS (1.640s)
[336.491905] Starting dynamic subtest: perf
[338.235210] Dynamic subtest perf: SUCCESS (1.748s)
[338.240789] Starting dynamic subtest: slpc
[346.497634] Dynamic subtest slpc: SUCCESS (8.261s)
[346.501623] Starting dynamic subtest: guc
[348.957236] Dynamic subtest guc: SUCCESS (2.459s)
[348.961062] Starting dynamic subtest: guc_multi_lrc
[350.652299] Dynamic subtest guc_multi_lrc: SUCCESS (1.694s)
[350.656348] Starting dynamic subtest: guc_hang
[352.937580] Dynamic subtest guc_hang: SUCCESS (2.284s)
[352.941721] Starting dynamic subtest: late_gt_pm
[354.660190] Dynamic subtest late_gt_pm: SUCCESS (1.721s)
[354.661323] Subtest live: SUCCESS (154.293s)
[354.672115] [160/165] (638s left) dmabuf (all-tests)
[354.705825] Starting subtest: all-tests
[354.706729] Starting dynamic subtest: sanitycheck
[354.771549] Dynamic subtest sanitycheck: SUCCESS (0.065s)
[354.783220] Starting dynamic subtest: dma_fence
[354.945454] Dynamic subtest dma_fence: SUCCESS (0.172s)
[354.956483] Starting dynamic subtest: dma_fence_chain
[364.461569] Dynamic subtest dma_fence_chain: SUCCESS (9.514s)
[364.474191] Starting dynamic subtest: dma_fence_unwrap
[364.543560] Dynamic subtest dma_fence_unwrap: SUCCESS (0.079s)
[364.556961] Starting dynamic subtest: dma_resv
[364.613427] Dynamic subtest dma_resv: SUCCESS (0.068s)
[364.615183] Subtest all-tests: SUCCESS (9.908s)
[364.633556] [161/165] (628s left) i915_suspend (basic-s2idle-without-i915)
[364.667435] Starting subtest: basic-s2idle-without-i915
[384.168027] Subtest basic-s2idle-without-i915: SUCCESS (5.435s)
[384.456328] [162/165] (623s left) i915_suspend (basic-s3-without-i915)
[384.486806] Starting subtest: basic-s3-without-i915
[404.730368] Subtest basic-s3-without-i915: SUCCESS (4.227s)
[405.014871] [163/165] (618s left) gem_exec_suspend (basic-s0)
[405.063737] Starting subtest: basic-S0
[405.064562] Starting dynamic subtest: smem
[423.125541] Dynamic subtest smem: SUCCESS (2.650s)
[423.126575] Subtest basic-S0: SUCCESS (2.651s)
[423.261301] [164/165] (615s left) gem_exec_suspend (basic-s3)
[423.292984] Starting subtest: basic-S3
[423.293811] Starting dynamic subtest: smem
[441.097752] Dynamic subtest smem: SUCCESS (2.590s)
[441.099033] Subtest basic-S3: SUCCESS (2.591s)
[441.248863] [165/165] (613s left) kms_pipe_crc_basic (suspend-read-crc)
[441.460457] Starting subtest: suspend-read-crc
[441.461697] Starting dynamic subtest: pipe-A-DP-1
[459.231610] Dynamic subtest pipe-A-DP-1: SUCCESS (2.359s)
[459.237685] Starting dynamic subtest: pipe-B-DP-1
[477.172473] Dynamic subtest pipe-B-DP-1: SUCCESS (2.218s)
[477.177778] Starting dynamic subtest: pipe-C-DP-1
[495.189472] Dynamic subtest pipe-C-DP-1: SUCCESS (2.279s)
[495.195153] Starting dynamic subtest: pipe-D-DP-1
[513.180989] Dynamic subtest pipe-D-DP-1: SUCCESS (2.249s)
[513.181728] Subtest suspend-read-crc: SUCCESS (9.110s)
[513.286657] Closing watchdogs
Done.