[32.314589] Initializing watchdogs
[32.314650]   /dev/watchdog0
[32.319561] [001/171] (960s left) i915_module_load (load)
[32.370015] Starting subtest: load
[33.433138] Subtest load: SUCCESS (1.057s)
[33.468837] [002/171] (959s left) core_auth (basic-auth)
[33.582861] Starting subtest: basic-auth
[33.583814] Subtest basic-auth: SUCCESS (0.001s)
[33.592625] [003/171] (959s left) debugfs_test (read_all_entries)
[33.656999] Starting subtest: read_all_entries
[34.003465] Subtest read_all_entries: SUCCESS (0.346s)
[34.118301] [004/171] (958s left) debugfs_test (basic-hwmon)
[34.178120] Starting subtest: basic-hwmon
[34.180709] Subtest basic-hwmon: SUCCESS (0.002s)
[34.296550] [005/171] (958s left) fbdev (eof)
[34.980854] Subtest eof: SKIP (0.000s)
[34.989115] [006/171] (957s left) fbdev (info)
[35.048048] Subtest info: SKIP (0.000s)
[35.056563] [007/171] (957s left) fbdev (nullptr)
[35.112374] Subtest nullptr: SKIP (0.000s)
[35.120649] [008/171] (957s left) fbdev (read)
[35.175950] Subtest read: SKIP (0.000s)
[35.184764] [009/171] (957s left) fbdev (write)
[35.242299] Subtest write: SKIP (0.000s)
[35.250761] [010/171] (957s left) gem_basic (bad-close)
[35.306798] Starting subtest: bad-close
[35.308569] Subtest bad-close: SUCCESS (0.000s)
[35.316183] [011/171] (957s left) gem_basic (create-close)
[35.371904] Starting subtest: create-close
[35.374360] Subtest create-close: SUCCESS (0.000s)
[35.402795] [012/171] (957s left) gem_basic (create-fd-close)
[35.458444] Starting subtest: create-fd-close
[35.460329] Subtest create-fd-close: SUCCESS (0.000s)
[35.478309] [013/171] (957s left) gem_busy (busy@all-engines)
[35.546988] Starting subtest: busy
[35.547824] Starting dynamic subtest: all-engines
[35.639362] Dynamic subtest all-engines: SUCCESS (0.093s)
[35.640216] Subtest busy: SUCCESS (0.093s)
[35.961932] [014/171] (957s left) gem_close_race (basic-process)
[36.075830] Starting subtest: basic-process
[36.123464] Subtest basic-process: SUCCESS (0.048s)
[36.266949] [015/171] (956s left) gem_close_race (basic-threads)
[36.372495] Starting subtest: basic-threads
[37.554490] Subtest basic-threads: SUCCESS (1.182s)
[37.732815] [016/171] (955s left) gem_ctx_create (basic)
[37.849039] Starting subtest: basic
[37.849899] Subtest basic: SUCCESS (0.000s)
[37.970154] [017/171] (955s left) gem_ctx_create (basic-files)
[38.038819] Starting subtest: basic-files
[40.311896] Subtest basic-files: SUCCESS (2.268s)
[40.699850] [018/171] (952s left) gem_ctx_exec (basic)
[40.761564] Starting subtest: basic
[40.765899] Subtest basic: SUCCESS (0.004s)
[40.805981] [019/171] (952s left) gem_exec_basic (basic)
[40.886761] Starting subtest: basic
[40.887577] Starting dynamic subtest: rcs0-smem
[40.889339] Dynamic subtest rcs0-smem: SUCCESS (0.002s)
[40.894172] Starting dynamic subtest: bcs0-smem
[40.894980] Dynamic subtest bcs0-smem: SUCCESS (0.001s)
[40.900649] Starting dynamic subtest: vcs0-smem
[40.901442] Dynamic subtest vcs0-smem: SUCCESS (0.001s)
[40.905937] Starting dynamic subtest: vcs1-smem
[40.906754] Dynamic subtest vcs1-smem: SUCCESS (0.001s)
[40.910936] Starting dynamic subtest: vecs0-smem
[40.911788] Dynamic subtest vecs0-smem: SUCCESS (0.001s)
[40.915960] Starting dynamic subtest: vecs1-smem
[40.916793] Dynamic subtest vecs1-smem: SUCCESS (0.001s)
[40.921252] Starting dynamic subtest: ccs0-smem
[40.922487] Dynamic subtest ccs0-smem: SUCCESS (0.001s)
[40.926862] Starting dynamic subtest: ccs1-smem
[40.928049] Dynamic subtest ccs1-smem: SUCCESS (0.001s)
[40.932095] Starting dynamic subtest: ccs2-smem
[40.932885] Dynamic subtest ccs2-smem: SUCCESS (0.001s)
[40.937158] Starting dynamic subtest: ccs3-smem
[40.938065] Dynamic subtest ccs3-smem: SUCCESS (0.001s)
[40.942552] Starting dynamic subtest: rcs0-lmem0
[40.943651] Dynamic subtest rcs0-lmem0: SUCCESS (0.001s)
[40.948090] Starting dynamic subtest: bcs0-lmem0
[40.948895] Dynamic subtest bcs0-lmem0: SUCCESS (0.000s)
[40.952819] Starting dynamic subtest: vcs0-lmem0
[40.953606] Dynamic subtest vcs0-lmem0: SUCCESS (0.000s)
[40.957643] Starting dynamic subtest: vcs1-lmem0
[40.958424] Dynamic subtest vcs1-lmem0: SUCCESS (0.000s)
[40.962819] Starting dynamic subtest: vecs0-lmem0
[40.964035] Dynamic subtest vecs0-lmem0: SUCCESS (0.000s)
[40.968498] Starting dynamic subtest: vecs1-lmem0
[40.969632] Dynamic subtest vecs1-lmem0: SUCCESS (0.000s)
[40.974054] Starting dynamic subtest: ccs0-lmem0
[40.975203] Dynamic subtest ccs0-lmem0: SUCCESS (0.000s)
[40.979630] Starting dynamic subtest: ccs1-lmem0
[40.980845] Dynamic subtest ccs1-lmem0: SUCCESS (0.000s)
[40.984854] Starting dynamic subtest: ccs2-lmem0
[40.985624] Dynamic subtest ccs2-lmem0: SUCCESS (0.000s)
[40.989624] Starting dynamic subtest: ccs3-lmem0
[40.990409] Dynamic subtest ccs3-lmem0: SUCCESS (0.000s)
[40.991195] Subtest basic: SUCCESS (0.016s)
[41.024461] [020/171] (952s left) gem_exec_create (basic)
[41.095106] Starting subtest: basic
[41.095920] Starting dynamic subtest: smem
[43.193574] Dynamic subtest smem: SUCCESS (2.098s)
[43.198025] Starting dynamic subtest: lmem0
[45.292024] Dynamic subtest lmem0: SUCCESS (2.098s)
[45.293132] Subtest basic: SUCCESS (4.197s)
[45.411672] [021/171] (947s left) gem_exec_fence (basic-busy)
[45.635924] Starting subtest: basic-busy
[45.636778] Starting dynamic subtest: rcs0
[45.731991] Dynamic subtest rcs0: SUCCESS (0.095s)
[45.739778] Starting dynamic subtest: bcs0
[45.789367] Dynamic subtest bcs0: SUCCESS (0.057s)
[45.805602] Starting dynamic subtest: vcs0
[45.848214] Dynamic subtest vcs0: SUCCESS (0.058s)
[45.866306] Starting dynamic subtest: vcs1
[45.903201] Dynamic subtest vcs1: SUCCESS (0.055s)
[45.921837] Starting dynamic subtest: vecs0
[45.963442] Dynamic subtest vecs0: SUCCESS (0.060s)
[45.982066] Starting dynamic subtest: vecs1
[46.015107] Dynamic subtest vecs1: SUCCESS (0.052s)
[46.033516] Starting dynamic subtest: ccs0
[46.074205] Dynamic subtest ccs0: SUCCESS (0.059s)
[46.092845] Starting dynamic subtest: ccs1
[46.143253] Dynamic subtest ccs1: SUCCESS (0.069s)
[46.161930] Starting dynamic subtest: ccs2
[46.195060] Dynamic subtest ccs2: SUCCESS (0.051s)
[46.213617] Starting dynamic subtest: ccs3
[46.250112] Dynamic subtest ccs3: SUCCESS (0.055s)
[46.252049] Subtest basic-busy: SUCCESS (0.614s)
[47.349483] [022/171] (945s left) gem_exec_fence (basic-wait)
[47.529957] Starting subtest: basic-wait
[47.530756] Starting dynamic subtest: rcs0
[47.628146] Dynamic subtest rcs0: SUCCESS (0.097s)
[47.637008] Starting dynamic subtest: bcs0
[47.688093] Dynamic subtest bcs0: SUCCESS (0.060s)
[47.702458] Starting dynamic subtest: vcs0
[47.747095] Dynamic subtest vcs0: SUCCESS (0.058s)
[47.766121] Starting dynamic subtest: vcs1
[47.804119] Dynamic subtest vcs1: SUCCESS (0.056s)
[47.812954] Starting dynamic subtest: vecs0
[47.852277] Dynamic subtest vecs0: SUCCESS (0.049s)
[47.861026] Starting dynamic subtest: vecs1
[47.911069] Dynamic subtest vecs1: SUCCESS (0.058s)
[47.930276] Starting dynamic subtest: ccs0
[47.962886] Dynamic subtest ccs0: SUCCESS (0.051s)
[47.981831] Starting dynamic subtest: ccs1
[48.013804] Dynamic subtest ccs1: SUCCESS (0.051s)
[48.032663] Starting dynamic subtest: ccs2
[48.068730] Dynamic subtest ccs2: SUCCESS (0.054s)
[48.087671] Starting dynamic subtest: ccs3
[48.122100] Dynamic subtest ccs3: SUCCESS (0.053s)
[48.124048] Subtest basic-wait: SUCCESS (0.591s)
[49.208204] [023/171] (943s left) gem_exec_fence (basic-await)
[49.390062] Starting subtest: basic-await
[49.390991] Starting dynamic subtest: rcs0
[49.503867] Dynamic subtest rcs0: SUCCESS (0.114s)
[49.508438] Starting dynamic subtest: bcs0
[49.595979] Dynamic subtest bcs0: SUCCESS (0.092s)
[49.600938] Starting dynamic subtest: vcs0
[49.690654] Dynamic subtest vcs0: SUCCESS (0.095s)
[49.696589] Starting dynamic subtest: vcs1
[49.790712] Dynamic subtest vcs1: SUCCESS (0.100s)
[49.795584] Starting dynamic subtest: vecs0
[49.885121] Dynamic subtest vecs0: SUCCESS (0.094s)
[49.889977] Starting dynamic subtest: vecs1
[49.980802] Dynamic subtest vecs1: SUCCESS (0.096s)
[49.985492] Starting dynamic subtest: ccs0
[50.074215] Dynamic subtest ccs0: SUCCESS (0.093s)
[50.079552] Starting dynamic subtest: ccs1
[50.171739] Dynamic subtest ccs1: SUCCESS (0.097s)
[50.176989] Starting dynamic subtest: ccs2
[50.268058] Dynamic subtest ccs2: SUCCESS (0.096s)
[50.273127] Starting dynamic subtest: ccs3
[50.361700] Dynamic subtest ccs3: SUCCESS (0.094s)
[50.362634] Subtest basic-await: SUCCESS (0.972s)
[51.425629] [024/171] (941s left) gem_exec_fence (nb-await)
[51.632721] Starting subtest: nb-await
[51.633653] Starting dynamic subtest: rcs0
[51.724447] Dynamic subtest rcs0: SUCCESS (0.092s)
[51.730197] Starting dynamic subtest: bcs0
[51.790968] Dynamic subtest bcs0: SUCCESS (0.066s)
[51.798121] Starting dynamic subtest: vcs0
[51.856666] Dynamic subtest vcs0: SUCCESS (0.066s)
[51.863846] Starting dynamic subtest: vcs1
[51.927151] Dynamic subtest vcs1: SUCCESS (0.069s)
[51.931871] Starting dynamic subtest: vecs0
[51.990570] Dynamic subtest vecs0: SUCCESS (0.064s)
[51.998850] Starting dynamic subtest: vecs1
[52.064325] Dynamic subtest vecs1: SUCCESS (0.073s)
[52.084423] Starting dynamic subtest: ccs0
[52.154919] Dynamic subtest ccs0: SUCCESS (0.091s)
[52.168733] Starting dynamic subtest: ccs1
[52.240185] Dynamic subtest ccs1: SUCCESS (0.084s)
[52.247179] Starting dynamic subtest: ccs2
[52.306223] Dynamic subtest ccs2: SUCCESS (0.066s)
[52.312895] Starting dynamic subtest: ccs3
[52.375073] Dynamic subtest ccs3: SUCCESS (0.069s)
[52.376369] Subtest nb-await: SUCCESS (0.742s)
[53.407050] [025/171] (939s left) gem_exec_gttfill (basic)
[53.500211] Starting subtest: basic
[58.712244] Subtest basic: SUCCESS (5.203s)
[58.913235] [026/171] (934s left) gem_exec_parallel (engines)
[59.022435] Starting subtest: engines
[59.023242] Starting dynamic subtest: basic
[60.904827] Dynamic subtest basic: SUCCESS (1.882s)
[60.910133] Starting dynamic subtest: contexts
[66.319304] Dynamic subtest contexts: SUCCESS (5.403s)
[66.324458] Starting dynamic subtest: fds
[70.054401] Dynamic subtest fds: SUCCESS (3.746s)
[70.059522] Starting dynamic subtest: userptr
[71.705485] Dynamic subtest userptr: SUCCESS (1.651s)
[71.706602] Subtest engines: SUCCESS (12.683s)
[71.911052] [027/171] (921s left) gem_exec_store (basic)
[71.986987] Starting subtest: basic
[72.114923] Subtest basic: SUCCESS (0.128s)
[72.265110] [028/171] (920s left) gem_flink_basic (bad-flink)
[72.328715] Starting subtest: bad-flink
[72.329530] Subtest bad-flink: SUCCESS (0.000s)
[72.338323] [029/171] (920s left) gem_flink_basic (bad-open)
[72.398368] Starting subtest: bad-open
[72.399268] Subtest bad-open: SUCCESS (0.000s)
[72.409025] [030/171] (920s left) gem_flink_basic (basic)
[72.466733] Starting subtest: basic
[72.467808] Subtest basic: SUCCESS (0.000s)
[72.487268] [031/171] (920s left) gem_flink_basic (double-flink)
[72.545311] Starting subtest: double-flink
[72.546131] Subtest double-flink: SUCCESS (0.000s)
[72.568491] [032/171] (920s left) gem_flink_basic (flink-lifetime)
[72.625894] Starting subtest: flink-lifetime
[72.626729] Subtest flink-lifetime: SUCCESS (0.001s)
[72.660891] [033/171] (920s left) gem_huc_copy (huc-copy)
[72.742009] Starting subtest: huc-copy
[72.746932] Subtest huc-copy: SUCCESS (0.005s)
[72.799634] [034/171] (920s left) gem_linear_blits (basic)
[72.947439] Starting subtest: basic
[72.975147] Subtest basic: SUCCESS (0.028s)
[73.042770] [035/171] (920s left) gem_mmap (basic)
[73.190414] Subtest basic: SKIP (0.000s)
[73.199975] [036/171] (920s left) gem_mmap_gtt (basic)
[73.260431] Subtest basic: SKIP (0.000s)
[73.268752] [037/171] (920s left) gem_render_linear_blits (basic)
[73.331726] Starting subtest: basic
[73.379658] Subtest basic: SUCCESS (0.048s)
[73.431961] [038/171] (919s left) gem_render_tiled_blits (basic)
[73.505502] Subtest basic: SKIP (0.000s)
[73.515191] [039/171] (919s left) gem_ringfill (basic-all)
[73.891273] Starting subtest: basic-all
[76.675408] Subtest basic-all: SUCCESS (2.776s)
[76.720539] [040/171] (916s left) gem_softpin (allocator-basic)
[76.790203] Starting subtest: allocator-basic
[76.957594] Subtest allocator-basic: SUCCESS (0.159s)
[77.022119] [041/171] (916s left) gem_softpin (allocator-basic-reserve)
[77.111242] Starting subtest: allocator-basic-reserve
[77.277560] Subtest allocator-basic-reserve: SUCCESS (0.158s)
[77.331634] [042/171] (916s left) gem_softpin (safe-alignment)
[77.413931] Starting subtest: safe-alignment
[77.468327] Subtest safe-alignment: SUCCESS (0.054s)
[77.524463] [043/171] (915s left) gem_sync (basic-all)
[77.621367] Starting subtest: basic-all
[81.326841] Subtest basic-all: SUCCESS (3.705s)
[81.447786] [044/171] (912s left) gem_sync (basic-each)
[81.516875] Starting subtest: basic-each
[84.179439] Subtest basic-each: SUCCESS (2.662s)
[84.352123] [045/171] (909s left) gem_tiled_blits (basic)
[84.448415] Subtest basic: SKIP (0.000s)
[84.458280] [046/171] (909s left) gem_tiled_fence_blits (basic)
[84.521697] Subtest basic: SKIP (0.000s)
[84.531902] [047/171] (908s left) gem_tiled_pread_basic
[84.600989] [048/171] (908s left) gem_wait (busy@all-engines)
[84.673068] Starting subtest: busy
[84.674055] Starting dynamic subtest: all-engines
[85.252340] Dynamic subtest all-engines: SUCCESS (0.579s)
[85.253318] Subtest busy: SUCCESS (0.579s)
[85.433809] [049/171] (908s left) gem_wait (wait@all-engines)
[85.540552] Starting subtest: wait
[85.541427] Starting dynamic subtest: all-engines
[86.627503] Dynamic subtest all-engines: SUCCESS (1.087s)
[86.628393] Subtest wait: SUCCESS (1.087s)
[86.798650] [050/171] (906s left) i915_getparams_basic (basic-eu-total)
[86.863388] Starting subtest: basic-eu-total
[86.865161] Subtest basic-eu-total: SUCCESS (0.000s)
[86.874106] [051/171] (906s left) i915_getparams_basic (basic-subslice-total)
[86.932637] Starting subtest: basic-subslice-total
[86.934329] Subtest basic-subslice-total: SUCCESS (0.000s)
[86.942736] [052/171] (906s left) i915_hangman (error-state-basic)
[87.016636] Starting subtest: error-state-basic
[87.213711] Subtest error-state-basic: SUCCESS (0.197s)
[87.232729] [053/171] (906s left) i915_pciid
[87.303352] [054/171] (906s left) kms_addfb_basic (addfb25-bad-modifier)
[87.361608] Starting subtest: addfb25-bad-modifier
[87.362603] Subtest addfb25-bad-modifier: SUCCESS (0.000s)
[87.505343] [055/171] (906s left) kms_addfb_basic (addfb25-framebuffer-vs-set-tiling)
[87.564376] Subtest addfb25-framebuffer-vs-set-tiling: SKIP (0.000s)
[87.716706] [056/171] (905s left) kms_addfb_basic (addfb25-modifier-no-flag)
[87.775173] Starting subtest: addfb25-modifier-no-flag
[87.775966] Subtest addfb25-modifier-no-flag: SUCCESS (0.000s)
[87.928409] [057/171] (905s left) kms_addfb_basic (addfb25-x-tiled-legacy)
[87.988252] Subtest addfb25-x-tiled-legacy: SKIP (0.000s)
[88.141139] [058/171] (905s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy)
[88.200790] Subtest addfb25-x-tiled-mismatch-legacy: SKIP (0.000s)
[88.346423] [059/171] (905s left) kms_addfb_basic (addfb25-yf-tiled-legacy)
[88.524062] Starting subtest: addfb25-yf-tiled-legacy
[88.524972] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.000s)
[88.551686] [060/171] (905s left) kms_addfb_basic (addfb25-y-tiled-legacy)
[88.730802] Starting subtest: addfb25-y-tiled-legacy
[88.731599] Subtest addfb25-y-tiled-legacy: SUCCESS (0.000s)
[88.761270] [061/171] (904s left) kms_addfb_basic (addfb25-y-tiled-small-legacy)
[88.941024] Starting subtest: addfb25-y-tiled-small-legacy
[88.942581] Subtest addfb25-y-tiled-small-legacy: SKIP (0.000s)
[88.978081] [062/171] (904s left) kms_addfb_basic (bad-pitch-0)
[89.036694] Starting subtest: bad-pitch-0
[89.037571] Subtest bad-pitch-0: SUCCESS (0.000s)
[89.190816] [063/171] (904s left) kms_addfb_basic (bad-pitch-1024)
[89.248512] Starting subtest: bad-pitch-1024
[89.249317] Subtest bad-pitch-1024: SUCCESS (0.000s)
[89.392423] [064/171] (904s left) kms_addfb_basic (bad-pitch-128)
[89.451137] Starting subtest: bad-pitch-128
[89.451931] Subtest bad-pitch-128: SUCCESS (0.000s)
[89.605462] [065/171] (904s left) kms_addfb_basic (bad-pitch-256)
[89.665730] Starting subtest: bad-pitch-256
[89.666881] Subtest bad-pitch-256: SUCCESS (0.000s)
[89.809140] [066/171] (903s left) kms_addfb_basic (bad-pitch-32)
[89.868359] Starting subtest: bad-pitch-32
[89.869251] Subtest bad-pitch-32: SUCCESS (0.000s)
[90.021650] [067/171] (903s left) kms_addfb_basic (bad-pitch-63)
[90.079571] Starting subtest: bad-pitch-63
[90.080468] Subtest bad-pitch-63: SUCCESS (0.000s)
[90.247696] [068/171] (903s left) kms_addfb_basic (bad-pitch-65536)
[90.306117] Starting subtest: bad-pitch-65536
[90.306901] Subtest bad-pitch-65536: SUCCESS (0.000s)
[90.461915] [069/171] (903s left) kms_addfb_basic (bad-pitch-999)
[90.519686] Starting subtest: bad-pitch-999
[90.520581] Subtest bad-pitch-999: SUCCESS (0.000s)
[90.664408] [070/171] (903s left) kms_addfb_basic (basic)
[90.723568] Starting subtest: basic
[90.724483] Subtest basic: SUCCESS (0.000s)
[90.867714] [071/171] (902s left) kms_addfb_basic (basic-x-tiled-legacy)
[90.927165] Starting subtest: basic-x-tiled-legacy
[90.928798] Subtest basic-x-tiled-legacy: SKIP (0.000s)
[91.075419] [072/171] (902s left) kms_addfb_basic (basic-y-tiled-legacy)
[91.134274] Starting subtest: basic-y-tiled-legacy
[91.135972] Subtest basic-y-tiled-legacy: SKIP (0.000s)
[91.280710] [073/171] (902s left) kms_addfb_basic (bo-too-small)
[91.463562] Starting subtest: bo-too-small
[91.464506] Subtest bo-too-small: SUCCESS (0.000s)
[91.488346] [074/171] (902s left) kms_addfb_basic (bo-too-small-due-to-tiling)
[91.666869] Starting subtest: bo-too-small-due-to-tiling
[91.668640] Subtest bo-too-small-due-to-tiling: SKIP (0.000s)
[91.691912] [075/171] (902s left) kms_addfb_basic (clobberred-modifier)
[91.750040] Starting subtest: clobberred-modifier
[91.751758] Subtest clobberred-modifier: SKIP (0.000s)
[91.895660] [076/171] (901s left) kms_addfb_basic (framebuffer-vs-set-tiling)
[91.954581] Starting subtest: framebuffer-vs-set-tiling
[91.956139] Subtest framebuffer-vs-set-tiling: SKIP (0.000s)
[92.106875] [077/171] (901s left) kms_addfb_basic (invalid-get-prop)
[92.165976] Starting subtest: invalid-get-prop
[92.166787] Subtest invalid-get-prop: SUCCESS (0.000s)
[92.333923] [078/171] (901s left) kms_addfb_basic (invalid-get-prop-any)
[92.393164] Starting subtest: invalid-get-prop-any
[92.394104] Subtest invalid-get-prop-any: SUCCESS (0.000s)
[92.548208] [079/171] (901s left) kms_addfb_basic (invalid-set-prop)
[92.606554] Starting subtest: invalid-set-prop
[92.607511] Subtest invalid-set-prop: SUCCESS (0.000s)
[92.756428] [080/171] (901s left) kms_addfb_basic (invalid-set-prop-any)
[92.814638] Starting subtest: invalid-set-prop-any
[92.815556] Subtest invalid-set-prop-any: SUCCESS (0.000s)
[92.959181] [081/171] (900s left) kms_addfb_basic (no-handle)
[93.017505] Starting subtest: no-handle
[93.018291] Subtest no-handle: SUCCESS (0.000s)
[93.158287] [082/171] (900s left) kms_addfb_basic (size-max)
[93.335920] Starting subtest: size-max
[93.336719] Subtest size-max: SUCCESS (0.000s)
[93.368547] [083/171] (900s left) kms_addfb_basic (small-bo)
[93.547909] Starting subtest: small-bo
[93.548741] Subtest small-bo: SUCCESS (0.000s)
[93.572481] [084/171] (900s left) kms_addfb_basic (tile-pitch-mismatch)
[93.632657] Starting subtest: tile-pitch-mismatch
[93.634375] Subtest tile-pitch-mismatch: SKIP (0.000s)
[93.781138] [085/171] (900s left) kms_addfb_basic (too-high)
[93.959832] Starting subtest: too-high
[93.960702] Subtest too-high: SUCCESS (0.000s)
[93.994342] [086/171] (899s left) kms_addfb_basic (too-wide)
[94.174222] Starting subtest: too-wide
[94.175050] Subtest too-wide: SUCCESS (0.000s)
[94.205277] [087/171] (899s left) kms_addfb_basic (unused-handle)
[94.263504] Starting subtest: unused-handle
[94.264447] Subtest unused-handle: SUCCESS (0.000s)
[94.410651] [088/171] (899s left) kms_addfb_basic (unused-modifier)
[94.468914] Starting subtest: unused-modifier
[94.469731] Subtest unused-modifier: SUCCESS (0.000s)
[94.612631] [089/171] (899s left) kms_addfb_basic (unused-offsets)
[94.670960] Starting subtest: unused-offsets
[94.671856] Subtest unused-offsets: SUCCESS (0.000s)
[94.815300] [090/171] (899s left) kms_addfb_basic (unused-pitches)
[94.874168] Starting subtest: unused-pitches
[94.874964] Subtest unused-pitches: SUCCESS (0.000s)
[95.014835] [091/171] (899s left) kms_busy (basic)
[95.199107] Subtest basic: SKIP (0.000s)
[95.209569] [092/171] (898s left) kms_chamelium_hpd (dp-hpd-fast)
[95.391693] Subtest dp-hpd-fast: SKIP (0.000s)
[95.402355] [093/171] (898s left) kms_chamelium_edid (dp-edid-read)
[95.584670] Subtest dp-edid-read: SKIP (0.000s)
[95.596514] [094/171] (898s left) kms_chamelium_frames (dp-crc-fast)
[95.778984] Subtest dp-crc-fast: SKIP (0.000s)
[95.789357] [095/171] (898s left) kms_chamelium_hpd (hdmi-hpd-fast)
[95.974409] Subtest hdmi-hpd-fast: SKIP (0.000s)
[95.985474] [096/171] (898s left) kms_chamelium_edid (hdmi-edid-read)
[96.166658] Subtest hdmi-edid-read: SKIP (0.000s)
[96.177384] [097/171] (897s left) kms_chamelium_frames (hdmi-crc-fast)
[96.360028] Subtest hdmi-crc-fast: SKIP (0.000s)
[96.370850] [098/171] (897s left) kms_chamelium_hpd (vga-hpd-fast)
[96.551861] Subtest vga-hpd-fast: SKIP (0.000s)
[96.562973] [099/171] (897s left) kms_chamelium_edid (vga-edid-read)
[96.762115] Subtest vga-edid-read: SKIP (0.000s)
[96.772754] [100/171] (897s left) kms_prop_blob (basic)
[96.832249] Starting subtest: basic
[96.833173] Subtest basic: SUCCESS (0.000s)
[96.843142] [101/171] (897s left) kms_cursor_legacy (basic-busy-flip-before-cursor-atomic)
[97.026058] Subtest basic-busy-flip-before-cursor-atomic: SKIP (0.000s)
[97.035274] [102/171] (897s left) kms_cursor_legacy (basic-busy-flip-before-cursor-legacy)
[97.218958] Subtest basic-busy-flip-before-cursor-legacy: SKIP (0.000s)
[97.228349] [103/171] (896s left) kms_cursor_legacy (basic-flip-after-cursor-atomic)
[97.410626] Subtest basic-flip-after-cursor-atomic: SKIP (0.000s)
[97.420423] [104/171] (896s left) kms_cursor_legacy (basic-flip-after-cursor-legacy)
[97.603234] Subtest basic-flip-after-cursor-legacy: SKIP (0.000s)
[97.612864] [105/171] (896s left) kms_cursor_legacy (basic-flip-after-cursor-varying-size)
[97.797781] Subtest basic-flip-after-cursor-varying-size: SKIP (0.000s)
[97.806657] [106/171] (896s left) kms_cursor_legacy (basic-flip-before-cursor-atomic)
[97.988997] Subtest basic-flip-before-cursor-atomic: SKIP (0.000s)
[97.998812] [107/171] (896s left) kms_cursor_legacy (basic-flip-before-cursor-legacy)
[98.182372] Subtest basic-flip-before-cursor-legacy: SKIP (0.000s)
[98.192164] [108/171] (896s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size)
[98.375439] Subtest basic-flip-before-cursor-varying-size: SKIP (0.000s)
[98.384739] [109/171] (895s left) kms_flip (basic-flip-vs-dpms)
[98.499785] Starting subtest: basic-flip-vs-dpms
[98.503055] Subtest basic-flip-vs-dpms: SKIP (0.003s)
[98.543897] [110/171] (895s left) kms_flip (basic-flip-vs-modeset)
[98.666654] Starting subtest: basic-flip-vs-modeset
[98.669154] Subtest basic-flip-vs-modeset: SKIP (0.004s)
[98.708307] [111/171] (895s left) kms_flip (basic-flip-vs-wf_vblank)
[98.824422] Starting subtest: basic-flip-vs-wf_vblank
[98.827270] Subtest basic-flip-vs-wf_vblank: SKIP (0.003s)
[98.858630] [112/171] (895s left) kms_flip (basic-plain-flip)
[98.972809] Starting subtest: basic-plain-flip
[98.975505] Subtest basic-plain-flip: SKIP (0.003s)
[98.993575] [113/171] (895s left) kms_force_connector_basic (force-connector-state)
[99.069887] Starting subtest: force-connector-state
[99.584040] Subtest force-connector-state: SUCCESS (0.513s)
[99.813120] [114/171] (894s left) kms_force_connector_basic (force-edid)
[99.895676] Starting subtest: force-edid
[99.923284] Subtest force-edid: SUCCESS (0.027s)
[100.082999] [115/171] (894s left) kms_force_connector_basic (force-load-detect)
[100.159129] Starting subtest: force-load-detect
[100.160898] Subtest force-load-detect: SKIP (0.000s)
[100.268868] [116/171] (894s left) kms_force_connector_basic (prune-stale-modes)
[100.346122] Starting subtest: prune-stale-modes
[100.362019] Subtest prune-stale-modes: SKIP (0.016s)
[100.518290] [117/171] (893s left) kms_frontbuffer_tracking (basic)
[100.697967] Subtest basic: SKIP (0.000s)
[100.723521] [118/171] (893s left) kms_pipe_crc_basic (compare-crc-sanitycheck-xr24)
[100.903135] Subtest compare-crc-sanitycheck-xr24: SKIP (0.000s)
[100.917605] [119/171] (893s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12)
[101.096956] Subtest compare-crc-sanitycheck-nv12: SKIP (0.000s)
[101.111909] [120/171] (893s left) kms_pipe_crc_basic (hang-read-crc)
[101.292073] Subtest hang-read-crc: SKIP (0.000s)
[101.307140] [121/171] (893s left) kms_pipe_crc_basic (nonblocking-crc)
[101.487110] Subtest nonblocking-crc: SKIP (0.000s)
[101.502312] [122/171] (892s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence)
[101.682111] Subtest nonblocking-crc-frame-sequence: SKIP (0.000s)
[101.697252] [123/171] (892s left) kms_pipe_crc_basic (read-crc)
[101.877994] Subtest read-crc: SKIP (0.000s)
[101.891518] [124/171] (892s left) kms_pipe_crc_basic (read-crc-frame-sequence)
[102.071976] Subtest read-crc-frame-sequence: SKIP (0.000s)
[102.087334] [125/171] (892s left) kms_psr (primary_page_flip)
[102.147374] Subtest primary_page_flip: SKIP (0.000s)
[102.161123] [126/171] (892s left) kms_psr (cursor_plane_move)
[102.221669] Subtest cursor_plane_move: SKIP (0.000s)
[102.236218] [127/171] (892s left) kms_psr (sprite_plane_onoff)
[102.295490] Subtest sprite_plane_onoff: SKIP (0.000s)
[102.309183] [128/171] (892s left) kms_psr (primary_mmap_gtt)
[102.368969] Subtest primary_mmap_gtt: SKIP (0.000s)
[102.382703] [129/171] (892s left) kms_setmode (basic-clone-single-crtc)
[102.441267] Starting subtest: basic-clone-single-crtc
[102.443633] Subtest basic-clone-single-crtc: SKIP (0.000s)
[102.461527] [130/171] (892s left) i915_pm_backlight (basic-brightness)
[102.641108] Subtest basic-brightness: SKIP (0.000s)
[102.656203] [131/171] (891s left) i915_pm_rpm (basic-pci-d3-state)
[104.495242] Starting subtest: basic-pci-d3-state
[105.139324] Subtest basic-pci-d3-state: SUCCESS (0.643s)
[105.222269] [132/171] (889s left) i915_pm_rpm (basic-rte)
[105.276111] Starting subtest: basic-rte
[108.040771] Subtest basic-rte: SUCCESS (2.761s)
[108.938086] [133/171] (885s left) i915_pm_rps (basic-api)
[109.002843] Starting subtest: basic-api
[109.004642] Subtest basic-api: SKIP (0.000s)
[109.024807] [134/171] (885s left) prime_self_import (basic-llseek-bad)
[109.072841] Starting subtest: basic-llseek-bad
[109.083903] Subtest basic-llseek-bad: SUCCESS (0.011s)
[109.116775] [135/171] (885s left) prime_self_import (basic-llseek-size)
[109.168600] Starting subtest: basic-llseek-size
[109.180012] Subtest basic-llseek-size: SUCCESS (0.012s)
[109.213900] [136/171] (885s left) prime_self_import (basic-with_fd_dup)
[109.266270] Starting subtest: basic-with_fd_dup
[109.277752] Subtest basic-with_fd_dup: SUCCESS (0.012s)
[109.318979] [137/171] (885s left) prime_self_import (basic-with_one_bo)
[109.374709] Starting subtest: basic-with_one_bo
[109.387551] Subtest basic-with_one_bo: SUCCESS (0.013s)
[109.407937] [138/171] (885s left) prime_self_import (basic-with_one_bo_two_files)
[109.455056] Starting subtest: basic-with_one_bo_two_files
[109.466565] Subtest basic-with_one_bo_two_files: SUCCESS (0.012s)
[109.503038] [139/171] (885s left) prime_self_import (basic-with_two_bos)
[109.551911] Starting subtest: basic-with_two_bos
[109.564470] Subtest basic-with_two_bos: SUCCESS (0.012s)
[109.606171] [140/171] (885s left) prime_vgem (basic-fence-flip)
[109.675749] Starting subtest: basic-fence-flip
[109.796902] Subtest basic-fence-flip: SKIP (0.120s)
[109.818876] [141/171] (884s left) prime_vgem (basic-fence-mmap)
[109.892217] Starting subtest: basic-fence-mmap
[109.893987] Subtest basic-fence-mmap: SKIP (0.000s)
[109.934785] [142/171] (884s left) prime_vgem (basic-fence-read)
[110.008069] Starting subtest: basic-fence-read
[110.014303] Subtest basic-fence-read: SKIP (0.006s)
[110.060919] [143/171] (884s left) prime_vgem (basic-gtt)
[110.138645] Starting subtest: basic-gtt
[110.140695] Subtest basic-gtt: SKIP (0.000s)
[110.181783] [144/171] (884s left) prime_vgem (basic-read)
[110.263778] Starting subtest: basic-read
[110.268591] Subtest basic-read: SKIP (0.004s)
[110.307699] [145/171] (884s left) prime_vgem (basic-write)
[110.375771] Starting subtest: basic-write
[110.380749] Subtest basic-write: SKIP (0.004s)
[110.425966] [146/171] (884s left) vgem_basic (setversion)
[110.477694] Starting subtest: setversion
[110.479458] Subtest setversion: SUCCESS (0.000s)
[110.493075] [147/171] (884s left) vgem_basic (create)
[110.544278] Starting subtest: create
[110.545121] Subtest create: SUCCESS (0.000s)
[110.560752] [148/171] (884s left) vgem_basic (debugfs)
[110.612275] Starting subtest: debugfs
[110.613164] Subtest debugfs: SUCCESS (0.000s)
[110.628252] [149/171] (884s left) vgem_basic (dmabuf-export)
[110.679629] Starting subtest: dmabuf-export
[110.708108] Subtest dmabuf-export: SUCCESS (0.029s)
[110.737763] [150/171] (884s left) vgem_basic (dmabuf-fence)
[110.789911] Starting subtest: dmabuf-fence
[110.790795] Subtest dmabuf-fence: SUCCESS (0.000s)
[110.806296] [151/171] (883s left) vgem_basic (dmabuf-fence-before)
[110.857073] Starting subtest: dmabuf-fence-before
[110.857994] Subtest dmabuf-fence-before: SUCCESS (0.000s)
[110.872933] [152/171] (883s left) vgem_basic (dmabuf-mmap)
[110.923733] Starting subtest: dmabuf-mmap
[110.931066] Subtest dmabuf-mmap: SUCCESS (0.009s)
[110.948130] [153/171] (883s left) vgem_basic (mmap)
[110.999013] Starting subtest: mmap
[111.002888] Subtest mmap: SUCCESS (0.005s)
[111.019951] [154/171] (883s left) vgem_basic (second-client)
[111.071051] Starting subtest: second-client
[111.077173] Subtest second-client: SUCCESS (0.006s)
[111.092940] [155/171] (883s left) vgem_basic (sysfs)
[111.144597] Starting subtest: sysfs
[111.145462] Subtest sysfs: SUCCESS (0.000s)
[111.160780] [156/171] (883s left) core_hotunplug (unbind-rebind)
[111.241920] Starting subtest: unbind-rebind
[113.188841] Subtest unbind-rebind: SUCCESS (1.946s)
[113.205477] [157/171] (881s left) vgem_basic (unload)
[113.260838] Starting subtest: unload
[142.162387] Subtest unload: SUCCESS (28.865s)
[142.180338] [158/171] (852s left) i915_module_load (reload)
[142.227907] Starting subtest: reload
[144.842274] Subtest reload: SUCCESS (2.615s)
[144.854150] [159/171] (850s left) gem_lmem_swapping (basic)
[147.807682] Starting subtest: basic
[147.808435] Starting dynamic subtest: lmem0
[167.035341] Dynamic subtest lmem0: SUCCESS (19.219s)
[167.036231] Subtest basic: SUCCESS (19.219s)
[169.428857] [160/171] (825s left) gem_lmem_swapping (parallel-random-engines)
[169.965163] Starting subtest: parallel-random-engines
[169.965944] Starting dynamic subtest: lmem0
[170.779054] Dynamic subtest lmem0: SUCCESS (0.814s)
[170.779883] Subtest parallel-random-engines: SUCCESS (0.814s)
[172.036372] [161/171] (822s left) gem_lmem_swapping (random-engines)
[172.541325] Starting subtest: random-engines
[172.542145] Starting dynamic subtest: lmem0
[173.289697] Dynamic subtest lmem0: SUCCESS (0.739s)
[173.290503] Subtest random-engines: SUCCESS (0.740s)
[174.569760] [162/171] (820s left) gem_lmem_swapping (verify-random)
[175.070265] Starting subtest: verify-random
[175.071064] Starting dynamic subtest: lmem0
[183.011940] Dynamic subtest lmem0: SUCCESS (7.907s)
[183.012903] Subtest verify-random: SUCCESS (7.908s)
[184.359811] [163/171] (810s left) i915_pm_rpm (module-reload)
[186.412257] Starting subtest: module-reload
[195.827687] Subtest module-reload: SUCCESS (9.406s)
[195.851312] [164/171] (799s left) i915_selftest (live)
[195.905272] Starting subtest: live
[195.906093] Starting dynamic subtest: sanitycheck
[197.306346] Dynamic subtest sanitycheck: SUCCESS (1.392s)
[197.312147] Starting dynamic subtest: uncore
[198.681356] Dynamic subtest uncore: SUCCESS (1.374s)
[198.686940] Starting dynamic subtest: workarounds
[203.051305] Dynamic subtest workarounds: SUCCESS (4.369s)
[203.056850] Starting dynamic subtest: gt_engines
[205.540379] Dynamic subtest gt_engines: SUCCESS (2.488s)
[205.546397] Starting dynamic subtest: gt_timelines
[233.234175] Dynamic subtest gt_timelines: SUCCESS (27.693s)
[233.239772] Starting dynamic subtest: gt_contexts
[234.678365] Dynamic subtest gt_contexts: SUCCESS (1.443s)
[234.683906] Starting dynamic subtest: gt_lrc
[242.717302] Dynamic subtest gt_lrc: SUCCESS (8.038s)
[242.722125] Starting dynamic subtest: gt_mocs
[246.454633] Dynamic subtest gt_mocs: SUCCESS (3.737s)
[246.461253] Starting dynamic subtest: gt_pm
[248.790298] Dynamic subtest gt_pm: SUCCESS (2.335s)
[248.795958] Starting dynamic subtest: gt_heartbeat
[250.397234] Dynamic subtest gt_heartbeat: SUCCESS (1.606s)
[250.402521] Starting dynamic subtest: gt_tlb
[262.615735] Dynamic subtest gt_tlb: SUCCESS (12.226s)
[262.621352] Starting dynamic subtest: requests
[280.411449] Dynamic subtest requests: SUCCESS (17.786s)
[280.417484] Starting dynamic subtest: migrate
[284.880211] Dynamic subtest migrate: SUCCESS (4.468s)
[284.886431] Starting dynamic subtest: active
[286.279247] Dynamic subtest active: SUCCESS (1.398s)
[286.284705] Starting dynamic subtest: objects
[288.555311] Dynamic subtest objects: SUCCESS (2.275s)
[288.561309] Starting dynamic subtest: mman
[297.084623] Dynamic subtest mman: SUCCESS (8.521s)
[297.093660] Starting dynamic subtest: dmabuf
[298.487767] Dynamic subtest dmabuf: SUCCESS (1.412s)
[298.492576] Starting dynamic subtest: vma
[299.895018] Dynamic subtest vma: SUCCESS (1.404s)
[299.899824] Starting dynamic subtest: coherency
[303.263337] Dynamic subtest coherency: SUCCESS (3.367s)
[303.269635] Starting dynamic subtest: gtt
[312.095372] Dynamic subtest gtt: SUCCESS (8.831s)
[312.101156] Starting dynamic subtest: gem
[313.517275] Dynamic subtest gem: SUCCESS (1.421s)
[313.522938] Starting dynamic subtest: evict
[317.041297] Dynamic subtest evict: SUCCESS (3.523s)
[317.046654] Starting dynamic subtest: hugepages
[334.738276] Dynamic subtest hugepages: SUCCESS (17.696s)
[334.743498] Starting dynamic subtest: gem_contexts
[375.893187] Dynamic subtest gem_contexts: SUCCESS (41.128s)
[375.898276] Starting dynamic subtest: client
[377.305211] Dynamic subtest client: SUCCESS (1.437s)
[377.310805] Starting dynamic subtest: gem_migrate
[382.007422] Dynamic subtest gem_migrate: SUCCESS (4.701s)
[382.012795] Starting dynamic subtest: reset
[383.484362] Dynamic subtest reset: SUCCESS (1.476s)
[383.490877] Starting dynamic subtest: memory_region
[386.398496] Dynamic subtest memory_region: SUCCESS (2.913s)
[386.403853] Starting dynamic subtest: hangcheck
[432.299258] Dynamic subtest hangcheck: SUCCESS (45.900s)
[432.305435] Starting dynamic subtest: execlists
[433.731280] Dynamic subtest execlists: SUCCESS (1.431s)
[433.737404] Starting dynamic subtest: ring_submission
[435.131174] Dynamic subtest ring_submission: SUCCESS (1.399s)
[435.135995] Starting dynamic subtest: perf
[436.630484] Dynamic subtest perf: SUCCESS (1.498s)
[436.637147] Starting dynamic subtest: slpc
[445.831294] Dynamic subtest slpc: SUCCESS (9.200s)
[445.837060] Starting dynamic subtest: guc
[448.472281] Dynamic subtest guc: SUCCESS (2.640s)
[448.477911] Starting dynamic subtest: guc_multi_lrc
[449.933310] Dynamic subtest guc_multi_lrc: SUCCESS (1.460s)
[449.938278] Starting dynamic subtest: guc_hang
[452.117367] Dynamic subtest guc_hang: SUCCESS (2.183s)
[452.122934] Starting dynamic subtest: late_gt_pm
[453.556402] Dynamic subtest late_gt_pm: SUCCESS (1.438s)
[453.557591] Subtest live: SUCCESS (257.643s)
[454.021597] [165/171] (540s left) dmabuf (all-tests)
[454.103231] Starting subtest: all-tests
[454.105739] Starting dynamic subtest: sanitycheck
[454.163612] Dynamic subtest sanitycheck: SUCCESS (0.060s)
[454.171185] Starting dynamic subtest: dma_fence
[454.346563] Dynamic subtest dma_fence: SUCCESS (0.182s)
[454.354986] Starting dynamic subtest: dma_fence_chain
[465.047511] Dynamic subtest dma_fence_chain: SUCCESS (10.699s)
[465.054337] Starting dynamic subtest: dma_fence_unwrap
[465.121241] Dynamic subtest dma_fence_unwrap: SUCCESS (0.073s)
[465.129704] Starting dynamic subtest: dma_resv
[465.195180] Dynamic subtest dma_resv: SUCCESS (0.072s)
[465.196897] Subtest all-tests: SUCCESS (11.093s)
[465.237495] [166/171] (529s left) i915_suspend (basic-s2idle-without-i915)
[465.327057] Starting subtest: basic-s2idle-without-i915
[485.464832] Subtest basic-s2idle-without-i915: SUCCESS (4.650s)
[485.500908] [167/171] (525s left) i915_suspend (basic-s3-without-i915)
[485.552648] Starting subtest: basic-s3-without-i915
[507.155309] Subtest basic-s3-without-i915: SUCCESS (5.705s)
[507.190248] [168/171] (519s left) gem_exec_suspend (basic-s0)
[507.271391] Starting subtest: basic-S0
[507.272221] Starting dynamic subtest: smem
[527.266114] Dynamic subtest smem: SUCCESS (4.720s)
[527.278143] Starting dynamic subtest: lmem0
[547.287705] Dynamic subtest lmem0: SUCCESS (4.880s)
[547.289068] Subtest basic-S0: SUCCESS (9.603s)
[547.458590] [169/171] (509s left) gem_exec_suspend (basic-s3)
[547.527597] Starting subtest: basic-S3
[547.528489] Starting dynamic subtest: smem
[568.558978] Dynamic subtest smem: SUCCESS (5.628s)
[568.570900] Starting dynamic subtest: lmem0
[589.570885] Dynamic subtest lmem0: SUCCESS (5.247s)
[589.572109] Subtest basic-S3: SUCCESS (10.878s)
[589.707396] [170/171] (498s left) kms_chamelium_hpd (common-hpd-after-suspend)
[589.908202] Subtest common-hpd-after-suspend: SKIP (0.000s)
[589.923615] [171/171] (498s left) kms_pipe_crc_basic (suspend-read-crc)
[590.121515] Subtest suspend-read-crc: SKIP (0.000s)
[590.132571] Closing watchdogs
Done.