[23.350083] Initializing watchdogs
[23.350160]   /dev/watchdog0
[23.364386] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:591d Intel Kabylake (Gen9) HD Graphics P630
[23.371070] [001/162] (960s left) i915_module_load (load)
[23.799337] Starting subtest: load
[25.912590] Subtest load: FAIL (2.017s)
[25.944405] [FACT i915_module_load (load)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[25.945714] [FACT i915_module_load (load)] new: kernel.kmod_is_loaded.i915: true
[25.950314] [002/162] (957s left) core_auth (basic-auth)
[26.000437] Starting subtest: basic-auth
[26.003724] Subtest basic-auth: SUCCESS (0.001s)
[26.041088] [003/162] (957s left) core_debugfs (read-all-entries)
[26.085177] Starting subtest: read-all-entries
[26.088207] Subtest read-all-entries: SUCCESS (0.002s)
[26.128931] [004/162] (957s left) core_sysfs (read-all-entries)
[26.175148] Starting subtest: read-all-entries
[26.178198] Subtest read-all-entries: SUCCESS (0.003s)
[26.216071] [005/162] (957s left) fbdev (eof)
[26.269513] Subtest eof: SKIP (0.000s)
[26.306613] [006/162] (957s left) fbdev (info)
[26.360154] Subtest info: SKIP (0.000s)
[26.400650] [007/162] (957s left) fbdev (nullptr)
[26.460149] Subtest nullptr: SKIP (0.000s)
[26.496693] [008/162] (957s left) fbdev (read)
[26.546434] Subtest read: SKIP (0.000s)
[26.583265] [009/162] (957s left) fbdev (write)
[26.636182] Subtest write: SKIP (0.000s)
[26.672146] [010/162] (957s left) gem_basic (bad-close)
[26.719784] Starting subtest: bad-close
[26.726282] Subtest bad-close: SUCCESS (0.000s)
[26.763962] [011/162] (957s left) gem_basic (create-close)
[26.811593] Starting subtest: create-close
[26.817911] Subtest create-close: SUCCESS (0.000s)
[26.868979] [012/162] (957s left) gem_basic (create-fd-close)
[26.916548] Starting subtest: create-fd-close
[26.922773] Subtest create-fd-close: SUCCESS (0.000s)
[26.981321] [013/162] (957s left) gem_busy (busy@all-engines)
[27.038431] Starting subtest: busy
[27.041638] Starting dynamic subtest: all-engines
[27.340573] Dynamic subtest all-engines: FAIL (0.028s)
[27.344110] Subtest busy: FAIL (0.028s)
[27.730383] [014/162] (956s left) gem_close_race (basic-process)
[27.893979] Subtest basic-process: FAIL (0.000s)
[27.931781] [015/162] (956s left) gem_close_race (basic-threads)
[28.098843] Subtest basic-threads: FAIL (0.000s)
[28.137485] [016/162] (956s left) gem_ctx_create (basic)
[28.190189] Starting subtest: basic
[28.193179] Subtest basic: SUCCESS (0.000s)
[28.334840] [017/162] (956s left) gem_ctx_create (basic-files)
[28.388190] Starting subtest: basic-files
[30.402321] Subtest basic-files: SUCCESS (2.011s)
[30.598515] [018/162] (953s left) gem_ctx_exec (basic)
[30.652585] Starting subtest: basic
[30.656078] Subtest basic: SUCCESS (0.004s)
[30.727583] [019/162] (953s left) gem_exec_basic (basic)
[30.787115] Starting subtest: basic
[30.790131] Starting dynamic subtest: rcs0-smem
[30.793158] Dynamic subtest rcs0-smem: SUCCESS (0.002s)
[30.802871] Starting dynamic subtest: bcs0-smem
[30.805883] Dynamic subtest bcs0-smem: SUCCESS (0.001s)
[30.815645] Starting dynamic subtest: vcs0-smem
[30.818714] Dynamic subtest vcs0-smem: SUCCESS (0.000s)
[30.828241] Starting dynamic subtest: vecs0-smem
[30.831545] Dynamic subtest vecs0-smem: SUCCESS (0.000s)
[30.834789] Subtest basic: SUCCESS (0.006s)
[30.974290] [020/162] (953s left) gem_exec_create (basic)
[31.027952] Starting subtest: basic
[31.031068] Starting dynamic subtest: smem
[33.079407] Dynamic subtest smem: SUCCESS (2.051s)
[33.082664] Subtest basic: SUCCESS (2.052s)
[33.225073] [021/162] (951s left) gem_exec_fence (basic-busy)
[33.436667] Subtest basic-busy: FAIL (0.000s)
[33.475498] [022/162] (951s left) gem_exec_fence (basic-wait)
[33.646058] Subtest basic-wait: FAIL (0.000s)
[33.684388] [023/162] (951s left) gem_exec_fence (basic-await)
[33.858196] Subtest basic-await: FAIL (0.000s)
[33.895880] [024/162] (950s left) gem_exec_fence (nb-await)
[34.070328] Subtest nb-await: FAIL (0.000s)
[34.107151] [025/162] (950s left) gem_exec_gttfill (basic)
[34.162272] Starting subtest: basic
[34.251093] Subtest basic: FAIL (0.008s)
[34.312314] [026/162] (950s left) gem_exec_parallel (engines)
[34.365795] Starting subtest: engines
[34.369117] Starting dynamic subtest: basic
[34.453471] Dynamic subtest basic: FAIL (0.007s)
[34.463057] Starting dynamic subtest: contexts
[34.549466] Dynamic subtest contexts: FAIL (0.006s)
[34.558892] Starting dynamic subtest: fds
[34.644565] Dynamic subtest fds: FAIL (0.005s)
[34.654136] Starting dynamic subtest: userptr
[34.739108] Dynamic subtest userptr: FAIL (0.005s)
[34.742107] Subtest engines: FAIL (0.024s)
[34.779454] [027/162] (950s left) gem_exec_store (basic)
[34.837922] Starting subtest: basic
[34.918939] Subtest basic: FAIL (0.007s)
[34.986141] [028/162] (950s left) gem_flink_basic (bad-flink)
[35.037686] Starting subtest: bad-flink
[35.040761] Subtest bad-flink: SUCCESS (0.000s)
[35.078080] [029/162] (949s left) gem_flink_basic (bad-open)
[35.123903] Starting subtest: bad-open
[35.126982] Subtest bad-open: SUCCESS (0.000s)
[35.163764] [030/162] (949s left) gem_flink_basic (basic)
[35.211572] Starting subtest: basic
[35.214832] Subtest basic: SUCCESS (0.000s)
[35.318227] [031/162] (949s left) gem_flink_basic (double-flink)
[35.367728] Starting subtest: double-flink
[35.371084] Subtest double-flink: SUCCESS (0.000s)
[35.420884] [032/162] (949s left) gem_flink_basic (flink-lifetime)
[35.469465] Starting subtest: flink-lifetime
[35.472696] Subtest flink-lifetime: SUCCESS (0.001s)
[35.526252] [033/162] (949s left) gem_huc_copy (huc-copy)
[35.579014] Starting subtest: huc-copy
[35.585647] Subtest huc-copy: SKIP (0.000s)
[35.645418] [034/162] (949s left) gem_linear_blits (basic)
[35.826755] Subtest basic: FAIL (0.000s)
[35.865086] [035/162] (949s left) gem_mmap (basic)
[35.913640] Starting subtest: basic
[35.929363] Subtest basic: SUCCESS (0.000s)
[35.969940] [036/162] (949s left) gem_mmap_gtt (basic)
[36.024495] Starting subtest: basic
[36.027806] Subtest basic: SUCCESS (0.001s)
[36.066663] [037/162] (949s left) gem_render_linear_blits (basic)
[36.116912] Starting subtest: basic
[36.211497] Subtest basic: FAIL (0.008s)
[36.252582] [038/162] (949s left) gem_render_tiled_blits (basic)
[36.303377] Starting subtest: basic
[36.397655] Subtest basic: FAIL (0.008s)
[36.438346] [039/162] (949s left) gem_ringfill (basic-all)
[36.591658] Subtest basic-all: FAIL (0.000s)
[36.634103] [040/162] (948s left) gem_softpin (allocator-basic)
[36.796821] Subtest allocator-basic: FAIL (0.000s)
[36.834761] [041/162] (948s left) gem_softpin (allocator-basic-reserve)
[36.995857] Subtest allocator-basic-reserve: FAIL (0.000s)
[37.034066] [042/162] (948s left) gem_softpin (safe-alignment)
[37.192792] Subtest safe-alignment: FAIL (0.000s)
[37.230334] [043/162] (948s left) gem_sync (basic-all)
[37.396510] Subtest basic-all: FAIL (0.000s)
[37.433377] [044/162] (948s left) gem_sync (basic-each)
[37.604041] Subtest basic-each: FAIL (0.000s)
[37.642380] [045/162] (948s left) gem_tiled_blits (basic)
[37.828322] Subtest basic: FAIL (0.000s)
[37.866913] [046/162] (947s left) gem_tiled_fence_blits (basic)
[38.039875] Subtest basic: FAIL (0.000s)
[38.077372] [047/162] (947s left) gem_tiled_pread_basic (basic)
[38.125705] Starting subtest: basic
[38.242640] Subtest basic: SUCCESS (0.120s)
[38.294585] [048/162] (947s left) gem_wait (busy@all-engines)
[38.354844] Starting subtest: busy
[38.358030] Starting dynamic subtest: all-engines
[38.472579] Dynamic subtest all-engines: FAIL (0.010s)
[38.475639] Subtest busy: FAIL (0.010s)
[38.517095] [049/162] (947s left) gem_wait (wait@all-engines)
[38.574641] Starting subtest: wait
[38.577648] Starting dynamic subtest: all-engines
[38.692594] Dynamic subtest all-engines: FAIL (0.010s)
[38.697204] Subtest wait: FAIL (0.010s)
[38.736432] [050/162] (947s left) i915_getparams_basic (basic-eu-total)
[38.785583] Starting subtest: basic-eu-total
[38.791934] Subtest basic-eu-total: SUCCESS (0.000s)
[38.829145] [051/162] (947s left) i915_getparams_basic (basic-subslice-total)
[38.877036] Starting subtest: basic-subslice-total
[38.883761] Subtest basic-subslice-total: SUCCESS (0.000s)
[38.921160] [052/162] (947s left) i915_hangman (error-state-basic)
[38.975523] Starting subtest: error-state-basic
[38.981691] Subtest error-state-basic: SUCCESS (0.006s)
[39.043583] [053/162] (947s left) i915_pciid
[39.133149] [054/162] (946s left) intel_hwmon (hwmon-read)
[39.183603] Subtest hwmon-read: SKIP (0.000s)
[39.230840] [055/162] (946s left) intel_hwmon (hwmon-write)
[39.282842] Subtest hwmon-write: SKIP (0.000s)
[39.320935] [056/162] (946s left) kms_addfb_basic (addfb25-4-tiled)
[39.400202] Starting subtest: addfb25-4-tiled
[39.403114] Subtest addfb25-4-tiled: SUCCESS (0.000s)
[39.455032] [057/162] (946s left) kms_addfb_basic (addfb25-bad-modifier)
[39.533490] Starting subtest: addfb25-bad-modifier
[39.536584] Subtest addfb25-bad-modifier: SUCCESS (0.000s)
[39.590983] [058/162] (946s left) kms_addfb_basic (addfb25-framebuffer-vs-set-tiling)
[39.667941] Starting subtest: addfb25-framebuffer-vs-set-tiling
[39.671161] Subtest addfb25-framebuffer-vs-set-tiling: SUCCESS (0.000s)
[39.728684] [059/162] (946s left) kms_addfb_basic (addfb25-modifier-no-flag)
[39.807344] Starting subtest: addfb25-modifier-no-flag
[39.810615] Subtest addfb25-modifier-no-flag: SUCCESS (0.000s)
[39.870649] [060/162] (946s left) kms_addfb_basic (addfb25-x-tiled-legacy)
[39.951179] Starting subtest: addfb25-x-tiled-legacy
[39.954164] Subtest addfb25-x-tiled-legacy: SUCCESS (0.000s)
[40.006531] [061/162] (946s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy)
[40.089737] Starting subtest: addfb25-x-tiled-mismatch-legacy
[40.092806] Subtest addfb25-x-tiled-mismatch-legacy: SUCCESS (0.000s)
[40.151433] [062/162] (946s left) kms_addfb_basic (addfb25-yf-tiled-legacy)
[40.240151] Starting subtest: addfb25-yf-tiled-legacy
[40.243159] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.000s)
[40.422787] [063/162] (946s left) kms_addfb_basic (addfb25-y-tiled-legacy)
[40.803108] Starting subtest: addfb25-y-tiled-legacy
[40.866888] Subtest addfb25-y-tiled-legacy: SUCCESS (0.000s)
[41.278298] [064/162] (945s left) kms_addfb_basic (addfb25-y-tiled-small-legacy)
[41.717177] Starting subtest: addfb25-y-tiled-small-legacy
[41.721194] Subtest addfb25-y-tiled-small-legacy: SUCCESS (0.000s)
[41.760318] [065/162] (945s left) kms_addfb_basic (bad-pitch-0)
[41.810721] Starting subtest: bad-pitch-0
[41.814599] Subtest bad-pitch-0: SUCCESS (0.000s)
[41.887671] [066/162] (945s left) kms_addfb_basic (bad-pitch-1024)
[41.937056] Starting subtest: bad-pitch-1024
[41.940901] Subtest bad-pitch-1024: SUCCESS (0.000s)
[42.026843] [067/162] (945s left) kms_addfb_basic (bad-pitch-128)
[42.079135] Starting subtest: bad-pitch-128
[42.081907] Subtest bad-pitch-128: SUCCESS (0.000s)
[42.150954] [068/162] (945s left) kms_addfb_basic (bad-pitch-256)
[42.198617] Starting subtest: bad-pitch-256
[42.202520] Subtest bad-pitch-256: SUCCESS (0.000s)
[42.285751] [069/162] (944s left) kms_addfb_basic (bad-pitch-32)
[42.335966] Starting subtest: bad-pitch-32
[42.340739] Subtest bad-pitch-32: SUCCESS (0.000s)
[42.421887] [070/162] (944s left) kms_addfb_basic (bad-pitch-63)
[42.474054] Starting subtest: bad-pitch-63
[42.477261] Subtest bad-pitch-63: SUCCESS (0.000s)
[42.558265] [071/162] (944s left) kms_addfb_basic (bad-pitch-65536)
[42.608590] Starting subtest: bad-pitch-65536
[42.612588] Subtest bad-pitch-65536: SUCCESS (0.000s)
[42.690056] [072/162] (944s left) kms_addfb_basic (bad-pitch-999)
[42.738795] Starting subtest: bad-pitch-999
[42.742009] Subtest bad-pitch-999: SUCCESS (0.000s)
[42.823332] [073/162] (944s left) kms_addfb_basic (basic)
[42.876304] Starting subtest: basic
[42.879588] Subtest basic: SUCCESS (0.000s)
[42.957224] [074/162] (944s left) kms_addfb_basic (basic-x-tiled-legacy)
[43.010966] Starting subtest: basic-x-tiled-legacy
[43.013981] Subtest basic-x-tiled-legacy: SUCCESS (0.000s)
[43.089762] [075/162] (944s left) kms_addfb_basic (basic-y-tiled-legacy)
[43.140898] Starting subtest: basic-y-tiled-legacy
[43.144863] Subtest basic-y-tiled-legacy: SUCCESS (0.000s)
[43.227062] [076/162] (944s left) kms_addfb_basic (bo-too-small)
[43.312671] Starting subtest: bo-too-small
[43.315760] Subtest bo-too-small: SUCCESS (0.000s)
[43.368808] [077/162] (944s left) kms_addfb_basic (bo-too-small-due-to-tiling)
[43.448361] Starting subtest: bo-too-small-due-to-tiling
[43.451638] Subtest bo-too-small-due-to-tiling: SUCCESS (0.000s)
[43.504801] [078/162] (944s left) kms_addfb_basic (clobberred-modifier)
[43.554873] Starting subtest: clobberred-modifier
[43.558860] Subtest clobberred-modifier: SUCCESS (0.000s)
[43.643433] [079/162] (943s left) kms_addfb_basic (framebuffer-vs-set-tiling)
[43.696973] Starting subtest: framebuffer-vs-set-tiling
[43.700133] Subtest framebuffer-vs-set-tiling: SUCCESS (0.000s)
[43.783314] [080/162] (943s left) kms_addfb_basic (invalid-get-prop)
[43.832790] Starting subtest: invalid-get-prop
[43.836634] Subtest invalid-get-prop: SUCCESS (0.000s)
[43.914442] [081/162] (943s left) kms_addfb_basic (invalid-get-prop-any)
[43.966391] Starting subtest: invalid-get-prop-any
[43.969727] Subtest invalid-get-prop-any: SUCCESS (0.000s)
[44.058329] [082/162] (943s left) kms_addfb_basic (invalid-set-prop)
[44.109488] Starting subtest: invalid-set-prop
[44.113490] Subtest invalid-set-prop: SUCCESS (0.000s)
[44.200852] [083/162] (943s left) kms_addfb_basic (invalid-set-prop-any)
[44.254490] Starting subtest: invalid-set-prop-any
[44.257924] Subtest invalid-set-prop-any: SUCCESS (0.000s)
[44.343627] [084/162] (943s left) kms_addfb_basic (no-handle)
[44.392413] Starting subtest: no-handle
[44.396377] Subtest no-handle: SUCCESS (0.000s)
[44.476703] [085/162] (943s left) kms_addfb_basic (size-max)
[44.556346] Starting subtest: size-max
[44.559379] Subtest size-max: SUCCESS (0.000s)
[44.610749] [086/162] (943s left) kms_addfb_basic (small-bo)
[44.688704] Starting subtest: small-bo
[44.691977] Subtest small-bo: SUCCESS (0.000s)
[44.737794] [087/162] (943s left) kms_addfb_basic (tile-pitch-mismatch)
[44.788299] Starting subtest: tile-pitch-mismatch
[44.792178] Subtest tile-pitch-mismatch: SUCCESS (0.000s)
[44.876131] [088/162] (943s left) kms_addfb_basic (too-high)
[44.954387] Starting subtest: too-high
[44.957680] Subtest too-high: SUCCESS (0.001s)
[45.020983] [089/162] (942s left) kms_addfb_basic (too-wide)
[45.106254] Starting subtest: too-wide
[45.109355] Subtest too-wide: SUCCESS (0.000s)
[45.161926] [090/162] (942s left) kms_addfb_basic (unused-handle)
[45.212594] Starting subtest: unused-handle
[45.216504] Subtest unused-handle: SUCCESS (0.000s)
[45.295850] [091/162] (942s left) kms_addfb_basic (unused-modifier)
[45.344938] Starting subtest: unused-modifier
[45.348846] Subtest unused-modifier: SUCCESS (0.000s)
[45.429924] [092/162] (942s left) kms_addfb_basic (unused-offsets)
[45.480290] Starting subtest: unused-offsets
[45.483930] Subtest unused-offsets: SUCCESS (0.000s)
[45.568180] [093/162] (942s left) kms_addfb_basic (unused-pitches)
[45.620904] Starting subtest: unused-pitches
[45.623805] Subtest unused-pitches: SUCCESS (0.000s)
[45.688780] [094/162] (942s left) kms_busy (basic)
[45.769529] Subtest basic: SKIP (0.000s)
[45.807136] [095/162] (942s left) kms_prop_blob (basic)
[45.854959] Starting subtest: basic
[45.858140] Subtest basic: SUCCESS (0.000s)
[45.895938] [096/162] (942s left) kms_cursor_legacy (basic-busy-flip-before-cursor-atomic)
[45.993225] Subtest basic-busy-flip-before-cursor-atomic: SKIP (0.000s)
[46.034252] [097/162] (942s left) kms_cursor_legacy (basic-busy-flip-before-cursor-legacy)
[46.133797] Subtest basic-busy-flip-before-cursor-legacy: SKIP (0.000s)
[46.173781] [098/162] (942s left) kms_cursor_legacy (basic-flip-after-cursor-atomic)
[46.285738] Subtest basic-flip-after-cursor-atomic: SKIP (0.000s)
[46.463810] [099/162] (942s left) kms_cursor_legacy (basic-flip-after-cursor-legacy)
[47.293239] Subtest basic-flip-after-cursor-legacy: SKIP (0.000s)
[47.781065] [100/162] (941s left) kms_cursor_legacy (basic-flip-after-cursor-varying-size)
[47.877219] Subtest basic-flip-after-cursor-varying-size: SKIP (0.000s)
[47.919521] [101/162] (941s left) kms_cursor_legacy (basic-flip-before-cursor-atomic)
[48.020615] Subtest basic-flip-before-cursor-atomic: SKIP (0.000s)
[48.062536] [102/162] (940s left) kms_cursor_legacy (basic-flip-before-cursor-legacy)
[48.164558] Subtest basic-flip-before-cursor-legacy: SKIP (0.000s)
[48.204617] [103/162] (940s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size)
[48.306161] Subtest basic-flip-before-cursor-varying-size: SKIP (0.000s)
[48.346331] [104/162] (940s left) kms_dsc (dsc-basic)
[48.427475] Subtest dsc-basic: SKIP (0.000s)
[48.465080] [105/162] (940s left) kms_flip (basic-flip-vs-dpms)
[48.725462] Subtest basic-flip-vs-dpms: FAIL (0.000s)
[48.763085] [106/162] (940s left) kms_flip (basic-flip-vs-modeset)
[49.026828] Subtest basic-flip-vs-modeset: FAIL (0.000s)
[49.064438] [107/162] (940s left) kms_flip (basic-flip-vs-wf_vblank)
[49.330117] Subtest basic-flip-vs-wf_vblank: FAIL (0.000s)
[49.367191] [108/162] (939s left) kms_flip (basic-plain-flip)
[49.644870] Subtest basic-plain-flip: FAIL (0.000s)
[49.683334] [109/162] (939s left) kms_force_connector_basic (force-connector-state)
[49.828881] Starting subtest: force-connector-state
[49.905680] Subtest force-connector-state: SUCCESS (0.080s)
[50.055330] [110/162] (939s left) kms_force_connector_basic (force-edid)
[50.197022] Starting subtest: force-edid
[50.363912] Subtest force-edid: SUCCESS (0.168s)
[50.443252] [111/162] (938s left) kms_force_connector_basic (force-load-detect)
[50.591533] Starting subtest: force-load-detect
[50.599187] Subtest force-load-detect: SKIP (0.000s)
[50.657475] [112/162] (938s left) kms_force_connector_basic (prune-stale-modes)
[50.806934] Starting subtest: prune-stale-modes
[50.971041] Subtest prune-stale-modes: SUCCESS (0.162s)
[51.045624] [113/162] (938s left) kms_frontbuffer_tracking (basic)
[51.299936] Subtest basic: FAIL (0.000s)
[51.337944] [114/162] (938s left) kms_hdmi_inject (inject-audio)
[51.387832] Starting subtest: inject-audio
[51.394156] Subtest inject-audio: SKIP (0.000s)
[51.438990] [115/162] (938s left) kms_pipe_crc_basic (compare-crc-sanitycheck-xr24)
[51.520851] Subtest compare-crc-sanitycheck-xr24: SKIP (0.000s)
[51.559128] [116/162] (938s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12)
[51.639462] Subtest compare-crc-sanitycheck-nv12: SKIP (0.000s)
[51.681149] [117/162] (937s left) kms_pipe_crc_basic (hang-read-crc)
[51.759122] Subtest hang-read-crc: SKIP (0.000s)
[51.796725] [118/162] (937s left) kms_pipe_crc_basic (nonblocking-crc)
[51.875150] Subtest nonblocking-crc: SKIP (0.000s)
[51.913744] [119/162] (937s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence)
[51.993825] Subtest nonblocking-crc-frame-sequence: SKIP (0.000s)
[52.031875] [120/162] (937s left) kms_pipe_crc_basic (read-crc)
[52.124635] Subtest read-crc: SKIP (0.000s)
[52.163404] [121/162] (937s left) kms_pipe_crc_basic (read-crc-frame-sequence)
[52.241561] Subtest read-crc-frame-sequence: SKIP (0.000s)
[52.280462] [122/162] (937s left) kms_pm_backlight (basic-brightness)
[52.364159] Subtest basic-brightness: SKIP (0.000s)
[52.401795] [123/162] (937s left) kms_pm_rpm (basic-pci-d3-state)
[63.810305] Starting subtest: basic-pci-d3-state
[63.990799] Subtest basic-pci-d3-state: SUCCESS (0.179s)
[64.039353] [124/162] (925s left) kms_pm_rpm (basic-rte)
[64.089481] Starting subtest: basic-rte
[75.561306] Subtest basic-rte: SUCCESS (11.478s)
[75.866873] [125/162] (914s left) kms_psr (psr-primary-page-flip)
[76.020022] Subtest psr-primary-page-flip: FAIL (0.000s)
[76.058480] [126/162] (913s left) kms_psr (psr-cursor-plane-move)
[76.209819] Subtest psr-cursor-plane-move: FAIL (0.000s)
[76.249802] [127/162] (913s left) kms_psr (psr-sprite-plane-onoff)
[76.401082] Subtest psr-sprite-plane-onoff: FAIL (0.000s)
[76.440465] [128/162] (913s left) kms_psr (psr-primary-mmap-gtt)
[76.589617] Subtest psr-primary-mmap-gtt: FAIL (0.000s)
[76.630139] [129/162] (913s left) kms_setmode (basic-clone-single-crtc)
[76.679478] Starting subtest: basic-clone-single-crtc
[76.689162] Subtest basic-clone-single-crtc: SKIP (0.000s)
[76.733584] [130/162] (913s left) i915_pm_rps (basic-api)
[76.787257] Starting subtest: basic-api
[76.790431] Subtest basic-api: SUCCESS (0.003s)
[76.832170] [131/162] (913s left) prime_self_import (basic-llseek-bad)
[76.879709] Starting subtest: basic-llseek-bad
[76.885749] Subtest basic-llseek-bad: SUCCESS (0.002s)
[76.947653] [132/162] (913s left) prime_self_import (basic-llseek-size)
[76.993530] Starting subtest: basic-llseek-size
[76.999767] Subtest basic-llseek-size: SUCCESS (0.003s)
[77.054527] [133/162] (913s left) prime_self_import (basic-with_fd_dup)
[77.130190] Starting subtest: basic-with_fd_dup
[77.136161] Subtest basic-with_fd_dup: SUCCESS (0.003s)
[77.324579] [134/162] (913s left) prime_self_import (basic-with_one_bo)
[77.641620] Starting subtest: basic-with_one_bo
[77.769458] Subtest basic-with_one_bo: SUCCESS (0.004s)
[78.217020] [135/162] (912s left) prime_self_import (basic-with_one_bo_two_files)
[78.508852] Starting subtest: basic-with_one_bo_two_files
[78.617894] Subtest basic-with_one_bo_two_files: SUCCESS (0.003s)
[78.656862] [136/162] (912s left) prime_self_import (basic-with_two_bos)
[78.703143] Starting subtest: basic-with_two_bos
[78.709429] Subtest basic-with_two_bos: SUCCESS (0.004s)
[78.772853] [137/162] (912s left) prime_vgem (basic-fence-flip)
[78.860306] Starting subtest: basic-fence-flip
[78.922333] Subtest basic-fence-flip: SKIP (0.059s)
[78.963720] [FACT prime_vgem (basic-fence-flip)] new: kernel.kmod_is_loaded.vgem: true
[78.967860] [138/162] (912s left) prime_vgem (basic-fence-mmap)
[79.020909] Starting subtest: basic-fence-mmap
[79.040430] Subtest basic-fence-mmap: SUCCESS (0.019s)
[79.104923] [139/162] (911s left) prime_vgem (basic-fence-read)
[79.158375] Starting subtest: basic-fence-read
[79.198545] Subtest basic-fence-read: SUCCESS (0.043s)
[79.269512] [140/162] (911s left) prime_vgem (basic-gtt)
[79.322605] Starting subtest: basic-gtt
[79.329651] Subtest basic-gtt: SUCCESS (0.008s)
[79.406718] [141/162] (911s left) prime_vgem (basic-read)
[79.459163] Starting subtest: basic-read
[79.476912] Subtest basic-read: SUCCESS (0.020s)
[79.546959] [142/162] (911s left) prime_vgem (basic-write)
[79.601648] Starting subtest: basic-write
[79.619810] Subtest basic-write: SUCCESS (0.021s)
[79.687547] [143/162] (911s left) vgem_basic (setversion)
[79.737086] Starting subtest: setversion
[79.743153] Subtest setversion: SUCCESS (0.000s)
[79.790463] [144/162] (911s left) vgem_basic (create)
[79.843180] Starting subtest: create
[79.846146] Subtest create: SUCCESS (0.000s)
[79.895054] [145/162] (911s left) vgem_basic (debugfs)
[79.944942] Starting subtest: debugfs
[79.948165] Subtest debugfs: SUCCESS (0.000s)
[79.997349] [146/162] (911s left) vgem_basic (dmabuf-export)
[80.048700] Starting subtest: dmabuf-export
[80.055154] Subtest dmabuf-export: SUCCESS (0.002s)
[80.121517] [147/162] (911s left) vgem_basic (dmabuf-fence)
[80.175311] Starting subtest: dmabuf-fence
[80.178617] Subtest dmabuf-fence: SUCCESS (0.001s)
[80.227360] [148/162] (911s left) vgem_basic (dmabuf-fence-before)
[80.276433] Starting subtest: dmabuf-fence-before
[80.279669] Subtest dmabuf-fence-before: SUCCESS (0.000s)
[80.327493] [149/162] (911s left) vgem_basic (dmabuf-mmap)
[80.376863] Starting subtest: dmabuf-mmap
[80.383571] Subtest dmabuf-mmap: SUCCESS (0.008s)
[80.429719] [150/162] (911s left) vgem_basic (mmap)
[80.481229] Starting subtest: mmap
[80.485083] Subtest mmap: SUCCESS (0.006s)
[80.533237] [151/162] (911s left) vgem_basic (second-client)
[80.579540] Starting subtest: second-client
[80.585870] Subtest second-client: SUCCESS (0.002s)
[80.631782] [152/162] (911s left) vgem_basic (sysfs)
[80.684455] Starting subtest: sysfs
[80.687884] Subtest sysfs: SUCCESS (0.000s)
[80.735150] [153/162] (911s left) core_hotunplug (unbind-rebind)
[80.804133] Starting subtest: unbind-rebind
[84.188129] Subtest unbind-rebind: SUCCESS (3.386s)
[84.231543] [154/162] (907s left) vgem_basic (unload)
[84.277890] Starting subtest: unload
[113.133603] Subtest unload: SUCCESS (28.857s)
[113.195822] [155/162] (878s left) i915_module_load (reload)
[113.246235] Starting subtest: reload
[115.583518] Subtest reload: FAIL (2.233s)
[115.625876] [156/162] (876s left) gem_lmem_swapping (basic)
[115.685457] Subtest basic: SKIP (0.000s)
[115.727345] [157/162] (876s left) gem_lmem_swapping (parallel-random-engines)
[115.777901] Subtest parallel-random-engines: SKIP (0.000s)
[115.818910] [158/162] (876s left) gem_lmem_swapping (random-engines)
[115.870869] Subtest random-engines: SKIP (0.000s)
[115.915421] [159/162] (876s left) gem_lmem_swapping (verify-random)
[115.965502] Subtest verify-random: SKIP (0.000s)
[116.010493] [160/162] (876s left) i915_pm_rpm (module-reload)
[127.430090] Starting subtest: module-reload
[155.074887] Subtest module-reload: SUCCESS (27.640s)
[155.105118] [FACT i915_pm_rpm (module-reload)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0
[155.106250] [FACT i915_pm_rpm (module-reload)] deleted: kernel.kmod_is_loaded.i915: true
[155.110572] [161/162] (837s left) i915_selftest (live)
[155.162713] Starting subtest: live
[155.165832] Starting dynamic subtest: sanitycheck
[157.213843] Dynamic subtest sanitycheck: SUCCESS (2.053s)
[157.223773] Starting dynamic subtest: uncore
[159.275277] Dynamic subtest uncore: SUCCESS (2.024s)
[159.338885] Starting dynamic subtest: workarounds
[161.478687] Dynamic subtest workarounds: SUCCESS (2.238s)
[161.488531] Starting dynamic subtest: gt_engines
[163.944225] Dynamic subtest gt_engines: SUCCESS (2.461s)
[163.956347] Starting dynamic subtest: gt_timelines
[172.559232] Dynamic subtest gt_timelines: SUCCESS (8.611s)
[172.570292] Starting dynamic subtest: gt_contexts
[174.740784] Dynamic subtest gt_contexts: SUCCESS (2.183s)
[174.750862] Starting dynamic subtest: gt_lrc
[179.219308] Dynamic subtest gt_lrc: SUCCESS (4.474s)
[179.229468] Starting dynamic subtest: gt_mocs
[181.366321] Dynamic subtest gt_mocs: SUCCESS (2.146s)
[181.380265] Starting dynamic subtest: gt_pm
[187.750425] Dynamic subtest gt_pm: SUCCESS (6.382s)
[187.760804] Starting dynamic subtest: gt_heartbeat
[189.805870] Dynamic subtest gt_heartbeat: SUCCESS (2.053s)
[189.816523] Starting dynamic subtest: gt_tlb
[193.032673] Dynamic subtest gt_tlb: SUCCESS (3.230s)
[193.043182] Starting dynamic subtest: requests
[201.284321] Dynamic subtest requests: SUCCESS (8.247s)
[201.295313] Starting dynamic subtest: migrate
[206.462154] Dynamic subtest migrate: SUCCESS (5.178s)
[206.475700] Starting dynamic subtest: active
[208.528832] Dynamic subtest active: SUCCESS (2.066s)
[208.539475] Starting dynamic subtest: objects
[211.099329] Dynamic subtest objects: SUCCESS (2.567s)
[211.111357] Starting dynamic subtest: mman
[216.253249] Dynamic subtest mman: SUCCESS (5.152s)
[216.265349] Starting dynamic subtest: dmabuf
[218.361558] Dynamic subtest dmabuf: SUCCESS (2.105s)
[218.371574] Starting dynamic subtest: vma
[220.401597] Dynamic subtest vma: SUCCESS (2.044s)
[220.411583] Starting dynamic subtest: coherency
[223.197913] Dynamic subtest coherency: SUCCESS (2.795s)
[223.208224] Starting dynamic subtest: gtt
[232.610448] Dynamic subtest gtt: SUCCESS (9.408s)
[232.622394] Starting dynamic subtest: gem
[234.840639] Dynamic subtest gem: SUCCESS (2.232s)
[234.850888] Starting dynamic subtest: evict
[238.023850] Dynamic subtest evict: SUCCESS (3.182s)
[238.037547] Starting dynamic subtest: hugepages
[246.487851] Dynamic subtest hugepages: SUCCESS (8.462s)
[246.498281] Starting dynamic subtest: gem_contexts
[261.092883] Dynamic subtest gem_contexts: SUCCESS (14.603s)
[261.103299] Starting dynamic subtest: client
[263.216920] Dynamic subtest client: SUCCESS (2.118s)
[263.229885] Starting dynamic subtest: gem_migrate
[265.307237] Dynamic subtest gem_migrate: SUCCESS (2.090s)
[265.319672] Starting dynamic subtest: reset
[267.677391] Dynamic subtest reset: SUCCESS (2.370s)
[267.689330] Starting dynamic subtest: memory_region
[269.777788] Dynamic subtest memory_region: SUCCESS (2.101s)
[269.793771] Starting dynamic subtest: hangcheck
[294.878842] Dynamic subtest hangcheck: SUCCESS (25.100s)
[294.889414] Starting dynamic subtest: execlists
[305.096191] Dynamic subtest execlists: SUCCESS (10.216s)
[305.106720] Starting dynamic subtest: ring_submission
[307.211438] Dynamic subtest ring_submission: SUCCESS (2.106s)
[307.229984] Starting dynamic subtest: perf
[309.341299] Dynamic subtest perf: SUCCESS (2.128s)
[309.351398] Starting dynamic subtest: slpc
[311.381497] Dynamic subtest slpc: SUCCESS (2.038s)
[311.391452] Starting dynamic subtest: guc
[313.506347] Dynamic subtest guc: SUCCESS (2.083s)
[313.576931] Starting dynamic subtest: guc_multi_lrc
[315.475471] Dynamic subtest guc_multi_lrc: SUCCESS (2.015s)
[315.487364] Starting dynamic subtest: guc_hang
[317.502675] Dynamic subtest guc_hang: SUCCESS (2.029s)
[317.513110] Starting dynamic subtest: late_gt_pm
[319.612173] Dynamic subtest late_gt_pm: SUCCESS (2.099s)
[319.615569] Subtest live: SUCCESS (164.415s)
[319.651717] [162/162] (672s left) dmabuf (all-tests)
[319.709836] Starting subtest: all-tests
[319.713952] Starting dynamic subtest: sanitycheck
[319.768138] Dynamic subtest sanitycheck: SUCCESS (0.058s)
[319.790085] Starting dynamic subtest: dma_fence
[319.939544] Dynamic subtest dma_fence: SUCCESS (0.170s)
[319.952377] Starting dynamic subtest: dma_fence_chain
[331.030206] Dynamic subtest dma_fence_chain: SUCCESS (11.088s)
[331.044701] Starting dynamic subtest: dma_fence_unwrap
[331.096875] Dynamic subtest dma_fence_unwrap: SUCCESS (0.065s)
[331.117904] Starting dynamic subtest: dma_resv
[331.170064] Dynamic subtest dma_resv: SUCCESS (0.071s)
[331.173533] Subtest all-tests: SUCCESS (11.461s)
[331.206224] Closing watchdogs
results: parsing output: 0/ for test: i915_module_load
results: parsing output: 1/ for test: core_auth
results: parsing output: 2/ for test: core_debugfs
results: parsing output: 3/ for test: core_sysfs
results: parsing output: 4/ for test: fbdev
results: parsing output: 5/ for test: fbdev
results: parsing output: 6/ for test: fbdev
results: parsing output: 7/ for test: fbdev
results: parsing output: 8/ for test: fbdev
results: parsing output: 9/ for test: gem_basic
results: parsing output: 10/ for test: gem_basic
results: parsing output: 11/ for test: gem_basic
results: parsing output: 12/ for test: gem_busy
results: parsing output: 13/ for test: gem_close_race
results: parsing output: 14/ for test: gem_close_race
results: parsing output: 15/ for test: gem_ctx_create
results: parsing output: 16/ for test: gem_ctx_create
results: parsing output: 17/ for test: gem_ctx_exec
results: parsing output: 18/ for test: gem_exec_basic
results: parsing output: 19/ for test: gem_exec_create
results: parsing output: 20/ for test: gem_exec_fence
results: parsing output: 21/ for test: gem_exec_fence
results: parsing output: 22/ for test: gem_exec_fence
results: parsing output: 23/ for test: gem_exec_fence
results: parsing output: 24/ for test: gem_exec_gttfill
results: parsing output: 25/ for test: gem_exec_parallel
results: parsing output: 26/ for test: gem_exec_store
results: parsing output: 27/ for test: gem_flink_basic
results: parsing output: 28/ for test: gem_flink_basic
results: parsing output: 29/ for test: gem_flink_basic
results: parsing output: 30/ for test: gem_flink_basic
results: parsing output: 31/ for test: gem_flink_basic
results: parsing output: 32/ for test: gem_huc_copy
results: parsing output: 33/ for test: gem_linear_blits
results: parsing output: 34/ for test: gem_mmap
results: parsing output: 35/ for test: gem_mmap_gtt
results: parsing output: 36/ for test: gem_render_linear_blits
results: parsing output: 37/ for test: gem_render_tiled_blits
results: parsing output: 38/ for test: gem_ringfill
results: parsing output: 39/ for test: gem_softpin
results: parsing output: 40/ for test: gem_softpin
results: parsing output: 41/ for test: gem_softpin
results: parsing output: 42/ for test: gem_sync
results: parsing output: 43/ for test: gem_sync
results: parsing output: 44/ for test: gem_tiled_blits
results: parsing output: 45/ for test: gem_tiled_fence_blits
results: parsing output: 46/ for test: gem_tiled_pread_basic
results: parsing output: 47/ for test: gem_wait
results: parsing output: 48/ for test: gem_wait
results: parsing output: 49/ for test: i915_getparams_basic
results: parsing output: 50/ for test: i915_getparams_basic
results: parsing output: 51/ for test: i915_hangman
results: parsing output: 52/ for test: i915_pciid
results: parsing output: 53/ for test: intel_hwmon
results: parsing output: 54/ for test: intel_hwmon
results: parsing output: 55/ for test: kms_addfb_basic
results: parsing output: 56/ for test: kms_addfb_basic
results: parsing output: 57/ for test: kms_addfb_basic
results: parsing output: 58/ for test: kms_addfb_basic
results: parsing output: 59/ for test: kms_addfb_basic
results: parsing output: 60/ for test: kms_addfb_basic
results: parsing output: 61/ for test: kms_addfb_basic
results: parsing output: 62/ for test: kms_addfb_basic
results: parsing output: 63/ for test: kms_addfb_basic
results: parsing output: 64/ for test: kms_addfb_basic
results: parsing output: 65/ for test: kms_addfb_basic
results: parsing output: 66/ for test: kms_addfb_basic
results: parsing output: 67/ for test: kms_addfb_basic
results: parsing output: 68/ for test: kms_addfb_basic
results: parsing output: 69/ for test: kms_addfb_basic
results: parsing output: 70/ for test: kms_addfb_basic
results: parsing output: 71/ for test: kms_addfb_basic
results: parsing output: 72/ for test: kms_addfb_basic
results: parsing output: 73/ for test: kms_addfb_basic
results: parsing output: 74/ for test: kms_addfb_basic
results: parsing output: 75/ for test: kms_addfb_basic
results: parsing output: 76/ for test: kms_addfb_basic
results: parsing output: 77/ for test: kms_addfb_basic
results: parsing output: 78/ for test: kms_addfb_basic
results: parsing output: 79/ for test: kms_addfb_basic
results: parsing output: 80/ for test: kms_addfb_basic
results: parsing output: 81/ for test: kms_addfb_basic
results: parsing output: 82/ for test: kms_addfb_basic
results: parsing output: 83/ for test: kms_addfb_basic
results: parsing output: 84/ for test: kms_addfb_basic
results: parsing output: 85/ for test: kms_addfb_basic
results: parsing output: 86/ for test: kms_addfb_basic
results: parsing output: 87/ for test: kms_addfb_basic
results: parsing output: 88/ for test: kms_addfb_basic
results: parsing output: 89/ for test: kms_addfb_basic
results: parsing output: 90/ for test: kms_addfb_basic
results: parsing output: 91/ for test: kms_addfb_basic
results: parsing output: 92/ for test: kms_addfb_basic
results: parsing output: 93/ for test: kms_busy
results: parsing output: 94/ for test: kms_prop_blob
results: parsing output: 95/ for test: kms_cursor_legacy
results: parsing output: 96/ for test: kms_cursor_legacy
results: parsing output: 97/ for test: kms_cursor_legacy
results: parsing output: 98/ for test: kms_cursor_legacy
results: parsing output: 99/ for test: kms_cursor_legacy
results: parsing output: 100/ for test: kms_cursor_legacy
results: parsing output: 101/ for test: kms_cursor_legacy
results: parsing output: 102/ for test: kms_cursor_legacy
results: parsing output: 103/ for test: kms_dsc
results: parsing output: 104/ for test: kms_flip
results: parsing output: 105/ for test: kms_flip
results: parsing output: 106/ for test: kms_flip
results: parsing output: 107/ for test: kms_flip
results: parsing output: 108/ for test: kms_force_connector_basic
results: parsing output: 109/ for test: kms_force_connector_basic
results: parsing output: 110/ for test: kms_force_connector_basic
results: parsing output: 111/ for test: kms_force_connector_basic
results: parsing output: 112/ for test: kms_frontbuffer_tracking
results: parsing output: 113/ for test: kms_hdmi_inject
results: parsing output: 114/ for test: kms_pipe_crc_basic
results: parsing output: 115/ for test: kms_pipe_crc_basic
results: parsing output: 116/ for test: kms_pipe_crc_basic
results: parsing output: 117/ for test: kms_pipe_crc_basic
results: parsing output: 118/ for test: kms_pipe_crc_basic
results: parsing output: 119/ for test: kms_pipe_crc_basic
results: parsing output: 120/ for test: kms_pipe_crc_basic
results: parsing output: 121/ for test: kms_pm_backlight
results: parsing output: 122/ for test: kms_pm_rpm
results: parsing output: 123/ for test: kms_pm_rpm
results: parsing output: 124/ for test: kms_psr
results: parsing output: 125/ for test: kms_psr
results: parsing output: 126/ for test: kms_psr
results: parsing output: 127/ for test: kms_psr
results: parsing output: 128/ for test: kms_setmode
results: parsing output: 129/ for test: i915_pm_rps
results: parsing output: 130/ for test: prime_self_import
results: parsing output: 131/ for test: prime_self_import
results: parsing output: 132/ for test: prime_self_import
results: parsing output: 133/ for test: prime_self_import
results: parsing output: 134/ for test: prime_self_import
results: parsing output: 135/ for test: prime_self_import
results: parsing output: 136/ for test: prime_vgem
results: parsing output: 137/ for test: prime_vgem
results: parsing output: 138/ for test: prime_vgem
results: parsing output: 139/ for test: prime_vgem
results: parsing output: 140/ for test: prime_vgem
results: parsing output: 141/ for test: prime_vgem
results: parsing output: 142/ for test: vgem_basic
results: parsing output: 143/ for test: vgem_basic
results: parsing output: 144/ for test: vgem_basic
results: parsing output: 145/ for test: vgem_basic
results: parsing output: 146/ for test: vgem_basic
results: parsing output: 147/ for test: vgem_basic
results: parsing output: 148/ for test: vgem_basic
results: parsing output: 149/ for test: vgem_basic
results: parsing output: 150/ for test: vgem_basic
results: parsing output: 151/ for test: vgem_basic
results: parsing output: 152/ for test: core_hotunplug
results: parsing output: 153/ for test: vgem_basic
results: parsing output: 154/ for test: i915_module_load
results: parsing output: 155/ for test: gem_lmem_swapping
results: parsing output: 156/ for test: gem_lmem_swapping
results: parsing output: 157/ for test: gem_lmem_swapping
results: parsing output: 158/ for test: gem_lmem_swapping
results: parsing output: 159/ for test: i915_pm_rpm
results: parsing output: 160/ for test: i915_selftest
results: parsing output: 161/ for test: dmabuf
Done.