[32.968495] Initializing watchdogs [32.968585] /dev/watchdog0 [32.982812] [FACT before any test] new: hardware.pci.gpu_at_addr.0000:00:02.0: 8086:591d Intel Kabylake (Gen9) HD Graphics P630 [32.992164] [001/162] (960s left) i915_module_load (load) [33.056580] Starting subtest: load [35.090331] Subtest load: SUCCESS (2.034s) [35.126590] [FACT i915_module_load (load)] new: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [35.127764] [FACT i915_module_load (load)] new: kernel.kmod_is_loaded.i915: true [35.132470] [002/162] (958s left) core_auth (basic-auth) [35.197389] Starting subtest: basic-auth [35.200732] Subtest basic-auth: SUCCESS (0.001s) [35.238027] [003/162] (958s left) core_debugfs (read-all-entries) [35.284291] Starting subtest: read-all-entries [35.287658] Subtest read-all-entries: SUCCESS (0.002s) [35.325944] [004/162] (958s left) core_sysfs (read-all-entries) [35.372145] Starting subtest: read-all-entries [35.375154] Subtest read-all-entries: SUCCESS (0.003s) [35.413110] [005/162] (958s left) fbdev (eof) [35.469173] Subtest eof: SKIP (0.000s) [35.507384] [006/162] (958s left) fbdev (info) [35.562238] Subtest info: SKIP (0.000s) [35.603442] [007/162] (958s left) fbdev (nullptr) [35.657628] Subtest nullptr: SKIP (0.000s) [35.698115] [008/162] (958s left) fbdev (read) [35.751636] Subtest read: SKIP (0.000s) [35.788758] [009/162] (958s left) fbdev (write) [35.843568] Subtest write: SKIP (0.000s) [35.881363] [010/162] (957s left) gem_basic (bad-close) [35.935071] Starting subtest: bad-close [35.941299] Subtest bad-close: SUCCESS (0.000s) [35.978383] [011/162] (957s left) gem_basic (create-close) [36.027713] Starting subtest: create-close [36.033880] Subtest create-close: SUCCESS (0.000s) [36.078294] [012/162] (957s left) gem_basic (create-fd-close) [36.123943] Starting subtest: create-fd-close [36.130415] Subtest create-fd-close: SUCCESS (0.000s) [36.182037] [013/162] (957s left) gem_busy (busy@all-engines) [36.241763] Starting subtest: busy [36.244814] Starting dynamic subtest: all-engines [36.269170] Dynamic subtest all-engines: SUCCESS (0.027s) [36.272243] Subtest busy: SUCCESS (0.028s) [36.581600] [014/162] (957s left) gem_close_race (basic-process) [36.638417] Starting subtest: basic-process [36.708066] Subtest basic-process: SUCCESS (0.069s) [36.860608] [015/162] (957s left) gem_close_race (basic-threads) [36.922251] Starting subtest: basic-threads [38.155744] Subtest basic-threads: SUCCESS (1.234s) [38.305285] [016/162] (955s left) gem_ctx_create (basic) [38.360583] Starting subtest: basic [38.363689] Subtest basic: SUCCESS (0.000s) [38.506515] [017/162] (955s left) gem_ctx_create (basic-files) [38.563127] Starting subtest: basic-files [40.573797] Subtest basic-files: SUCCESS (2.012s) [40.773499] [018/162] (953s left) gem_ctx_exec (basic) [40.827149] Starting subtest: basic [40.830178] Subtest basic: SUCCESS (0.004s) [40.909464] [019/162] (953s left) gem_exec_basic (basic) [40.959118] Starting subtest: basic [40.962159] Starting dynamic subtest: rcs0-smem [40.965189] Dynamic subtest rcs0-smem: SUCCESS (0.002s) [40.974912] Starting dynamic subtest: bcs0-smem [40.978327] Dynamic subtest bcs0-smem: SUCCESS (0.001s) [40.988155] Starting dynamic subtest: vcs0-smem [40.991513] Dynamic subtest vcs0-smem: SUCCESS (0.000s) [41.001096] Starting dynamic subtest: vecs0-smem [41.004327] Dynamic subtest vecs0-smem: SUCCESS (0.000s) [41.007612] Subtest basic: SUCCESS (0.005s) [41.131121] [020/162] (953s left) gem_exec_create (basic) [41.187155] Starting subtest: basic [41.190432] Starting dynamic subtest: smem [43.236395] Dynamic subtest smem: SUCCESS (2.049s) [43.239510] Subtest basic: SUCCESS (2.050s) [43.383827] [021/162] (950s left) gem_exec_fence (basic-busy) [43.554877] Starting subtest: basic-busy [43.557988] Starting dynamic subtest: rcs0 [43.593484] Dynamic subtest rcs0: SUCCESS (0.039s) [43.610845] Starting dynamic subtest: bcs0 [43.629385] Dynamic subtest bcs0: SUCCESS (0.035s) [43.640902] Starting dynamic subtest: vcs0 [43.659151] Dynamic subtest vcs0: SUCCESS (0.030s) [43.669669] Starting dynamic subtest: vecs0 [43.694127] Dynamic subtest vecs0: SUCCESS (0.035s) [43.697290] Subtest basic-busy: SUCCESS (0.141s) [44.215619] [FACT gem_exec_fence (basic-busy)] new: kernel.kmod_is_loaded.vgem: true [44.220520] [022/162] (950s left) gem_exec_fence (basic-wait) [44.389951] Starting subtest: basic-wait [44.393289] Starting dynamic subtest: rcs0 [44.419478] Dynamic subtest rcs0: SUCCESS (0.029s) [44.433937] Starting dynamic subtest: bcs0 [44.452346] Dynamic subtest bcs0: SUCCESS (0.032s) [44.467229] Starting dynamic subtest: vcs0 [44.478967] Dynamic subtest vcs0: SUCCESS (0.025s) [44.494150] Starting dynamic subtest: vecs0 [44.511578] Dynamic subtest vecs0: SUCCESS (0.032s) [44.514895] Subtest basic-wait: SUCCESS (0.122s) [45.004167] [023/162] (949s left) gem_exec_fence (basic-await) [45.287921] Starting subtest: basic-await [45.351702] Starting dynamic subtest: rcs0 [45.418500] Dynamic subtest rcs0: SUCCESS (0.092s) [45.484283] Starting dynamic subtest: bcs0 [45.549445] Dynamic subtest bcs0: SUCCESS (0.081s) [45.614284] Starting dynamic subtest: vcs0 [45.678934] Dynamic subtest vcs0: SUCCESS (0.093s) [45.743893] Starting dynamic subtest: vecs0 [45.808851] Dynamic subtest vecs0: SUCCESS (0.080s) [45.874136] Subtest basic-await: SUCCESS (0.348s) [46.426345] [024/162] (948s left) gem_exec_fence (nb-await) [46.719318] Starting subtest: nb-await [46.722580] Starting dynamic subtest: rcs0 [46.781556] Dynamic subtest rcs0: SUCCESS (0.061s) [46.802300] Starting dynamic subtest: bcs0 [46.847819] Dynamic subtest bcs0: SUCCESS (0.065s) [46.868835] Starting dynamic subtest: vcs0 [46.913163] Dynamic subtest vcs0: SUCCESS (0.064s) [46.934108] Starting dynamic subtest: vecs0 [46.977921] Dynamic subtest vecs0: SUCCESS (0.063s) [46.981773] Subtest nb-await: SUCCESS (0.256s) [47.471113] [025/162] (947s left) gem_exec_gttfill (basic) [47.528426] Starting subtest: basic [51.038062] Subtest basic: SUCCESS (3.482s) [51.201868] [026/162] (943s left) gem_exec_parallel (engines) [51.331167] Starting subtest: engines [51.334462] Starting dynamic subtest: basic [53.166621] Dynamic subtest basic: SUCCESS (1.826s) [53.177613] Starting dynamic subtest: contexts [55.172854] Dynamic subtest contexts: SUCCESS (1.998s) [55.183973] Starting dynamic subtest: fds [60.450155] Dynamic subtest fds: SUCCESS (5.263s) [60.461234] Starting dynamic subtest: userptr [62.544579] Dynamic subtest userptr: SUCCESS (2.092s) [62.547716] Subtest engines: SUCCESS (11.180s) [62.709839] [027/162] (932s left) gem_exec_store (basic) [62.773573] Starting subtest: basic [62.822567] Subtest basic: SUCCESS (0.052s) [62.979855] [028/162] (931s left) gem_flink_basic (bad-flink) [63.029861] Starting subtest: bad-flink [63.033161] Subtest bad-flink: SUCCESS (0.000s) [63.076104] [029/162] (931s left) gem_flink_basic (bad-open) [63.124165] Starting subtest: bad-open [63.127318] Subtest bad-open: SUCCESS (0.000s) [63.169922] [030/162] (931s left) gem_flink_basic (basic) [63.219186] Starting subtest: basic [63.222227] Subtest basic: SUCCESS (0.000s) [63.278000] [031/162] (931s left) gem_flink_basic (double-flink) [63.326187] Starting subtest: double-flink [63.329280] Subtest double-flink: SUCCESS (0.000s) [63.389622] [032/162] (931s left) gem_flink_basic (flink-lifetime) [63.436444] Starting subtest: flink-lifetime [63.439556] Subtest flink-lifetime: SUCCESS (0.001s) [63.495539] [033/162] (931s left) gem_huc_copy (huc-copy) [63.548805] Starting subtest: huc-copy [63.555166] Subtest huc-copy: SKIP (0.000s) [63.616344] [034/162] (931s left) gem_linear_blits (basic) [63.739623] Starting subtest: basic [63.743161] Subtest basic: SUCCESS (0.008s) [63.840666] [035/162] (931s left) gem_mmap (basic) [63.975464] Starting subtest: basic [63.991023] Subtest basic: SUCCESS (0.000s) [64.045051] [036/162] (931s left) gem_mmap_gtt (basic) [64.094885] Starting subtest: basic [64.098188] Subtest basic: SUCCESS (0.001s) [64.140146] [037/162] (931s left) gem_render_linear_blits (basic) [64.192216] Starting subtest: basic [64.217842] Subtest basic: SUCCESS (0.029s) [64.276033] [038/162] (931s left) gem_render_tiled_blits (basic) [64.329711] Starting subtest: basic [64.356495] Subtest basic: SUCCESS (0.030s) [64.415833] [039/162] (931s left) gem_ringfill (basic-all) [64.640712] Starting subtest: basic-all [65.773266] Subtest basic-all: SUCCESS (1.129s) [65.845037] [040/162] (929s left) gem_softpin (allocator-basic) [65.898160] Starting subtest: allocator-basic [65.997549] Subtest allocator-basic: SUCCESS (0.099s) [66.071857] [041/162] (929s left) gem_softpin (allocator-basic-reserve) [66.126232] Starting subtest: allocator-basic-reserve [66.217630] Subtest allocator-basic-reserve: SUCCESS (0.096s) [66.297684] [042/162] (929s left) gem_softpin (safe-alignment) [66.351387] Starting subtest: safe-alignment [66.360277] Subtest safe-alignment: SUCCESS (0.010s) [66.435501] [043/162] (929s left) gem_sync (basic-all) [66.522589] Starting subtest: basic-all [68.797720] Subtest basic-all: SUCCESS (2.302s) [68.947470] [044/162] (926s left) gem_sync (basic-each) [69.034172] Starting subtest: basic-each [71.100635] Subtest basic-each: SUCCESS (2.085s) [71.256041] [045/162] (924s left) gem_tiled_blits (basic) [71.363890] Starting subtest: basic [71.379569] Subtest basic: SUCCESS (0.015s) [71.492840] [046/162] (924s left) gem_tiled_fence_blits (basic) [71.668754] Starting subtest: basic [71.676953] Subtest basic: SUCCESS (0.007s) [71.768834] [047/162] (924s left) gem_tiled_pread_basic (basic) [71.897172] Starting subtest: basic [72.014604] Subtest basic: SUCCESS (0.124s) [72.083443] [048/162] (923s left) gem_wait (busy@all-engines) [72.147490] Starting subtest: busy [72.150535] Starting dynamic subtest: all-engines [72.665088] Dynamic subtest all-engines: SUCCESS (0.521s) [72.668053] Subtest busy: SUCCESS (0.521s) [72.828224] [049/162] (923s left) gem_wait (wait@all-engines) [72.887600] Starting subtest: wait [72.890784] Starting dynamic subtest: all-engines [73.935422] Dynamic subtest all-engines: SUCCESS (1.043s) [73.938747] Subtest wait: SUCCESS (1.043s) [74.112490] [050/162] (921s left) i915_getparams_basic (basic-eu-total) [74.162677] Starting subtest: basic-eu-total [74.168797] Subtest basic-eu-total: SUCCESS (0.000s) [74.213808] [051/162] (921s left) i915_getparams_basic (basic-subslice-total) [74.259176] Starting subtest: basic-subslice-total [74.265093] Subtest basic-subslice-total: SUCCESS (0.000s) [74.310100] [052/162] (921s left) i915_hangman (error-state-basic) [74.367476] Starting subtest: error-state-basic [74.375795] Subtest error-state-basic: SUCCESS (0.006s) [74.443915] [053/162] (921s left) i915_pciid [74.541969] [054/162] (921s left) intel_hwmon (hwmon-read) [74.594118] Subtest hwmon-read: SKIP (0.000s) [74.638263] [055/162] (921s left) intel_hwmon (hwmon-write) [74.693970] Subtest hwmon-write: SKIP (0.000s) [74.741923] [056/162] (921s left) kms_addfb_basic (addfb25-4-tiled) [74.838203] Starting subtest: addfb25-4-tiled [74.841310] Subtest addfb25-4-tiled: SUCCESS (0.000s) [74.896752] [057/162] (921s left) kms_addfb_basic (addfb25-bad-modifier) [74.977648] Starting subtest: addfb25-bad-modifier [74.980850] Subtest addfb25-bad-modifier: SUCCESS (0.000s) [75.040504] [058/162] (921s left) kms_addfb_basic (addfb25-framebuffer-vs-set-tiling) [75.121328] Starting subtest: addfb25-framebuffer-vs-set-tiling [75.124746] Subtest addfb25-framebuffer-vs-set-tiling: SUCCESS (0.000s) [75.181144] [059/162] (921s left) kms_addfb_basic (addfb25-modifier-no-flag) [75.258162] Starting subtest: addfb25-modifier-no-flag [75.261309] Subtest addfb25-modifier-no-flag: SUCCESS (0.000s) [75.328083] [060/162] (921s left) kms_addfb_basic (addfb25-x-tiled-legacy) [75.408131] Starting subtest: addfb25-x-tiled-legacy [75.411123] Subtest addfb25-x-tiled-legacy: SUCCESS (0.000s) [75.467692] [061/162] (921s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy) [75.548620] Starting subtest: addfb25-x-tiled-mismatch-legacy [75.551953] Subtest addfb25-x-tiled-mismatch-legacy: SUCCESS (0.000s) [75.617502] [062/162] (920s left) kms_addfb_basic (addfb25-yf-tiled-legacy) [75.697075] Starting subtest: addfb25-yf-tiled-legacy [75.700110] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.000s) [75.759579] [063/162] (920s left) kms_addfb_basic (addfb25-y-tiled-legacy) [75.840886] Starting subtest: addfb25-y-tiled-legacy [75.844069] Subtest addfb25-y-tiled-legacy: SUCCESS (0.000s) [75.909983] [064/162] (920s left) kms_addfb_basic (addfb25-y-tiled-small-legacy) [76.006163] Starting subtest: addfb25-y-tiled-small-legacy [76.009132] Subtest addfb25-y-tiled-small-legacy: SUCCESS (0.000s) [76.053144] [065/162] (920s left) kms_addfb_basic (bad-pitch-0) [76.108620] Starting subtest: bad-pitch-0 [76.111780] Subtest bad-pitch-0: SUCCESS (0.000s) [76.192783] [066/162] (920s left) kms_addfb_basic (bad-pitch-1024) [76.242978] Starting subtest: bad-pitch-1024 [76.247573] Subtest bad-pitch-1024: SUCCESS (0.000s) [76.334013] [067/162] (920s left) kms_addfb_basic (bad-pitch-128) [76.384411] Starting subtest: bad-pitch-128 [76.387971] Subtest bad-pitch-128: SUCCESS (0.000s) [76.476133] [068/162] (920s left) kms_addfb_basic (bad-pitch-256) [76.530028] Starting subtest: bad-pitch-256 [76.532932] Subtest bad-pitch-256: SUCCESS (0.000s) [76.618610] [069/162] (920s left) kms_addfb_basic (bad-pitch-32) [76.668645] Starting subtest: bad-pitch-32 [76.672790] Subtest bad-pitch-32: SUCCESS (0.000s) [76.749857] [070/162] (920s left) kms_addfb_basic (bad-pitch-63) [76.799243] Starting subtest: bad-pitch-63 [76.803109] Subtest bad-pitch-63: SUCCESS (0.000s) [76.879477] [071/162] (920s left) kms_addfb_basic (bad-pitch-65536) [76.932431] Starting subtest: bad-pitch-65536 [76.935428] Subtest bad-pitch-65536: SUCCESS (0.000s) [77.019341] [072/162] (919s left) kms_addfb_basic (bad-pitch-999) [77.068503] Starting subtest: bad-pitch-999 [77.073543] Subtest bad-pitch-999: SUCCESS (0.000s) [77.154505] [073/162] (919s left) kms_addfb_basic (basic) [77.202468] Starting subtest: basic [77.206859] Subtest basic: SUCCESS (0.000s) [77.293625] [074/162] (919s left) kms_addfb_basic (basic-x-tiled-legacy) [77.343760] Starting subtest: basic-x-tiled-legacy [77.347410] Subtest basic-x-tiled-legacy: SUCCESS (0.000s) [77.435464] [075/162] (919s left) kms_addfb_basic (basic-y-tiled-legacy) [77.484970] Starting subtest: basic-y-tiled-legacy [77.488850] Subtest basic-y-tiled-legacy: SUCCESS (0.000s) [77.579989] [076/162] (919s left) kms_addfb_basic (bo-too-small) [77.661510] Starting subtest: bo-too-small [77.664569] Subtest bo-too-small: SUCCESS (0.000s) [77.723510] [077/162] (919s left) kms_addfb_basic (bo-too-small-due-to-tiling) [77.803152] Starting subtest: bo-too-small-due-to-tiling [77.806336] Subtest bo-too-small-due-to-tiling: SUCCESS (0.000s) [77.863425] [078/162] (919s left) kms_addfb_basic (clobberred-modifier) [77.913846] Starting subtest: clobberred-modifier [77.917308] Subtest clobberred-modifier: SUCCESS (0.000s) [78.006293] [079/162] (919s left) kms_addfb_basic (framebuffer-vs-set-tiling) [78.056567] Starting subtest: framebuffer-vs-set-tiling [78.060684] Subtest framebuffer-vs-set-tiling: SUCCESS (0.000s) [78.147794] [080/162] (919s left) kms_addfb_basic (invalid-get-prop) [78.198477] Starting subtest: invalid-get-prop [78.201972] Subtest invalid-get-prop: SUCCESS (0.000s) [78.281347] [081/162] (919s left) kms_addfb_basic (invalid-get-prop-any) [78.329867] Starting subtest: invalid-get-prop-any [78.333208] Subtest invalid-get-prop-any: SUCCESS (0.000s) [78.419091] [082/162] (919s left) kms_addfb_basic (invalid-set-prop) [78.469428] Starting subtest: invalid-set-prop [78.473134] Subtest invalid-set-prop: SUCCESS (0.000s) [78.560893] [083/162] (918s left) kms_addfb_basic (invalid-set-prop-any) [78.610502] Starting subtest: invalid-set-prop-any [78.614086] Subtest invalid-set-prop-any: SUCCESS (0.000s) [78.695735] [084/162] (918s left) kms_addfb_basic (no-handle) [78.747258] Starting subtest: no-handle [78.750665] Subtest no-handle: SUCCESS (0.000s) [78.827209] [085/162] (918s left) kms_addfb_basic (size-max) [78.905194] Starting subtest: size-max [78.908194] Subtest size-max: SUCCESS (0.000s) [78.974889] [086/162] (918s left) kms_addfb_basic (small-bo) [79.055185] Starting subtest: small-bo [79.058158] Subtest small-bo: SUCCESS (0.000s) [79.117362] [087/162] (918s left) kms_addfb_basic (tile-pitch-mismatch) [79.166704] Starting subtest: tile-pitch-mismatch [79.171646] Subtest tile-pitch-mismatch: SUCCESS (0.000s) [79.257328] [088/162] (918s left) kms_addfb_basic (too-high) [79.336270] Starting subtest: too-high [79.339575] Subtest too-high: SUCCESS (0.001s) [79.390533] [089/162] (918s left) kms_addfb_basic (too-wide) [79.469638] Starting subtest: too-wide [79.472699] Subtest too-wide: SUCCESS (0.000s) [79.529523] [090/162] (918s left) kms_addfb_basic (unused-handle) [79.580911] Starting subtest: unused-handle [79.585728] Subtest unused-handle: SUCCESS (0.000s) [79.671974] [091/162] (918s left) kms_addfb_basic (unused-modifier) [79.728343] Starting subtest: unused-modifier [79.734402] Subtest unused-modifier: SUCCESS (0.000s) [79.810684] [092/162] (918s left) kms_addfb_basic (unused-offsets) [79.864195] Starting subtest: unused-offsets [79.867759] Subtest unused-offsets: SUCCESS (0.000s) [79.948376] [093/162] (917s left) kms_addfb_basic (unused-pitches) [80.000395] Starting subtest: unused-pitches [80.004505] Subtest unused-pitches: SUCCESS (0.000s) [80.086636] [094/162] (917s left) kms_busy (basic) [80.168121] Subtest basic: SKIP (0.000s) [80.210070] [095/162] (917s left) kms_prop_blob (basic) [80.260121] Starting subtest: basic [80.263189] Subtest basic: SUCCESS (0.000s) [80.305758] [096/162] (917s left) kms_cursor_legacy (basic-busy-flip-before-cursor-atomic) [80.405465] Subtest basic-busy-flip-before-cursor-atomic: SKIP (0.000s) [80.450595] [097/162] (917s left) kms_cursor_legacy (basic-busy-flip-before-cursor-legacy) [80.547890] Subtest basic-busy-flip-before-cursor-legacy: SKIP (0.000s) [80.592369] [098/162] (917s left) kms_cursor_legacy (basic-flip-after-cursor-atomic) [80.690388] Subtest basic-flip-after-cursor-atomic: SKIP (0.000s) [80.735761] [099/162] (917s left) kms_cursor_legacy (basic-flip-after-cursor-legacy) [80.835489] Subtest basic-flip-after-cursor-legacy: SKIP (0.000s) [80.880051] [100/162] (917s left) kms_cursor_legacy (basic-flip-after-cursor-varying-size) [80.980918] Subtest basic-flip-after-cursor-varying-size: SKIP (0.000s) [81.036166] [101/162] (917s left) kms_cursor_legacy (basic-flip-before-cursor-atomic) [81.138562] Subtest basic-flip-before-cursor-atomic: SKIP (0.000s) [81.184346] [102/162] (917s left) kms_cursor_legacy (basic-flip-before-cursor-legacy) [81.286620] Subtest basic-flip-before-cursor-legacy: SKIP (0.000s) [81.331526] [103/162] (917s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size) [81.429437] Subtest basic-flip-before-cursor-varying-size: SKIP (0.000s) [81.473710] [104/162] (916s left) kms_dsc (dsc-basic) [81.553484] Subtest dsc-basic: SKIP (0.000s) [81.594894] [105/162] (916s left) kms_flip (basic-flip-vs-dpms) [81.676986] Starting subtest: basic-flip-vs-dpms [81.683216] Subtest basic-flip-vs-dpms: SKIP (0.001s) [81.727825] [106/162] (916s left) kms_flip (basic-flip-vs-modeset) [81.811451] Starting subtest: basic-flip-vs-modeset [81.817779] Subtest basic-flip-vs-modeset: SKIP (0.001s) [81.860715] [107/162] (916s left) kms_flip (basic-flip-vs-wf_vblank) [81.942338] Starting subtest: basic-flip-vs-wf_vblank [81.948112] Subtest basic-flip-vs-wf_vblank: SKIP (0.001s) [81.991660] [108/162] (916s left) kms_flip (basic-plain-flip) [82.071353] Starting subtest: basic-plain-flip [82.077516] Subtest basic-plain-flip: SKIP (0.001s) [82.119414] [109/162] (916s left) kms_force_connector_basic (force-connector-state) [82.269543] Starting subtest: force-connector-state [82.346851] Subtest force-connector-state: SUCCESS (0.078s) [82.501483] [110/162] (916s left) kms_force_connector_basic (force-edid) [82.666494] Starting subtest: force-edid [82.839397] Subtest force-edid: SUCCESS (0.180s) [82.920146] [111/162] (915s left) kms_force_connector_basic (force-load-detect) [83.075152] Starting subtest: force-load-detect [83.081059] Subtest force-load-detect: SKIP (0.000s) [83.141379] [112/162] (915s left) kms_force_connector_basic (prune-stale-modes) [83.295695] Starting subtest: prune-stale-modes [83.466503] Subtest prune-stale-modes: SUCCESS (0.178s) [83.551035] [113/162] (915s left) kms_frontbuffer_tracking (basic) [83.632904] Subtest basic: SKIP (0.000s) [83.781480] [114/162] (915s left) kms_hdmi_inject (inject-audio) [84.164325] Starting subtest: inject-audio [84.387957] Subtest inject-audio: SKIP (0.000s) [84.966738] [115/162] (914s left) kms_pipe_crc_basic (compare-crc-sanitycheck-xr24) [85.235088] Subtest compare-crc-sanitycheck-xr24: SKIP (0.000s) [85.277773] [116/162] (914s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12) [85.358106] Subtest compare-crc-sanitycheck-nv12: SKIP (0.000s) [85.401891] [117/162] (914s left) kms_pipe_crc_basic (hang-read-crc) [85.483657] Subtest hang-read-crc: SKIP (0.000s) [85.526269] [118/162] (914s left) kms_pipe_crc_basic (nonblocking-crc) [85.612762] Subtest nonblocking-crc: SKIP (0.000s) [85.658882] [119/162] (914s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence) [85.738196] Subtest nonblocking-crc-frame-sequence: SKIP (0.000s) [85.781596] [120/162] (914s left) kms_pipe_crc_basic (read-crc) [85.859829] Subtest read-crc: SKIP (0.000s) [85.905813] [121/162] (914s left) kms_pipe_crc_basic (read-crc-frame-sequence) [85.987881] Subtest read-crc-frame-sequence: SKIP (0.000s) [86.032468] [122/162] (914s left) kms_pm_backlight (basic-brightness) [86.117186] Subtest basic-brightness: SKIP (0.000s) [86.160984] [123/162] (914s left) kms_pm_rpm (basic-pci-d3-state) [97.452340] Starting subtest: basic-pci-d3-state [97.635381] Subtest basic-pci-d3-state: SUCCESS (0.182s) [97.691180] [124/162] (902s left) kms_pm_rpm (basic-rte) [97.740760] Starting subtest: basic-rte [109.254590] Subtest basic-rte: SUCCESS (11.517s) [109.560424] [125/162] (890s left) kms_psr (psr-primary-page-flip) [109.647656] Subtest psr-primary-page-flip: SKIP (0.000s) [109.696254] [126/162] (890s left) kms_psr (psr-cursor-plane-move) [109.778189] Subtest psr-cursor-plane-move: SKIP (0.000s) [109.822599] [127/162] (890s left) kms_psr (psr-sprite-plane-onoff) [109.904956] Subtest psr-sprite-plane-onoff: SKIP (0.000s) [109.949661] [128/162] (890s left) kms_psr (psr-primary-mmap-gtt) [110.030508] Subtest psr-primary-mmap-gtt: SKIP (0.000s) [110.094062] [129/162] (890s left) kms_setmode (basic-clone-single-crtc) [110.148420] Starting subtest: basic-clone-single-crtc [110.159764] Subtest basic-clone-single-crtc: SKIP (0.000s) [110.242234] [130/162] (890s left) i915_pm_rps (basic-api) [110.296697] Starting subtest: basic-api [110.299839] Subtest basic-api: SUCCESS (0.003s) [110.386240] [131/162] (890s left) prime_self_import (basic-llseek-bad) [110.438822] Starting subtest: basic-llseek-bad [110.445179] Subtest basic-llseek-bad: SUCCESS (0.002s) [110.548612] [132/162] (890s left) prime_self_import (basic-llseek-size) [110.595484] Starting subtest: basic-llseek-size [110.601848] Subtest basic-llseek-size: SUCCESS (0.002s) [110.673922] [133/162] (890s left) prime_self_import (basic-with_fd_dup) [110.721388] Starting subtest: basic-with_fd_dup [110.727469] Subtest basic-with_fd_dup: SUCCESS (0.002s) [110.843366] [134/162] (890s left) prime_self_import (basic-with_one_bo) [110.893071] Starting subtest: basic-with_one_bo [110.899279] Subtest basic-with_one_bo: SUCCESS (0.002s) [110.943560] [135/162] (890s left) prime_self_import (basic-with_one_bo_two_files) [110.990154] Starting subtest: basic-with_one_bo_two_files [110.996460] Subtest basic-with_one_bo_two_files: SUCCESS (0.003s) [111.059815] [136/162] (889s left) prime_self_import (basic-with_two_bos) [111.103435] Starting subtest: basic-with_two_bos [111.109641] Subtest basic-with_two_bos: SUCCESS (0.003s) [111.176200] [137/162] (889s left) prime_vgem (basic-fence-flip) [111.233860] Starting subtest: basic-fence-flip [111.283899] Subtest basic-fence-flip: SKIP (0.052s) [111.331307] [138/162] (889s left) prime_vgem (basic-fence-mmap) [111.384983] Starting subtest: basic-fence-mmap [111.406730] Subtest basic-fence-mmap: SUCCESS (0.022s) [111.476050] [139/162] (889s left) prime_vgem (basic-fence-read) [111.528555] Starting subtest: basic-fence-read [111.572136] Subtest basic-fence-read: SUCCESS (0.044s) [111.624039] [140/162] (889s left) prime_vgem (basic-gtt) [111.679363] Starting subtest: basic-gtt [111.687130] Subtest basic-gtt: SUCCESS (0.011s) [111.755144] [141/162] (889s left) prime_vgem (basic-read) [111.811221] Starting subtest: basic-read [111.828936] Subtest basic-read: SUCCESS (0.022s) [111.912073] [142/162] (889s left) prime_vgem (basic-write) [111.963454] Starting subtest: basic-write [111.984926] Subtest basic-write: SUCCESS (0.022s) [112.036093] [143/162] (889s left) vgem_basic (setversion) [112.090726] Starting subtest: setversion [112.097146] Subtest setversion: SUCCESS (0.000s) [112.144361] [144/162] (889s left) vgem_basic (create) [112.194681] Starting subtest: create [112.198192] Subtest create: SUCCESS (0.000s) [112.249205] [145/162] (889s left) vgem_basic (debugfs) [112.304608] Starting subtest: debugfs [112.307911] Subtest debugfs: SUCCESS (0.000s) [112.359412] [146/162] (889s left) vgem_basic (dmabuf-export) [112.410691] Starting subtest: dmabuf-export [112.416927] Subtest dmabuf-export: SUCCESS (0.002s) [112.488758] [147/162] (889s left) vgem_basic (dmabuf-fence) [112.538174] Starting subtest: dmabuf-fence [112.541243] Subtest dmabuf-fence: SUCCESS (0.001s) [112.585286] [148/162] (889s left) vgem_basic (dmabuf-fence-before) [112.636518] Starting subtest: dmabuf-fence-before [112.639637] Subtest dmabuf-fence-before: SUCCESS (0.000s) [112.689688] [149/162] (889s left) vgem_basic (dmabuf-mmap) [112.740835] Starting subtest: dmabuf-mmap [112.743794] Subtest dmabuf-mmap: SUCCESS (0.008s) [112.787871] [150/162] (888s left) vgem_basic (mmap) [112.832816] Starting subtest: mmap [112.835801] Subtest mmap: SUCCESS (0.005s) [112.879882] [151/162] (888s left) vgem_basic (second-client) [112.931600] Starting subtest: second-client [112.937735] Subtest second-client: SUCCESS (0.002s) [112.985124] [152/162] (888s left) vgem_basic (sysfs) [113.037470] Starting subtest: sysfs [113.040620] Subtest sysfs: SUCCESS (0.001s) [113.087818] [153/162] (888s left) core_hotunplug (unbind-rebind) [113.195784] Starting subtest: unbind-rebind [116.627541] Subtest unbind-rebind: SUCCESS (3.432s) [116.673672] [154/162] (885s left) vgem_basic (unload) [116.720312] Starting subtest: unload [145.591956] Subtest unload: SUCCESS (28.870s) [145.654471] [155/162] (856s left) i915_module_load (reload) [145.706051] Starting subtest: reload [148.174240] Subtest reload: SUCCESS (2.472s) [148.216296] [156/162] (853s left) gem_lmem_swapping (basic) [148.277811] Subtest basic: SKIP (0.000s) [148.320383] [157/162] (853s left) gem_lmem_swapping (parallel-random-engines) [148.371642] Subtest parallel-random-engines: SKIP (0.000s) [148.414857] [158/162] (853s left) gem_lmem_swapping (random-engines) [148.467676] Subtest random-engines: SKIP (0.000s) [148.510132] [159/162] (853s left) gem_lmem_swapping (verify-random) [148.562050] Subtest verify-random: SKIP (0.000s) [148.604217] [160/162] (853s left) i915_pm_rpm (module-reload) [160.016795] Starting subtest: module-reload [187.735684] Subtest module-reload: SUCCESS (27.723s) [187.765883] [FACT i915_pm_rpm (module-reload)] deleted: hardware.pci.drm_card_at_addr.0000:00:02.0: card0 [187.767192] [FACT i915_pm_rpm (module-reload)] deleted: kernel.kmod_is_loaded.i915: true [187.771331] [161/162] (814s left) i915_selftest (live) [187.821463] Starting subtest: live [187.824676] Starting dynamic subtest: sanitycheck [189.950870] Dynamic subtest sanitycheck: SUCCESS (2.132s) [189.961753] Starting dynamic subtest: uncore [192.064390] Dynamic subtest uncore: SUCCESS (2.111s) [192.076224] Starting dynamic subtest: workarounds [194.348536] Dynamic subtest workarounds: SUCCESS (2.286s) [194.362937] Starting dynamic subtest: gt_engines [196.971637] Dynamic subtest gt_engines: SUCCESS (2.618s) [196.987719] Starting dynamic subtest: gt_timelines [205.825914] Dynamic subtest gt_timelines: SUCCESS (8.858s) [205.836832] Starting dynamic subtest: gt_contexts [208.060387] Dynamic subtest gt_contexts: SUCCESS (2.231s) [208.072267] Starting dynamic subtest: gt_lrc [212.619664] Dynamic subtest gt_lrc: SUCCESS (4.561s) [212.630646] Starting dynamic subtest: gt_mocs [214.851217] Dynamic subtest gt_mocs: SUCCESS (2.228s) [214.862099] Starting dynamic subtest: gt_pm [221.340568] Dynamic subtest gt_pm: SUCCESS (6.491s) [221.354590] Starting dynamic subtest: gt_heartbeat [223.459890] Dynamic subtest gt_heartbeat: SUCCESS (2.118s) [223.470709] Starting dynamic subtest: gt_tlb [226.798533] Dynamic subtest gt_tlb: SUCCESS (3.338s) [226.812828] Starting dynamic subtest: requests [235.114851] Dynamic subtest requests: SUCCESS (8.315s) [235.125617] Starting dynamic subtest: migrate [240.226266] Dynamic subtest migrate: SUCCESS (5.108s) [240.238266] Starting dynamic subtest: active [242.392141] Dynamic subtest active: SUCCESS (2.164s) [242.403018] Starting dynamic subtest: objects [245.060555] Dynamic subtest objects: SUCCESS (2.671s) [245.071328] Starting dynamic subtest: mman [250.368453] Dynamic subtest mman: SUCCESS (5.273s) [250.434089] Starting dynamic subtest: dmabuf [252.522545] Dynamic subtest dmabuf: SUCCESS (2.186s) [252.533349] Starting dynamic subtest: vma [254.662678] Dynamic subtest vma: SUCCESS (2.140s) [254.673304] Starting dynamic subtest: coherency [257.601442] Dynamic subtest coherency: SUCCESS (2.938s) [257.612734] Starting dynamic subtest: gtt [267.205998] Dynamic subtest gtt: SUCCESS (9.603s) [267.220849] Starting dynamic subtest: gem [269.512651] Dynamic subtest gem: SUCCESS (2.298s) [269.523178] Starting dynamic subtest: evict [272.797708] Dynamic subtest evict: SUCCESS (3.292s) [272.808612] Starting dynamic subtest: hugepages [281.360874] Dynamic subtest hugepages: SUCCESS (8.562s) [281.371968] Starting dynamic subtest: gem_contexts [296.131352] Dynamic subtest gem_contexts: SUCCESS (14.768s) [296.141968] Starting dynamic subtest: client [298.332977] Dynamic subtest client: SUCCESS (2.202s) [298.344159] Starting dynamic subtest: gem_migrate [300.460790] Dynamic subtest gem_migrate: SUCCESS (2.127s) [300.475727] Starting dynamic subtest: reset [302.808797] Dynamic subtest reset: SUCCESS (2.342s) [302.819701] Starting dynamic subtest: memory_region [305.001124] Dynamic subtest memory_region: SUCCESS (2.196s) [305.011894] Starting dynamic subtest: hangcheck [330.208891] Dynamic subtest hangcheck: SUCCESS (25.207s) [330.219899] Starting dynamic subtest: execlists [340.494089] Dynamic subtest execlists: SUCCESS (10.284s) [340.504939] Starting dynamic subtest: ring_submission [342.650192] Dynamic subtest ring_submission: SUCCESS (2.153s) [342.663182] Starting dynamic subtest: perf [344.861780] Dynamic subtest perf: SUCCESS (2.213s) [344.872759] Starting dynamic subtest: slpc [347.027988] Dynamic subtest slpc: SUCCESS (2.165s) [347.039209] Starting dynamic subtest: guc [349.138088] Dynamic subtest guc: SUCCESS (2.109s) [349.148889] Starting dynamic subtest: guc_multi_lrc [351.248791] Dynamic subtest guc_multi_lrc: SUCCESS (2.110s) [351.259884] Starting dynamic subtest: guc_hang [353.348585] Dynamic subtest guc_hang: SUCCESS (2.099s) [353.359450] Starting dynamic subtest: late_gt_pm [355.520617] Dynamic subtest late_gt_pm: SUCCESS (2.171s) [355.523575] Subtest live: SUCCESS (167.702s) [355.560883] [162/162] (646s left) dmabuf (all-tests) [355.620562] Starting subtest: all-tests [355.623441] Starting dynamic subtest: sanitycheck [355.684098] Dynamic subtest sanitycheck: SUCCESS (0.064s) [355.704328] Starting dynamic subtest: dma_fence [355.858556] Dynamic subtest dma_fence: SUCCESS (0.173s) [355.871793] Starting dynamic subtest: dma_fence_chain [366.568266] Dynamic subtest dma_fence_chain: SUCCESS (10.708s) [366.582650] Starting dynamic subtest: dma_fence_unwrap [366.630984] Dynamic subtest dma_fence_unwrap: SUCCESS (0.060s) [366.653370] Starting dynamic subtest: dma_resv [366.701948] Dynamic subtest dma_resv: SUCCESS (0.069s) [366.705590] Subtest all-tests: SUCCESS (11.084s) [366.737994] 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.