[35.985887] Initializing watchdogs [35.985984] /dev/watchdog0 [35.998639] [001/160] (960s left) i915_module_load (load) [36.081887] Starting subtest: load [39.088179] Subtest load: SUCCESS (3.013s) [39.114930] [002/160] (957s left) core_auth (basic-auth) [40.665287] Starting subtest: basic-auth [40.672266] Subtest basic-auth: SUCCESS (0.001s) [40.753618] [003/160] (955s left) debugfs_test (read_all_entries) [40.849929] Starting subtest: read_all_entries [41.206711] Subtest read_all_entries: SUCCESS (0.356s) [41.297049] [004/160] (955s left) debugfs_test (basic-hwmon) [41.400952] Starting subtest: basic-hwmon [41.415725] Subtest basic-hwmon: SKIP (0.000s) [41.505211] [005/160] (955s left) fbdev (eof) [41.595781] Starting subtest: eof [41.603023] Subtest eof: SUCCESS (0.000s) [41.656741] [006/160] (954s left) fbdev (info) [41.737391] Starting subtest: info [41.744479] Subtest info: SUCCESS (0.000s) [41.806166] [007/160] (954s left) fbdev (nullptr) [41.884919] Starting subtest: nullptr [41.892255] Subtest nullptr: SUCCESS (0.000s) [41.939573] [008/160] (954s left) fbdev (read) [42.027850] Starting subtest: read [43.070768] Subtest read: SUCCESS (1.033s) [43.134681] [009/160] (953s left) fbdev (write) [43.220376] Starting subtest: write [43.938596] Subtest write: SUCCESS (0.709s) [44.004369] [010/160] (952s left) gem_basic (bad-close) [44.093080] Starting subtest: bad-close [44.106966] Subtest bad-close: SUCCESS (0.000s) [44.190594] [011/160] (952s left) gem_basic (create-close) [44.286122] Starting subtest: create-close [44.299338] Subtest create-close: SUCCESS (0.000s) [44.372683] [012/160] (952s left) gem_basic (create-fd-close) [44.461061] Starting subtest: create-fd-close [44.475930] Subtest create-fd-close: SUCCESS (0.000s) [44.549610] [013/160] (952s left) gem_busy (busy@all-engines) [44.650226] Starting subtest: busy [44.657027] Starting dynamic subtest: all-engines [44.774604] Dynamic subtest all-engines: SUCCESS (0.123s) [44.781835] Subtest busy: SUCCESS (0.123s) [46.748973] [014/160] (950s left) gem_close_race (basic-process) [46.865959] Starting subtest: basic-process [46.916378] Subtest basic-process: SUCCESS (0.048s) [47.112213] [015/160] (949s left) gem_close_race (basic-threads) [47.229177] Starting subtest: basic-threads [48.545162] Subtest basic-threads: SUCCESS (1.316s) [48.748302] [016/160] (948s left) gem_ctx_create (basic) [48.849533] Starting subtest: basic [48.856241] Subtest basic: SUCCESS (0.000s) [49.044899] [017/160] (947s left) gem_ctx_create (basic-files) [49.146478] Starting subtest: basic-files [51.170849] Subtest basic-files: SUCCESS (2.025s) [52.764099] [018/160] (944s left) gem_ctx_exec (basic) [52.858847] Starting subtest: basic [52.878507] Subtest basic: SUCCESS (0.020s) [52.990286] [019/160] (944s left) gem_exec_basic (basic) [53.085728] Starting subtest: basic [53.092414] Starting dynamic subtest: rcs0-smem [53.098910] Dynamic subtest rcs0-smem: SUCCESS (0.009s) [53.111376] Starting dynamic subtest: bcs0-smem [53.118231] Dynamic subtest bcs0-smem: SUCCESS (0.008s) [53.131207] Starting dynamic subtest: vcs0-smem [53.138298] Dynamic subtest vcs0-smem: SUCCESS (0.007s) [53.150975] Starting dynamic subtest: vcs1-smem [53.158100] Dynamic subtest vcs1-smem: SUCCESS (0.007s) [53.170865] Starting dynamic subtest: vecs0-smem [53.178089] Dynamic subtest vecs0-smem: SUCCESS (0.008s) [53.191072] Starting dynamic subtest: ccs0-smem [53.198046] Dynamic subtest ccs0-smem: SUCCESS (0.007s) [53.204841] Subtest basic: SUCCESS (0.048s) [54.744395] [020/160] (942s left) gem_exec_create (basic) [54.836174] Starting subtest: basic [54.843192] Starting dynamic subtest: smem [58.675393] Dynamic subtest smem: SUCCESS (3.830s) [58.682281] Subtest basic: SUCCESS (3.830s) [58.867549] [021/160] (938s left) gem_exec_fence (basic-busy) [59.093857] Starting subtest: basic-busy [59.100542] Starting dynamic subtest: rcs0 [59.183869] Dynamic subtest rcs0: SUCCESS (0.092s) [59.197190] Starting dynamic subtest: bcs0 [59.242184] Dynamic subtest bcs0: SUCCESS (0.057s) [59.255391] Starting dynamic subtest: vcs0 [59.297906] Dynamic subtest vcs0: SUCCESS (0.056s) [59.311067] Starting dynamic subtest: vcs1 [59.359225] Dynamic subtest vcs1: SUCCESS (0.061s) [59.372703] Starting dynamic subtest: vecs0 [59.423093] Dynamic subtest vecs0: SUCCESS (0.063s) [59.436188] Starting dynamic subtest: ccs0 [59.481140] Dynamic subtest ccs0: SUCCESS (0.058s) [59.488058] Subtest basic-busy: SUCCESS (0.389s) [61.757551] [022/160] (935s left) gem_exec_fence (basic-wait) [61.976235] Starting subtest: basic-wait [61.983294] Starting dynamic subtest: rcs0 [62.074150] Dynamic subtest rcs0: SUCCESS (0.097s) [62.087757] Starting dynamic subtest: bcs0 [62.135054] Dynamic subtest bcs0: SUCCESS (0.061s) [62.148800] Starting dynamic subtest: vcs0 [62.190814] Dynamic subtest vcs0: SUCCESS (0.056s) [62.204614] Starting dynamic subtest: vcs1 [62.247132] Dynamic subtest vcs1: SUCCESS (0.056s) [62.260879] Starting dynamic subtest: vecs0 [62.305602] Dynamic subtest vecs0: SUCCESS (0.059s) [62.319202] Starting dynamic subtest: ccs0 [62.362179] Dynamic subtest ccs0: SUCCESS (0.056s) [62.369330] Subtest basic-wait: SUCCESS (0.385s) [63.801574] [023/160] (933s left) gem_exec_fence (basic-await) [64.029688] Starting subtest: basic-await [64.036711] Starting dynamic subtest: rcs0 [64.136715] Dynamic subtest rcs0: SUCCESS (0.116s) [64.150719] Starting dynamic subtest: bcs0 [64.246384] Dynamic subtest bcs0: SUCCESS (0.109s) [64.259597] Starting dynamic subtest: vcs0 [64.346674] Dynamic subtest vcs0: SUCCESS (0.100s) [64.360212] Starting dynamic subtest: vcs1 [64.457161] Dynamic subtest vcs1: SUCCESS (0.110s) [64.470956] Starting dynamic subtest: vecs0 [64.565109] Dynamic subtest vecs0: SUCCESS (0.107s) [64.578567] Starting dynamic subtest: ccs0 [64.672879] Dynamic subtest ccs0: SUCCESS (0.108s) [64.680048] Subtest basic-await: SUCCESS (0.652s) [66.753628] [024/160] (930s left) gem_exec_fence (nb-await) [66.990662] Starting subtest: nb-await [66.997581] Starting dynamic subtest: rcs0 [67.086247] Dynamic subtest rcs0: SUCCESS (0.109s) [67.099604] Starting dynamic subtest: bcs0 [67.157855] Dynamic subtest bcs0: SUCCESS (0.071s) [67.171363] Starting dynamic subtest: vcs0 [67.227358] Dynamic subtest vcs0: SUCCESS (0.069s) [67.240946] Starting dynamic subtest: vcs1 [67.294644] Dynamic subtest vcs1: SUCCESS (0.067s) [67.308058] Starting dynamic subtest: vecs0 [67.367703] Dynamic subtest vecs0: SUCCESS (0.073s) [67.381263] Starting dynamic subtest: ccs0 [67.441335] Dynamic subtest ccs0: SUCCESS (0.073s) [67.448228] Subtest nb-await: SUCCESS (0.464s) [68.806697] [025/160] (928s left) gem_exec_gttfill (basic) [68.901590] Starting subtest: basic [72.659112] Subtest basic: SUCCESS (3.748s) [72.848785] [026/160] (924s left) gem_exec_parallel (engines) [73.002550] Starting subtest: engines [73.009598] Starting dynamic subtest: basic [76.659965] Dynamic subtest basic: SUCCESS (3.648s) [76.674319] Starting dynamic subtest: contexts [83.982093] Dynamic subtest contexts: SUCCESS (7.322s) [83.996407] Starting dynamic subtest: fds [90.501770] Dynamic subtest fds: SUCCESS (6.519s) [90.516432] Starting dynamic subtest: userptr [92.671050] Dynamic subtest userptr: SUCCESS (2.169s) [92.678629] Subtest engines: SUCCESS (19.659s) [92.875272] [027/160] (904s left) gem_exec_store (basic) [92.994476] Starting subtest: basic [93.105886] Subtest basic: SUCCESS (0.124s) [93.305546] [028/160] (904s left) gem_flink_basic (bad-flink) [93.403866] Starting subtest: bad-flink [93.411311] Subtest bad-flink: SUCCESS (0.000s) [93.504701] [029/160] (903s left) gem_flink_basic (bad-open) [93.594946] Starting subtest: bad-open [93.601723] Subtest bad-open: SUCCESS (0.000s) [93.707253] [030/160] (903s left) gem_flink_basic (basic) [93.796644] Starting subtest: basic [93.803241] Subtest basic: SUCCESS (0.000s) [93.897568] [031/160] (903s left) gem_flink_basic (double-flink) [93.995246] Starting subtest: double-flink [94.002106] Subtest double-flink: SUCCESS (0.000s) [94.092711] [032/160] (903s left) gem_flink_basic (flink-lifetime) [94.183792] Starting subtest: flink-lifetime [94.190713] Subtest flink-lifetime: SUCCESS (0.003s) [94.297586] [033/160] (903s left) gem_huc_copy (huc-copy) [94.405507] Starting subtest: huc-copy [94.418825] Subtest huc-copy: SUCCESS (0.010s) [94.542287] [034/160] (902s left) gem_linear_blits (basic) [94.780869] Starting subtest: basic [94.812913] Subtest basic: SUCCESS (0.032s) [94.959413] [035/160] (902s left) gem_mmap (basic) [95.099654] Subtest basic: SKIP (0.000s) [95.147305] [036/160] (902s left) gem_mmap_gtt (basic) [95.250188] Subtest basic: SKIP (0.000s) [95.297096] [037/160] (902s left) gem_render_linear_blits (basic) [95.397154] Starting subtest: basic [95.463116] Subtest basic: SUCCESS (0.070s) [95.554459] [038/160] (902s left) gem_render_tiled_blits (basic) [95.653250] Subtest basic: SKIP (0.000s) [95.703874] [039/160] (902s left) gem_ringfill (basic-all) [101.693839] Starting subtest: basic-all [102.920926] Subtest basic-all: SUCCESS (1.235s) [103.708859] [040/160] (894s left) gem_softpin (allocator-basic) [103.806046] Starting subtest: allocator-basic [103.961935] Subtest allocator-basic: SUCCESS (0.151s) [104.096022] [041/160] (893s left) gem_softpin (allocator-basic-reserve) [104.180408] Starting subtest: allocator-basic-reserve [104.340783] Subtest allocator-basic-reserve: SUCCESS (0.152s) [104.463583] [042/160] (893s left) gem_softpin (safe-alignment) [104.561557] Starting subtest: safe-alignment [104.639739] Subtest safe-alignment: SUCCESS (0.081s) [105.760167] [043/160] (892s left) gem_sync (basic-all) [105.894544] Starting subtest: basic-all [109.683371] Subtest basic-all: SUCCESS (3.821s) [109.871470] [044/160] (887s left) gem_sync (basic-each) [110.024363] Starting subtest: basic-each [113.683080] Subtest basic-each: SUCCESS (3.695s) [113.872748] [045/160] (884s left) gem_tiled_blits (basic) [113.972409] Subtest basic: SKIP (0.000s) [114.016415] [046/160] (883s left) gem_tiled_fence_blits (basic) [114.120325] Subtest basic: SKIP (0.000s) [114.165725] [047/160] (883s left) gem_tiled_pread_basic [114.309172] [048/160] (883s left) gem_wait (busy@all-engines) [114.419297] Starting subtest: busy [114.426092] Starting dynamic subtest: all-engines [115.698980] Dynamic subtest all-engines: SUCCESS (1.270s) [115.706144] Subtest busy: SUCCESS (1.270s) [115.907296] [049/160] (882s left) gem_wait (wait@all-engines) [116.011718] Starting subtest: wait [116.018672] Starting dynamic subtest: all-engines [117.682150] Dynamic subtest all-engines: SUCCESS (1.661s) [117.688817] Subtest wait: SUCCESS (1.661s) [117.892506] [050/160] (880s left) i915_getparams_basic (basic-eu-total) [117.982640] Starting subtest: basic-eu-total [117.996308] Subtest basic-eu-total: SUCCESS (0.000s) [118.086238] [051/160] (880s left) i915_getparams_basic (basic-subslice-total) [118.179213] Starting subtest: basic-subslice-total [118.192688] Subtest basic-subslice-total: SUCCESS (0.000s) [118.272695] [052/160] (879s left) i915_hangman (error-state-basic) [118.388216] Starting subtest: error-state-basic [118.638103] Subtest error-state-basic: SUCCESS (0.255s) [118.730760] [053/160] (879s left) i915_pciid [118.916577] [054/160] (879s left) kms_addfb_basic (addfb25-4-tiled) [119.047874] Starting subtest: addfb25-4-tiled [119.054279] Subtest addfb25-4-tiled: SUCCESS (0.000s) [119.141968] [055/160] (879s left) kms_addfb_basic (addfb25-bad-modifier) [119.238217] Starting subtest: addfb25-bad-modifier [119.245078] Subtest addfb25-bad-modifier: SUCCESS (0.000s) [119.371143] [056/160] (878s left) kms_addfb_basic (addfb25-framebuffer-vs-set-tiling) [119.467602] Subtest addfb25-framebuffer-vs-set-tiling: SKIP (0.000s) [119.577229] [057/160] (878s left) kms_addfb_basic (addfb25-modifier-no-flag) [119.666787] Starting subtest: addfb25-modifier-no-flag [119.673583] Subtest addfb25-modifier-no-flag: SUCCESS (0.000s) [119.803585] [058/160] (878s left) kms_addfb_basic (addfb25-x-tiled-legacy) [119.899812] Subtest addfb25-x-tiled-legacy: SKIP (0.000s) [120.014776] [059/160] (878s left) kms_addfb_basic (addfb25-x-tiled-mismatch-legacy) [120.116170] Subtest addfb25-x-tiled-mismatch-legacy: SKIP (0.000s) [120.224111] [060/160] (878s left) kms_addfb_basic (addfb25-yf-tiled-legacy) [120.347304] Starting subtest: addfb25-yf-tiled-legacy [120.353775] Subtest addfb25-yf-tiled-legacy: SUCCESS (0.000s) [120.448890] [061/160] (877s left) kms_addfb_basic (addfb25-y-tiled-legacy) [120.564982] Starting subtest: addfb25-y-tiled-legacy [120.571919] Subtest addfb25-y-tiled-legacy: SUCCESS (0.000s) [120.656831] [062/160] (877s left) kms_addfb_basic (addfb25-y-tiled-small-legacy) [120.776141] Starting subtest: addfb25-y-tiled-small-legacy [120.790233] Subtest addfb25-y-tiled-small-legacy: SKIP (0.000s) [120.871226] [063/160] (877s left) kms_addfb_basic (bad-pitch-0) [120.961075] Starting subtest: bad-pitch-0 [120.967898] Subtest bad-pitch-0: SUCCESS (0.000s) [121.078968] [064/160] (877s left) kms_addfb_basic (bad-pitch-1024) [121.171382] Starting subtest: bad-pitch-1024 [121.181138] Subtest bad-pitch-1024: SUCCESS (0.000s) [121.288458] [065/160] (877s left) kms_addfb_basic (bad-pitch-128) [121.383807] Starting subtest: bad-pitch-128 [121.390670] Subtest bad-pitch-128: SUCCESS (0.000s) [121.495349] [066/160] (877s left) kms_addfb_basic (bad-pitch-256) [121.585525] Starting subtest: bad-pitch-256 [121.592397] Subtest bad-pitch-256: SUCCESS (0.000s) [121.720939] [067/160] (876s left) kms_addfb_basic (bad-pitch-32) [121.819415] Starting subtest: bad-pitch-32 [121.826198] Subtest bad-pitch-32: SUCCESS (0.000s) [121.933070] [068/160] (876s left) kms_addfb_basic (bad-pitch-63) [122.029208] Starting subtest: bad-pitch-63 [122.035980] Subtest bad-pitch-63: SUCCESS (0.000s) [122.150634] [069/160] (876s left) kms_addfb_basic (bad-pitch-65536) [122.238896] Starting subtest: bad-pitch-65536 [122.245915] Subtest bad-pitch-65536: SUCCESS (0.000s) [122.359930] [070/160] (876s left) kms_addfb_basic (bad-pitch-999) [122.451132] Starting subtest: bad-pitch-999 [122.458046] Subtest bad-pitch-999: SUCCESS (0.000s) [122.584407] [071/160] (876s left) kms_addfb_basic (basic) [122.674199] Starting subtest: basic [122.680761] Subtest basic: SUCCESS (0.000s) [122.796037] [072/160] (875s left) kms_addfb_basic (basic-x-tiled-legacy) [122.898885] Starting subtest: basic-x-tiled-legacy [122.912860] Subtest basic-x-tiled-legacy: SKIP (0.000s) [123.025712] [073/160] (875s left) kms_addfb_basic (basic-y-tiled-legacy) [123.119794] Starting subtest: basic-y-tiled-legacy [123.133535] Subtest basic-y-tiled-legacy: SKIP (0.000s) [123.230710] [074/160] (875s left) kms_addfb_basic (bo-too-small) [123.358686] Starting subtest: bo-too-small [123.365564] Subtest bo-too-small: SUCCESS (0.000s) [123.459887] [075/160] (875s left) kms_addfb_basic (bo-too-small-due-to-tiling) [123.572774] Starting subtest: bo-too-small-due-to-tiling [123.586556] Subtest bo-too-small-due-to-tiling: SKIP (0.000s) [123.664203] [076/160] (875s left) kms_addfb_basic (clobberred-modifier) [123.752217] Starting subtest: clobberred-modifier [123.765893] Subtest clobberred-modifier: SKIP (0.000s) [123.891758] [077/160] (875s left) kms_addfb_basic (framebuffer-vs-set-tiling) [123.988439] Starting subtest: framebuffer-vs-set-tiling [124.002074] Subtest framebuffer-vs-set-tiling: SKIP (0.000s) [124.100148] [078/160] (874s left) kms_addfb_basic (invalid-get-prop) [124.190280] Starting subtest: invalid-get-prop [124.197202] Subtest invalid-get-prop: SUCCESS (0.000s) [124.319816] [079/160] (874s left) kms_addfb_basic (invalid-get-prop-any) [124.409550] Starting subtest: invalid-get-prop-any [124.416580] Subtest invalid-get-prop-any: SUCCESS (0.000s) [124.526887] [080/160] (874s left) kms_addfb_basic (invalid-set-prop) [124.615566] Starting subtest: invalid-set-prop [124.622660] Subtest invalid-set-prop: SUCCESS (0.000s) [124.735582] [081/160] (874s left) kms_addfb_basic (invalid-set-prop-any) [124.823061] Starting subtest: invalid-set-prop-any [124.829952] Subtest invalid-set-prop-any: SUCCESS (0.000s) [124.943752] [082/160] (874s left) kms_addfb_basic (no-handle) [125.035888] Starting subtest: no-handle [125.042691] Subtest no-handle: SUCCESS (0.000s) [125.173258] [083/160] (873s left) kms_addfb_basic (size-max) [125.298893] Starting subtest: size-max [125.305644] Subtest size-max: SUCCESS (0.000s) [125.390503] [084/160] (873s left) kms_addfb_basic (small-bo) [125.515775] Starting subtest: small-bo [125.522297] Subtest small-bo: SUCCESS (0.000s) [125.613721] [085/160] (873s left) kms_addfb_basic (tile-pitch-mismatch) [125.710693] Starting subtest: tile-pitch-mismatch [125.724543] Subtest tile-pitch-mismatch: SKIP (0.000s) [125.824269] [086/160] (873s left) kms_addfb_basic (too-high) [125.924751] Starting subtest: too-high [125.931250] Subtest too-high: SUCCESS (0.001s) [126.020578] [087/160] (873s left) kms_addfb_basic (too-wide) [126.144765] Starting subtest: too-wide [126.151232] Subtest too-wide: SUCCESS (0.000s) [126.242207] [088/160] (873s left) kms_addfb_basic (unused-handle) [126.331217] Starting subtest: unused-handle [126.337955] Subtest unused-handle: SUCCESS (0.000s) [126.454203] [089/160] (872s left) kms_addfb_basic (unused-modifier) [126.543943] Starting subtest: unused-modifier [126.550866] Subtest unused-modifier: SUCCESS (0.000s) [126.670450] [090/160] (872s left) kms_addfb_basic (unused-offsets) [126.760856] Starting subtest: unused-offsets [126.767864] Subtest unused-offsets: SUCCESS (0.000s) [126.879903] [091/160] (872s left) kms_addfb_basic (unused-pitches) [126.969654] Starting subtest: unused-pitches [126.976476] Subtest unused-pitches: SUCCESS (0.000s) [127.089634] [092/160] (872s left) kms_busy (basic) [127.213195] Starting subtest: basic [127.219976] Starting dynamic subtest: flip [128.146104] Dynamic subtest flip: SUCCESS (0.926s) [128.160690] Starting dynamic subtest: modeset [131.933203] Dynamic subtest modeset: SUCCESS (3.786s) [131.939981] Subtest basic: SUCCESS (4.714s) [132.855750] [093/160] (866s left) kms_prop_blob (basic) [132.945068] Starting subtest: basic [132.952742] Subtest basic: SUCCESS (0.000s) [133.039418] [094/160] (866s left) kms_cursor_legacy (basic-busy-flip-before-cursor-atomic) [133.189633] Starting subtest: basic-busy-flip-before-cursor-atomic [133.203887] Subtest basic-busy-flip-before-cursor-atomic: SKIP (0.000s) [133.367107] [095/160] (866s left) kms_cursor_legacy (basic-busy-flip-before-cursor-legacy) [133.520506] Starting subtest: basic-busy-flip-before-cursor-legacy [133.534768] Subtest basic-busy-flip-before-cursor-legacy: SKIP (0.000s) [133.698071] [096/160] (865s left) kms_cursor_legacy (basic-flip-after-cursor-atomic) [133.852397] Starting subtest: basic-flip-after-cursor-atomic [135.146204] Subtest basic-flip-after-cursor-atomic: SUCCESS (1.290s) [136.055464] [097/160] (863s left) kms_cursor_legacy (basic-flip-after-cursor-legacy) [136.210732] Starting subtest: basic-flip-after-cursor-legacy [137.526340] Subtest basic-flip-after-cursor-legacy: SUCCESS (1.311s) [138.421549] [098/160] (861s left) kms_cursor_legacy (basic-flip-after-cursor-varying-size) [138.574939] Starting subtest: basic-flip-after-cursor-varying-size [139.908441] Subtest basic-flip-after-cursor-varying-size: SUCCESS (1.329s) [140.852385] [099/160] (858s left) kms_cursor_legacy (basic-flip-before-cursor-atomic) [141.006431] Starting subtest: basic-flip-before-cursor-atomic [142.322584] Subtest basic-flip-before-cursor-atomic: SUCCESS (1.311s) [143.223305] [100/160] (856s left) kms_cursor_legacy (basic-flip-before-cursor-legacy) [143.380424] Starting subtest: basic-flip-before-cursor-legacy [144.689329] Subtest basic-flip-before-cursor-legacy: SUCCESS (1.312s) [145.588526] [101/160] (854s left) kms_cursor_legacy (basic-flip-before-cursor-varying-size) [145.739751] Starting subtest: basic-flip-before-cursor-varying-size [147.054334] Subtest basic-flip-before-cursor-varying-size: SUCCESS (1.311s) [147.957591] [102/160] (851s left) kms_dsc (dsc-basic) [148.083742] Starting subtest: dsc-basic [148.097296] Subtest dsc-basic: SKIP (0.000s) [148.164357] [103/160] (851s left) kms_flip (basic-flip-vs-dpms) [148.288025] Starting subtest: basic-flip-vs-dpms [148.295056] Starting dynamic subtest: A-eDP1 [151.135403] Dynamic subtest A-eDP1: SUCCESS (2.839s) [151.151951] Starting dynamic subtest: B-eDP1 [153.502293] Dynamic subtest B-eDP1: SUCCESS (2.368s) [153.524327] Starting dynamic subtest: C-eDP1 [155.807117] Dynamic subtest C-eDP1: SUCCESS (2.301s) [155.822238] Starting dynamic subtest: D-eDP1 [158.123179] Dynamic subtest D-eDP1: SUCCESS (2.317s) [158.131974] Subtest basic-flip-vs-dpms: SUCCESS (9.840s) [159.018608] [104/160] (840s left) kms_flip (basic-flip-vs-modeset) [159.157037] Starting subtest: basic-flip-vs-modeset [159.165050] Starting dynamic subtest: A-eDP1 [162.012888] Dynamic subtest A-eDP1: SUCCESS (2.856s) [162.028378] Starting dynamic subtest: B-eDP1 [164.317046] Dynamic subtest B-eDP1: SUCCESS (2.300s) [164.332518] Starting dynamic subtest: C-eDP1 [166.637982] Dynamic subtest C-eDP1: SUCCESS (2.319s) [166.653837] Starting dynamic subtest: D-eDP1 [168.920066] Dynamic subtest D-eDP1: SUCCESS (2.287s) [168.926753] Subtest basic-flip-vs-modeset: SUCCESS (9.777s) [169.848659] [105/160] (829s left) kms_flip (basic-flip-vs-wf_vblank) [169.981877] Starting subtest: basic-flip-vs-wf_vblank [169.988885] Starting dynamic subtest: A-eDP1 [172.146315] Dynamic subtest A-eDP1: SUCCESS (2.165s) [172.162049] Starting dynamic subtest: B-eDP1 [174.258090] Dynamic subtest B-eDP1: SUCCESS (2.110s) [174.273687] Starting dynamic subtest: C-eDP1 [176.353111] Dynamic subtest C-eDP1: SUCCESS (2.093s) [176.368732] Starting dynamic subtest: D-eDP1 [178.718988] Dynamic subtest D-eDP1: SUCCESS (2.362s) [178.725863] Subtest basic-flip-vs-wf_vblank: SUCCESS (8.744s) [180.024771] [106/160] (819s left) kms_flip (basic-plain-flip) [180.150821] Starting subtest: basic-plain-flip [180.157857] Starting dynamic subtest: A-eDP1 [182.039858] Dynamic subtest A-eDP1: SUCCESS (1.888s) [182.055487] Starting dynamic subtest: B-eDP1 [183.894580] Dynamic subtest B-eDP1: SUCCESS (1.854s) [183.911121] Starting dynamic subtest: C-eDP1 [185.735483] Dynamic subtest C-eDP1: SUCCESS (1.838s) [185.750920] Starting dynamic subtest: D-eDP1 [187.527583] Dynamic subtest D-eDP1: SUCCESS (1.791s) [187.534426] Subtest basic-plain-flip: SUCCESS (7.388s) [188.791575] [107/160] (811s left) kms_force_connector_basic (force-connector-state) [188.886307] Starting subtest: force-connector-state [189.330521] Subtest force-connector-state: SUCCESS (0.442s) [190.506924] [108/160] (809s left) kms_force_connector_basic (force-edid) [190.604998] Starting subtest: force-edid [190.635215] Subtest force-edid: SUCCESS (0.031s) [190.788464] [109/160] (809s left) kms_force_connector_basic (force-load-detect) [190.886684] Starting subtest: force-load-detect [190.900450] Subtest force-load-detect: SKIP (0.000s) [191.019035] [110/160] (808s left) kms_force_connector_basic (prune-stale-modes) [191.116727] Starting subtest: prune-stale-modes [191.148805] Subtest prune-stale-modes: SUCCESS (0.028s) [191.299891] [111/160] (808s left) kms_frontbuffer_tracking (basic) [191.441391] Starting subtest: basic [195.535058] Subtest basic: SUCCESS (4.107s) [195.637331] [112/160] (804s left) kms_hdmi_inject (inject-audio) [196.029166] Starting subtest: inject-audio [196.180699] Subtest inject-audio: SUCCESS (0.146s) [196.942928] [113/160] (803s left) kms_pipe_crc_basic (compare-crc-sanitycheck-xr24) [197.056038] Starting subtest: compare-crc-sanitycheck-xr24 [197.063086] Starting dynamic subtest: pipe-A-eDP-1 [197.877872] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.822s) [197.894454] Starting dynamic subtest: pipe-B-eDP-1 [199.272080] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.391s) [199.287673] Starting dynamic subtest: pipe-C-eDP-1 [200.639405] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.357s) [200.655124] Starting dynamic subtest: pipe-D-eDP-1 [201.999116] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.357s) [202.005563] Subtest compare-crc-sanitycheck-xr24: SUCCESS (4.939s) [202.934328] [114/160] (797s left) kms_pipe_crc_basic (compare-crc-sanitycheck-nv12) [203.054883] Starting subtest: compare-crc-sanitycheck-nv12 [203.061859] Starting dynamic subtest: pipe-A-eDP-1 [203.938122] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.880s) [203.953571] Starting dynamic subtest: pipe-B-eDP-1 [205.330348] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.389s) [205.346244] Starting dynamic subtest: pipe-C-eDP-1 [206.696368] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.356s) [206.711874] Starting dynamic subtest: pipe-D-eDP-1 [208.047859] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.356s) [208.054807] Subtest compare-crc-sanitycheck-nv12: SUCCESS (4.994s) [208.951184] [115/160] (791s left) kms_pipe_crc_basic (hang-read-crc) [209.065999] Starting subtest: hang-read-crc [209.072993] Starting dynamic subtest: pipe-A-eDP-1 [211.486513] Dynamic subtest pipe-A-eDP-1: SUCCESS (2.418s) [211.502171] Starting dynamic subtest: pipe-B-eDP-1 [214.608053] Dynamic subtest pipe-B-eDP-1: SUCCESS (3.119s) [214.624516] Starting dynamic subtest: pipe-C-eDP-1 [217.945826] Dynamic subtest pipe-C-eDP-1: SUCCESS (3.327s) [217.961464] Starting dynamic subtest: pipe-D-eDP-1 [220.958192] Dynamic subtest pipe-D-eDP-1: SUCCESS (3.017s) [220.965742] Subtest hang-read-crc: SUCCESS (11.893s) [221.876845] [116/160] (778s left) kms_pipe_crc_basic (nonblocking-crc) [221.984133] Starting subtest: nonblocking-crc [221.991256] Starting dynamic subtest: pipe-A-eDP-1 [222.895849] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.910s) [222.911493] Starting dynamic subtest: pipe-B-eDP-1 [224.489561] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.591s) [224.505162] Starting dynamic subtest: pipe-C-eDP-1 [226.047536] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.554s) [226.063192] Starting dynamic subtest: pipe-D-eDP-1 [227.607626] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.557s) [227.614934] Subtest nonblocking-crc: SUCCESS (5.625s) [228.534790] [117/160] (771s left) kms_pipe_crc_basic (nonblocking-crc-frame-sequence) [228.657689] Starting subtest: nonblocking-crc-frame-sequence [228.664527] Starting dynamic subtest: pipe-A-eDP-1 [229.568988] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.909s) [229.584589] Starting dynamic subtest: pipe-B-eDP-1 [231.159645] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.588s) [231.175397] Starting dynamic subtest: pipe-C-eDP-1 [232.719144] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.557s) [232.734763] Starting dynamic subtest: pipe-D-eDP-1 [234.280345] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.558s) [234.287221] Subtest nonblocking-crc-frame-sequence: SUCCESS (5.624s) [235.189183] [118/160] (765s left) kms_pipe_crc_basic (read-crc) [235.309376] Starting subtest: read-crc [235.315995] Starting dynamic subtest: pipe-A-eDP-1 [236.168304] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.861s) [236.188311] Starting dynamic subtest: pipe-B-eDP-1 [237.710464] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.539s) [238.577338] Starting dynamic subtest: pipe-C-eDP-1 [239.569445] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.010s) [239.584939] Starting dynamic subtest: pipe-D-eDP-1 [241.078665] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.506s) [241.085948] Subtest read-crc: SUCCESS (5.774s) [242.040050] [119/160] (758s left) kms_pipe_crc_basic (read-crc-frame-sequence) [242.159075] Starting subtest: read-crc-frame-sequence [242.166108] Starting dynamic subtest: pipe-A-eDP-1 [243.019220] Dynamic subtest pipe-A-eDP-1: SUCCESS (0.859s) [243.034795] Starting dynamic subtest: pipe-B-eDP-1 [244.584490] Dynamic subtest pipe-B-eDP-1: SUCCESS (1.561s) [244.600190] Starting dynamic subtest: pipe-C-eDP-1 [246.092100] Dynamic subtest pipe-C-eDP-1: SUCCESS (1.505s) [246.118139] Starting dynamic subtest: pipe-D-eDP-1 [247.615295] Dynamic subtest pipe-D-eDP-1: SUCCESS (1.511s) [247.629045] Subtest read-crc-frame-sequence: SUCCESS (5.449s) [248.577325] [120/160] (751s left) kms_pm_backlight (basic-brightness) [248.699726] Starting subtest: basic-brightness [248.832176] Starting dynamic subtest: eDP-1 [249.350726] Dynamic subtest eDP-1: SUCCESS (0.524s) [249.357352] Subtest basic-brightness: SUCCESS (0.652s) [250.299366] [121/160] (750s left) kms_pm_rpm (basic-pci-d3-state) [251.915303] Starting subtest: basic-pci-d3-state [256.537495] Subtest basic-pci-d3-state: SUCCESS (4.620s) [256.851497] [122/160] (743s left) kms_pm_rpm (basic-rte) [256.943890] Starting subtest: basic-rte [263.064374] Subtest basic-rte: SUCCESS (6.131s) [268.441811] [123/160] (731s left) kms_psr (psr-primary-page-flip) [268.573715] Starting subtest: psr-primary-page-flip [268.580795] Starting dynamic subtest: eDP-1 [270.583937] Dynamic subtest eDP-1: SUCCESS (2.011s) [270.590981] Subtest psr-primary-page-flip: SUCCESS (2.013s) [271.546403] [124/160] (728s left) kms_psr (psr-cursor-plane-move) [271.661372] Starting subtest: psr-cursor-plane-move [271.668406] Starting dynamic subtest: eDP-1 [273.640682] Dynamic subtest eDP-1: SUCCESS (1.977s) [273.647296] Subtest psr-cursor-plane-move: SUCCESS (1.979s) [274.550642] [125/160] (725s left) kms_psr (psr-sprite-plane-onoff) [274.680024] Starting subtest: psr-sprite-plane-onoff [274.686793] Starting dynamic subtest: eDP-1 [276.723413] Dynamic subtest eDP-1: SUCCESS (2.040s) [276.730035] Subtest psr-sprite-plane-onoff: SUCCESS (2.043s) [277.622529] [126/160] (722s left) kms_psr (psr-primary-mmap-gtt) [277.745208] Starting subtest: psr-primary-mmap-gtt [277.752610] Starting dynamic subtest: eDP-1 [279.451569] Dynamic subtest eDP-1: SKIP (1.691s) [279.466267] Subtest psr-primary-mmap-gtt: SKIP (1.694s) [279.642837] [127/160] (720s left) kms_setmode (basic-clone-single-crtc) [279.742363] Starting subtest: basic-clone-single-crtc [279.762941] Subtest basic-clone-single-crtc: SKIP (0.001s) [279.836438] [128/160] (720s left) i915_pm_rps (basic-api) [279.936172] Starting subtest: basic-api [279.949693] Subtest basic-api: SKIP (0.001s) [280.038331] [129/160] (720s left) prime_self_import (basic-llseek-bad) [280.115980] Starting subtest: basic-llseek-bad [280.130533] Subtest basic-llseek-bad: SUCCESS (0.011s) [280.237180] [130/160] (720s left) prime_self_import (basic-llseek-size) [280.321299] Starting subtest: basic-llseek-size [280.334864] Subtest basic-llseek-size: SUCCESS (0.014s) [280.446544] [131/160] (720s left) prime_self_import (basic-with_fd_dup) [280.535612] Starting subtest: basic-with_fd_dup [280.549165] Subtest basic-with_fd_dup: SUCCESS (0.014s) [280.642907] [132/160] (720s left) prime_self_import (basic-with_one_bo) [280.729546] Starting subtest: basic-with_one_bo [280.743259] Subtest basic-with_one_bo: SUCCESS (0.015s) [280.841872] [133/160] (719s left) prime_self_import (basic-with_one_bo_two_files) [280.933553] Starting subtest: basic-with_one_bo_two_files [280.948304] Subtest basic-with_one_bo_two_files: SUCCESS (0.010s) [281.050337] [134/160] (719s left) prime_self_import (basic-with_two_bos) [281.126447] Starting subtest: basic-with_two_bos [281.140358] Subtest basic-with_two_bos: SUCCESS (0.013s) [281.240047] [135/160] (719s left) prime_vgem (basic-fence-flip) [281.368823] Starting subtest: basic-fence-flip [281.827804] Subtest basic-fence-flip: SUCCESS (0.463s) [281.931174] [136/160] (718s left) prime_vgem (basic-fence-mmap) [282.047363] Starting subtest: basic-fence-mmap [282.061590] Subtest basic-fence-mmap: SKIP (0.000s) [282.150595] [137/160] (718s left) prime_vgem (basic-fence-read) [282.256951] Starting subtest: basic-fence-read [282.270639] Subtest basic-fence-read: SKIP (0.008s) [282.367841] [138/160] (718s left) prime_vgem (basic-gtt) [282.473116] Starting subtest: basic-gtt [282.486064] Subtest basic-gtt: SKIP (0.000s) [282.566453] [139/160] (718s left) prime_vgem (basic-read) [282.689689] Starting subtest: basic-read [282.704413] Subtest basic-read: SKIP (0.008s) [282.802642] [140/160] (718s left) prime_vgem (basic-write) [282.922161] Starting subtest: basic-write [282.935731] Subtest basic-write: SKIP (0.008s) [283.035687] [141/160] (718s left) vgem_basic (setversion) [283.127302] Starting subtest: setversion [283.141465] Subtest setversion: SUCCESS (0.000s) [283.183770] [142/160] (717s left) vgem_basic (create) [283.281538] Starting subtest: create [283.288867] Subtest create: SUCCESS (0.000s) [283.334038] [143/160] (717s left) vgem_basic (debugfs) [283.423607] Starting subtest: debugfs [283.431200] Subtest debugfs: SUCCESS (0.000s) [283.485261] [144/160] (717s left) vgem_basic (dmabuf-export) [283.575314] Starting subtest: dmabuf-export [283.588852] Subtest dmabuf-export: SUCCESS (0.021s) [283.686056] [145/160] (717s left) vgem_basic (dmabuf-fence) [283.790359] Starting subtest: dmabuf-fence [283.797554] Subtest dmabuf-fence: SUCCESS (0.001s) [283.853521] [146/160] (717s left) vgem_basic (dmabuf-fence-before) [283.958119] Starting subtest: dmabuf-fence-before [283.965067] Subtest dmabuf-fence-before: SUCCESS (0.000s) [284.015630] [147/160] (717s left) vgem_basic (dmabuf-mmap) [284.113274] Starting subtest: dmabuf-mmap [284.120280] Subtest dmabuf-mmap: SUCCESS (0.013s) [284.186161] [148/160] (717s left) vgem_basic (mmap) [284.279253] Starting subtest: mmap [284.286577] Subtest mmap: SUCCESS (0.012s) [284.332710] [149/160] (716s left) vgem_basic (second-client) [284.429366] Starting subtest: second-client [284.457235] Subtest second-client: SUCCESS (0.033s) [284.519219] [150/160] (716s left) vgem_basic (sysfs) [284.609366] Starting subtest: sysfs [284.616266] Subtest sysfs: SUCCESS (0.001s) [284.666962] [151/160] (716s left) core_hotunplug (unbind-rebind) [284.793850] Starting subtest: unbind-rebind [289.706382] Subtest unbind-rebind: SUCCESS (4.912s) [289.740134] [152/160] (711s left) vgem_basic (unload) [289.822688] Starting subtest: unload [318.768815] Subtest unload: SUCCESS (28.942s) [318.890164] [153/160] (682s left) i915_module_load (reload) [318.974365] Starting subtest: reload [322.511116] Subtest reload: SUCCESS (3.542s) [322.544344] [154/160] (678s left) gem_lmem_swapping (basic) [322.648840] Subtest basic: SKIP (0.000s) [322.679603] [155/160] (678s left) gem_lmem_swapping (parallel-random-engines) [322.777658] Subtest parallel-random-engines: SKIP (0.000s) [322.812798] [156/160] (678s left) gem_lmem_swapping (random-engines) [322.896402] Subtest random-engines: SKIP (0.000s) [322.929323] [157/160] (678s left) gem_lmem_swapping (verify-random) [323.017487] Subtest verify-random: SKIP (0.000s) [323.048810] [158/160] (678s left) i915_pm_rpm (module-reload) [342.655633] Starting subtest: module-reload [390.571052] Subtest module-reload: SUCCESS (47.909s) [390.601050] [159/160] (611s left) i915_selftest (live) [390.690682] Starting subtest: live [390.697485] Starting dynamic subtest: sanitycheck [412.898031] Dynamic subtest sanitycheck: SUCCESS (22.205s) [412.910136] Starting dynamic subtest: uncore [435.145312] Dynamic subtest uncore: SUCCESS (22.246s) [435.157717] Starting dynamic subtest: workarounds [457.374325] Dynamic subtest workarounds: SUCCESS (22.228s) [457.385272] Starting dynamic subtest: gt_engines [479.608319] Dynamic subtest gt_engines: SUCCESS (22.232s) [479.620907] Starting dynamic subtest: gt_timelines [539.556371] Dynamic subtest gt_timelines: SUCCESS (59.957s) [539.568551] Starting dynamic subtest: gt_contexts [561.799252] Dynamic subtest gt_contexts: SUCCESS (22.233s) [561.811582] Starting dynamic subtest: gt_lrc [584.026200] Dynamic subtest gt_lrc: SUCCESS (22.225s) [584.038776] Starting dynamic subtest: gt_mocs [606.245035] Dynamic subtest gt_mocs: SUCCESS (22.217s) [606.257641] Starting dynamic subtest: gt_pm [628.470043] Dynamic subtest gt_pm: SUCCESS (22.223s) [628.482535] Starting dynamic subtest: gt_heartbeat [650.685492] Dynamic subtest gt_heartbeat: SUCCESS (22.215s) [650.697757] Starting dynamic subtest: gt_tlb [672.905138] Dynamic subtest gt_tlb: SUCCESS (22.219s) [672.917638] Starting dynamic subtest: requests [695.279406] Dynamic subtest requests: SUCCESS (22.374s) [695.291916] Starting dynamic subtest: migrate [717.437428] Dynamic subtest migrate: SUCCESS (22.156s) [717.450060] Starting dynamic subtest: active [739.660255] Dynamic subtest active: SUCCESS (22.222s) [739.672971] Starting dynamic subtest: objects [761.869964] Dynamic subtest objects: SUCCESS (22.209s) [761.882260] Starting dynamic subtest: mman [784.096447] Dynamic subtest mman: SUCCESS (22.226s) [784.112905] Starting dynamic subtest: dmabuf [806.343510] Dynamic subtest dmabuf: SUCCESS (22.246s) [806.356043] Starting dynamic subtest: vma [828.563901] Dynamic subtest vma: SUCCESS (22.219s) [828.576397] Starting dynamic subtest: coherency [850.798171] Dynamic subtest coherency: SUCCESS (22.234s) [850.810537] Starting dynamic subtest: gtt [873.041149] Dynamic subtest gtt: SUCCESS (22.241s) [873.053535] Starting dynamic subtest: gem [897.365253] Dynamic subtest gem: SUCCESS (24.324s) [897.377700] Starting dynamic subtest: evict [919.612338] Dynamic subtest evict: SUCCESS (22.245s) [919.624934] Starting dynamic subtest: hugepages [941.526160] Dynamic subtest hugepages: SUCCESS (21.913s) [941.538897] Starting dynamic subtest: gem_contexts [953.647166] Killing the test because the kernel is tainted. [965.945925] Aborting: Lockdep not active /proc/lockdep_stats contents: lock-classes: 1718 [max: 8192] direct dependencies: 16862 [max: 32768] indirect dependencies: 122530 all direct dependencies: 328118 dependency chains: 24077 [max: 131072] dependency chain hlocks used: 98509 [max: 655360] dependency chain hlocks lost: 0 in-hardirq chains: 171 in-softirq chains: 601 in-process chains: 23305 stack-trace entries: 248489 [max: 1048576] number of stack traces: 11262 number of stack hash chains: 8150 combined max dependencies: 2413196464 hardirq-safe locks: 93 hardirq-unsafe locks: 1048 softirq-safe locks: 183 softirq-unsafe locks: 958 irq-safe locks: 204 irq-unsafe locks: 1048 hardirq-read-safe locks: 3 hardirq-read-unsafe locks: 271 softirq-read-safe locks: 7 softirq-read-unsafe locks: 266 irq-read-safe locks: 7 irq-read-unsafe locks: 271 uncategorized locks: 308 unused locks: 1 max locking depth: 16 max bfs queue depth: 438 max lock class index: 1794 chain lookup misses: 74518 chain lookup hits: 320506027 cyclic checks: 74425 redundant checks: 0 redundant links: 0 find-mask forwards checks: 14118 find-mask backwards checks: 7380 hardirq on events: 173099263 hardirq off events: 173099240 redundant hardirq ons: 40 redundant hardirq offs: 29 softirq on events: 1179332 softirq off events: 1179332 redundant softirq ons: 0 redundant softirq offs: 0 debug_locks: 0 zapped classes: 3805 zapped lock chains: 49935 large chain blocks: 1 [965.952792] Closing watchdogs Done.