2025-07-25T09:37:40.819260253Z /package/admin/s6-overlay/libexec/preinit: info: container permissions: uid=0 (root), euid=0, gid=0 (root), egid=0
2025-07-25T09:37:40.819301566Z /package/admin/s6-overlay/libexec/preinit: info: /run permissions: uid=0 (root), gid=0 (root), perms=oxorgxgruxuwur
2025-07-25T09:37:40.861402549Z [mod-init] Running Docker Modification Logic
2025-07-25T09:37:41.088401333Z [mod-init] Adding linuxserver/mods:universal-redis to container
2025-07-25T09:37:41.765827144Z [mod-init] Downloading linuxserver/mods:universal-redis from lscr.io
2025-07-25T09:37:42.134073636Z [mod-init] Installing linuxserver/mods:universal-redis
2025-07-25T09:37:42.158765338Z [mod-init] linuxserver/mods:universal-redis applied to container
2025-07-25T09:37:42.185409923Z s6-rc: info: service s6rc-oneshot-runner: starting
2025-07-25T09:37:42.188552069Z s6-rc: info: service s6rc-oneshot-runner successfully started
2025-07-25T09:37:42.188662721Z s6-rc: info: service fix-attrs: starting
2025-07-25T09:37:42.188850810Z s6-rc: info: service init-migrations: starting
2025-07-25T09:37:42.189138249Z s6-rc: info: service init-envfile: starting
2025-07-25T09:37:42.195869411Z s6-rc: info: service fix-attrs successfully started
2025-07-25T09:37:42.195984954Z s6-rc: info: service legacy-cont-init: starting
2025-07-25T09:37:42.196822269Z [migrations] started
2025-07-25T09:37:42.196945037Z [migrations] no migrations found
2025-07-25T09:37:42.197433380Z s6-rc: info: service init-migrations successfully started
2025-07-25T09:37:42.197634625Z s6-rc: info: service init-adduser: starting
2025-07-25T09:37:42.198137828Z s6-rc: info: service init-envfile successfully started
2025-07-25T09:37:42.202007770Z s6-rc: info: service legacy-cont-init successfully started
2025-07-25T09:37:42.217609381Z usermod: no changes
2025-07-25T09:37:42.224088575Z ───────────────────────────────────────
2025-07-25T09:37:42.224117995Z 
2025-07-25T09:37:42.224122423Z       ██╗     ███████╗██╗ ██████╗
2025-07-25T09:37:42.224126963Z       ██║     ██╔════╝██║██╔═══██╗
2025-07-25T09:37:42.224131652Z       ██║     ███████╗██║██║   ██║
2025-07-25T09:37:42.224136311Z       ██║     ╚════██║██║██║   ██║
2025-07-25T09:37:42.224140600Z       ███████╗███████║██║╚██████╔╝
2025-07-25T09:37:42.224144598Z       ╚══════╝╚══════╝╚═╝ ╚═════╝
2025-07-25T09:37:42.224148436Z 
2025-07-25T09:37:42.224152203Z    Brought to you by linuxserver.io
2025-07-25T09:37:42.224155901Z ───────────────────────────────────────
2025-07-25T09:37:42.224587730Z 
2025-07-25T09:37:42.224621368Z To support LSIO projects visit:
2025-07-25T09:37:42.224629575Z https://www.linuxserver.io/donate/
2025-07-25T09:37:42.224637811Z 
2025-07-25T09:37:42.224645507Z ───────────────────────────────────────
2025-07-25T09:37:42.224654425Z GID/UID
2025-07-25T09:37:42.224661719Z ───────────────────────────────────────
2025-07-25T09:37:42.228334494Z 
2025-07-25T09:37:42.228351849Z User UID:    911
2025-07-25T09:37:42.228356258Z User GID:    911
2025-07-25T09:37:42.228361047Z ───────────────────────────────────────
2025-07-25T09:37:42.229997702Z Linuxserver.io version: v0.118.0-ls93
2025-07-25T09:37:42.230234319Z Build-date: 2025-07-25T09:26:18+00:00
2025-07-25T09:37:42.230250020Z ───────────────────────────────────────
2025-07-25T09:37:42.230255942Z     
2025-07-25T09:37:42.244051157Z s6-rc: info: service init-adduser successfully started
2025-07-25T09:37:42.244146569Z s6-rc: info: service init-device-perms: starting
2025-07-25T09:37:42.249593265Z s6-rc: info: service init-device-perms successfully started
2025-07-25T09:37:42.249730942Z s6-rc: info: service init-os-end: starting
2025-07-25T09:37:42.251272706Z s6-rc: info: service init-os-end successfully started
2025-07-25T09:37:42.251494774Z s6-rc: info: service init-manyfold-config: starting
2025-07-25T09:37:42.251588011Z s6-rc: info: service init-config: starting
2025-07-25T09:37:42.253028772Z s6-rc: info: service init-config successfully started
2025-07-25T09:37:42.253190558Z s6-rc: info: service init-crontab-config: starting
2025-07-25T09:37:42.262218293Z s6-rc: info: service init-crontab-config successfully started
2025-07-25T09:37:42.277291461Z **** Running Manyfold database init. ****
2025-07-25T09:37:44.472017469Z `/root` is not writable.
2025-07-25T09:37:44.472236640Z Bundler will use `/tmp/bundler20250725-173-13gvh3173' as your home directory temporarily.
2025-07-25T09:37:48.835697354Z Server: 0d65cd0027d2, Context: rails, Role: web, data: {:cpu=>{:one_min=>1.48, :five_min=>1.52, :fifteen_min=>1.87}, :memory=>0.17905664e9, :disk=>{:available=>861372436480, :total=>938656133120, :used=>77283696640}}
2025-07-25T09:37:48.835744329Z Monitor error: Connection refused - connect(2) for 127.0.0.1:6379 (redis://localhost:6379)
2025-07-25T09:37:48.835752285Z INFO  2025-07-25T09:37:48.650Z pid=173 tid=5rl: Sidekiq 8.0.5 connecting to Redis with options {:size=>10, :pool_name=>"internal", :url=>nil}
2025-07-25T09:37:48.835776684Z WARNING: table: "settings" does not exist or not database connection, `SiteSettings.anonymous_usage_id` fallback to returns the default value.
2025-07-25T09:37:49.858694318Z Migrating to CreateLibraries (20210130201037)
2025-07-25T09:37:49.858728126Z == 20210130201037 CreateLibraries: migrating ==================================
2025-07-25T09:37:49.858737725Z -- create_table(:libraries)
2025-07-25T09:37:49.858745912Z    -> 0.0009s
2025-07-25T09:37:49.858754369Z == 20210130201037 CreateLibraries: migrated (0.0010s) =========================
2025-07-25T09:37:49.858763106Z 
2025-07-25T09:37:49.858771503Z Migrating to CreateModels (20210130203243)
2025-07-25T09:37:49.858781373Z == 20210130203243 CreateModels: migrating =====================================
2025-07-25T09:37:49.858791524Z -- create_table(:models)
2025-07-25T09:37:49.858801594Z    -> 0.0010s
2025-07-25T09:37:49.858811484Z == 20210130203243 CreateModels: migrated (0.0010s) ============================
2025-07-25T09:37:49.858821885Z 
2025-07-25T09:37:49.858831384Z Migrating to CreateParts (20210205230918)
2025-07-25T09:37:49.858841394Z == 20210205230918 CreateParts: migrating ======================================
2025-07-25T09:37:49.858851404Z -- create_table(:parts)
2025-07-25T09:37:49.858861585Z    -> 0.0009s
2025-07-25T09:37:49.858873048Z == 20210205230918 CreateParts: migrated (0.0010s) =============================
2025-07-25T09:37:49.858884290Z 
2025-07-25T09:37:49.858895293Z Migrating to AddFieldsToParts (20210210153744)
2025-07-25T09:37:49.858906245Z == 20210210153744 AddFieldsToParts: migrating =================================
2025-07-25T09:37:49.858916626Z -- add_column(:parts, :presupported, :boolean, {:default=>false, :null=>false})
2025-07-25T09:37:49.858927487Z    -> 0.0006s
2025-07-25T09:37:49.858937978Z -- add_column(:parts, :printed, :boolean, {:default=>false, :null=>false})
2025-07-25T09:37:49.858948620Z    -> 0.0003s
2025-07-25T09:37:49.858959081Z == 20210210153744 AddFieldsToParts: migrated (0.0009s) ========================
2025-07-25T09:37:49.858969732Z 
2025-07-25T09:37:49.858979502Z Migrating to ActsAsTaggableOnMigration (20210212143001)
2025-07-25T09:37:49.858989683Z == 20210212143001 ActsAsTaggableOnMigration: migrating ========================
2025-07-25T09:37:49.859000484Z -- create_table(:tags, {:id=>:integer})
2025-07-25T09:37:49.859011507Z    -> 0.0009s
2025-07-25T09:37:49.859021527Z -- create_table(:taggings, {:id=>:integer})
2025-07-25T09:37:49.859030775Z    -> 0.0006s
2025-07-25T09:37:49.859040495Z -- add_index(:taggings, :tag_id, {:name=>"index_taggings_on_tag_id"})
2025-07-25T09:37:49.859050295Z    -> 0.0002s
2025-07-25T09:37:49.859078271Z -- add_index(:taggings, [:taggable_id, :taggable_type, :context], {:name=>"taggings_taggable_context_idx"})
2025-07-25T09:37:49.859089494Z    -> 0.0005s
2025-07-25T09:37:49.859099884Z == 20210212143001 ActsAsTaggableOnMigration: migrated (0.0024s) ===============
2025-07-25T09:37:49.859110376Z 
2025-07-25T09:37:49.859120165Z Migrating to AddMissingUniqueIndices (20210212143002)
2025-07-25T09:37:49.859131157Z == 20210212143002 AddMissingUniqueIndices: migrating ==========================
2025-07-25T09:37:49.859141679Z -- add_index(:tags, :name, {:unique=>true, :name=>"index_tags_on_name"})
2025-07-25T09:37:49.859152380Z    -> 0.0003s
2025-07-25T09:37:49.859162360Z -- index_exists?(:taggings, :tag_id, {:name=>"index_taggings_on_tag_id"})
2025-07-25T09:37:49.859172210Z    -> 0.0004s
2025-07-25T09:37:49.859181980Z -- remove_foreign_key(:taggings, :tags)
2025-07-25T09:37:49.859192070Z    -> 0.0293s
2025-07-25T09:37:49.859205086Z -- remove_index(:taggings, :tag_id, {:name=>"index_taggings_on_tag_id"})
2025-07-25T09:37:49.859213674Z    -> 0.0022s
2025-07-25T09:37:49.859221970Z -- remove_index(:taggings, nil, {:name=>"taggings_taggable_context_idx"})
2025-07-25T09:37:49.859232091Z    -> 0.0002s
2025-07-25T09:37:49.859242692Z -- add_index(:taggings, [:tag_id, :taggable_id, :taggable_type, :context, :tagger_id, :tagger_type], {:unique=>true, :name=>"taggings_idx"})
2025-07-25T09:37:49.859253514Z    -> 0.0010s
2025-07-25T09:37:49.859263865Z -- add_foreign_key(:taggings, :tags, {:column=>"tag_id"})
2025-07-25T09:37:49.859275117Z    -> 0.0139s
2025-07-25T09:37:49.859284957Z == 20210212143002 AddMissingUniqueIndices: migrated (0.0513s) =================
2025-07-25T09:37:49.859295007Z 
2025-07-25T09:37:49.859304396Z Migrating to AddTaggingsCounterCacheToTags (20210212143003)
2025-07-25T09:37:49.859312793Z == 20210212143003 AddTaggingsCounterCacheToTags: migrating ====================
2025-07-25T09:37:49.859320839Z -- add_column(:tags, :taggings_count, :integer, {:default=>0})
2025-07-25T09:37:49.859329076Z    -> 0.0016s
2025-07-25T09:37:49.859337072Z == 20210212143003 AddTaggingsCounterCacheToTags: migrated (0.0138s) ===========
2025-07-25T09:37:49.859345238Z 
2025-07-25T09:37:49.859352994Z Migrating to AddMissingTaggableIndex (20210212143004)
2025-07-25T09:37:49.859361040Z == 20210212143004 AddMissingTaggableIndex: migrating ==========================
2025-07-25T09:37:49.859369477Z -- add_index(:taggings, [:taggable_id, :taggable_type, :context], {:name=>"taggings_taggable_context_idx"})
2025-07-25T09:37:49.859377804Z    -> 0.0002s
2025-07-25T09:37:49.859388345Z == 20210212143004 AddMissingTaggableIndex: migrated (0.0003s) =================
2025-07-25T09:37:49.859409638Z 
2025-07-25T09:37:49.859419157Z Migrating to ChangeCollationForTagNames (20210212143005)
2025-07-25T09:37:49.859429147Z == 20210212143005 ChangeCollationForTagNames: migrating =======================
2025-07-25T09:37:49.859439248Z == 20210212143005 ChangeCollationForTagNames: migrated (0.0006s) ==============
2025-07-25T09:37:49.859448566Z 
2025-07-25T09:37:49.859456322Z Migrating to AddMissingIndexesOnTaggings (20210212143006)
2025-07-25T09:37:49.859464308Z == 20210212143006 AddMissingIndexesOnTaggings: migrating ======================
2025-07-25T09:37:49.859472655Z -- index_exists?(:taggings, :tag_id, {:name=>"index_taggings_on_tag_id"})
2025-07-25T09:37:49.859480932Z    -> 0.0012s
2025-07-25T09:37:49.859488828Z -- add_index(:taggings, :tag_id, {:name=>"index_taggings_on_tag_id"})
2025-07-25T09:37:49.859497034Z    -> 0.0002s
2025-07-25T09:37:49.859504920Z -- index_exists?(:taggings, :taggable_id, {:name=>"index_taggings_on_taggable_id"})
2025-07-25T09:37:49.859513217Z    -> 0.0006s
2025-07-25T09:37:49.859521082Z -- add_index(:taggings, :taggable_id, {:name=>"index_taggings_on_taggable_id"})
2025-07-25T09:37:49.859529620Z    -> 0.0002s
2025-07-25T09:37:49.859537997Z -- index_exists?(:taggings, :taggable_type, {:name=>"index_taggings_on_taggable_type"})
2025-07-25T09:37:49.859548428Z    -> 0.0004s
2025-07-25T09:37:49.859558869Z -- add_index(:taggings, :taggable_type, {:name=>"index_taggings_on_taggable_type"})
2025-07-25T09:37:49.859569009Z    -> 0.0001s
2025-07-25T09:37:49.859579520Z -- index_exists?(:taggings, :tagger_id, {:name=>"index_taggings_on_tagger_id"})
2025-07-25T09:37:49.859589921Z    -> 0.0017s
2025-07-25T09:37:49.859600102Z -- add_index(:taggings, :tagger_id, {:name=>"index_taggings_on_tagger_id"})
2025-07-25T09:37:49.859610863Z    -> 0.0001s
2025-07-25T09:37:49.859621274Z -- index_exists?(:taggings, :context, {:name=>"index_taggings_on_context"})
2025-07-25T09:37:49.859630984Z    -> 0.0005s
2025-07-25T09:37:49.859641445Z -- add_index(:taggings, :context, {:name=>"index_taggings_on_context"})
2025-07-25T09:37:49.859652136Z    -> 0.0003s
2025-07-25T09:37:49.859662617Z -- index_exists?(:taggings, [:tagger_id, :tagger_type], {:name=>"index_taggings_on_tagger_id_and_tagger_type"})
2025-07-25T09:37:49.859673590Z    -> 0.0006s
2025-07-25T09:37:49.859683229Z -- add_index(:taggings, [:tagger_id, :tagger_type], {:name=>"index_taggings_on_tagger_id_and_tagger_type"})
2025-07-25T09:37:49.859694732Z    -> 0.0002s
2025-07-25T09:37:49.859705033Z -- index_exists?(:taggings, [:taggable_id, :taggable_type, :tagger_id, :context], {:name=>"taggings_idy"})
2025-07-25T09:37:49.859715734Z    -> 0.0008s
2025-07-25T09:37:49.859740815Z -- add_index(:taggings, [:taggable_id, :taggable_type, :tagger_id, :context], {:name=>"taggings_idy"})
2025-07-25T09:37:49.859752719Z    -> 0.0006s
2025-07-25T09:37:49.859762038Z == 20210212143006 AddMissingIndexesOnTaggings: migrated (0.0078s) =============
2025-07-25T09:37:49.859771988Z 
2025-07-25T09:37:49.859781787Z Migrating to AddPreviewPartToModel (20210220204055)
2025-07-25T09:37:49.859792369Z == 20210220204055 AddPreviewPartToModel: migrating ============================
2025-07-25T09:37:49.859802659Z -- add_reference(:models, :preview_part, {:null=>true, :foreign_key=>{:to_table=>:parts}})
2025-07-25T09:37:49.859812850Z    -> 0.0351s
2025-07-25T09:37:49.859822339Z == 20210220204055 AddPreviewPartToModel: migrated (0.0352s) ===================
2025-07-25T09:37:49.859833251Z 
2025-07-25T09:37:49.859843482Z Migrating to CreateCreators (20210225232756)
2025-07-25T09:37:49.859876548Z == 20210225232756 CreateCreators: migrating ===================================
2025-07-25T09:37:49.859886969Z -- create_table(:creators)
2025-07-25T09:37:49.859896749Z    -> 0.0020s
2025-07-25T09:37:49.859906669Z == 20210225232756 CreateCreators: migrated (0.0020s) ==========================
2025-07-25T09:37:49.859916889Z 
2025-07-25T09:37:49.859927160Z Migrating to AddCreatorToModels (20210225232841)
2025-07-25T09:37:49.859937341Z == 20210225232841 AddCreatorToModels: migrating ===============================
2025-07-25T09:37:49.859946830Z -- add_reference(:models, :creator, {:null=>true, :foreign_key=>true})
2025-07-25T09:37:49.859956289Z    -> 0.0083s
2025-07-25T09:37:49.859964996Z == 20210225232841 AddCreatorToModels: migrated (0.0083s) ======================
2025-07-25T09:37:49.859974205Z 
2025-07-25T09:37:49.859983624Z Migrating to CreateLinks (20210301230017)
2025-07-25T09:37:49.859993684Z == 20210301230017 CreateLinks: migrating ======================================
2025-07-25T09:37:49.860003614Z -- create_table(:links)
2025-07-25T09:37:49.860013784Z    -> 0.0007s
2025-07-25T09:37:49.860024376Z == 20210301230017 CreateLinks: migrated (0.0008s) =============================
2025-07-25T09:37:49.860034797Z 
2025-07-25T09:37:49.860046260Z Migrating to DropLinkFieldsFromCreators (20210302161202)
2025-07-25T09:37:49.860056821Z == 20210302161202 DropLinkFieldsFromCreators: migrating =======================
2025-07-25T09:37:49.860067252Z -- remove_column(:creators, :thingiverse_user, :string)
2025-07-25T09:37:49.860077372Z    -> 0.0105s
2025-07-25T09:37:49.860087252Z -- remove_column(:creators, :cults3d_user, :string)
2025-07-25T09:37:49.860097523Z    -> 0.0028s
2025-07-25T09:37:49.860106732Z -- remove_column(:creators, :mmf_user, :string)
2025-07-25T09:37:49.860132173Z    -> 0.0057s
2025-07-25T09:37:49.860142063Z -- remove_column(:creators, :cgtrader_user, :string)
2025-07-25T09:37:49.860152083Z    -> 0.0025s
2025-07-25T09:37:49.860161983Z == 20210302161202 DropLinkFieldsFromCreators: migrated (0.0218s) ==============
2025-07-25T09:37:49.860172845Z 
2025-07-25T09:37:49.860182524Z Migrating to RemoveFkConstraintFromModelPreviewPart (20210314185822)
2025-07-25T09:37:49.860193116Z == 20210314185822 RemoveFkConstraintFromModelPreviewPart: migrating ===========
2025-07-25T09:37:49.860202935Z -- remove_foreign_key(:models, :parts, {:column=>:preview_part_id})
2025-07-25T09:37:49.860211462Z    -> 0.0135s
2025-07-25T09:37:49.860219358Z == 20210314185822 RemoveFkConstraintFromModelPreviewPart: migrated (0.0135s) ==
2025-07-25T09:37:49.860227465Z 
2025-07-25T09:37:49.860235240Z Migrating to AddYUpToParts (20210318202638)
2025-07-25T09:37:49.860243186Z == 20210318202638 AddYUpToParts: migrating ====================================
2025-07-25T09:37:49.860251473Z -- add_column(:parts, :y_up, :boolean, {:default=>false, :null=>false})
2025-07-25T09:37:49.860259830Z    -> 0.0037s
2025-07-25T09:37:49.860267746Z == 20210318202638 AddYUpToParts: migrated (0.0038s) ===========================
2025-07-25T09:37:49.860275782Z 
2025-07-25T09:37:49.860283497Z Migrating to CreateImages (20210321164508)
2025-07-25T09:37:49.860291464Z == 20210321164508 CreateImages: migrating =====================================
2025-07-25T09:37:49.860299530Z -- create_table(:images)
2025-07-25T09:37:49.860307446Z    -> 0.0027s
2025-07-25T09:37:49.860315261Z == 20210321164508 CreateImages: migrated (0.0027s) ============================
2025-07-25T09:37:49.860323618Z 
2025-07-25T09:37:49.860331424Z Migrating to CreateDelayedJobs (20210330215825)
2025-07-25T09:37:49.860339440Z == 20210330215825 CreateDelayedJobs: migrating ================================
2025-07-25T09:37:49.860347456Z -- create_table(:delayed_jobs)
2025-07-25T09:37:49.860355312Z    -> 0.0032s
2025-07-25T09:37:49.860363178Z -- add_index(:delayed_jobs, [:priority, :run_at], {:name=>"delayed_jobs_priority"})
2025-07-25T09:37:49.860371384Z    -> 0.0002s
2025-07-25T09:37:49.860379170Z == 20210330215825 CreateDelayedJobs: migrated (0.0034s) =======================
2025-07-25T09:37:49.860387256Z 
2025-07-25T09:37:49.860394942Z Migrating to RenamePartsToModelFiles (20220105233138)
2025-07-25T09:37:49.860402888Z == 20220105233138 RenamePartsToModelFiles: migrating ==========================
2025-07-25T09:37:49.860410914Z -- rename_table(:parts, :model_files)
2025-07-25T09:37:49.860421105Z    -> 0.0016s
2025-07-25T09:37:49.860447598Z -- rename_column(:models, :preview_part_id, :preview_file_id)
2025-07-25T09:37:49.860455824Z    -> 0.0121s
2025-07-25T09:37:49.860463700Z == 20220105233138 RenamePartsToModelFiles: migrated (0.0137s) =================
2025-07-25T09:37:49.860471857Z 
2025-07-25T09:37:49.860479582Z Migrating to RemoveImagesTable (20220106220519)
2025-07-25T09:37:50.101148038Z == 20220106220519 RemoveImagesTable: migrating ================================
2025-07-25T09:37:50.101197197Z -- drop_table(:images)
2025-07-25T09:37:50.101206495Z    -> 0.0003s
2025-07-25T09:37:50.101215363Z == 20220106220519 RemoveImagesTable: migrated (0.0003s) =======================
2025-07-25T09:37:50.101223670Z 
2025-07-25T09:37:50.101231816Z Migrating to AddServiceNameToActiveStorageBlobs (20220612220115)
2025-07-25T09:37:50.101239963Z == 20220612220115 AddServiceNameToActiveStorageBlobs: migrating ===============
2025-07-25T09:37:50.101248159Z -- table_exists?(:active_storage_blobs)
2025-07-25T09:37:50.101256226Z    -> 0.0002s
2025-07-25T09:37:50.101264392Z == 20220612220115 AddServiceNameToActiveStorageBlobs: migrated (0.0002s) ======
2025-07-25T09:37:50.101272478Z 
2025-07-25T09:37:50.101280284Z Migrating to CreateActiveStorageVariantRecords (20220612220116)
2025-07-25T09:37:50.101288340Z == 20220612220116 CreateActiveStorageVariantRecords: migrating ================
2025-07-25T09:37:50.101296547Z -- table_exists?(:active_storage_blobs)
2025-07-25T09:37:50.101305244Z    -> 0.0001s
2025-07-25T09:37:50.101313250Z == 20220612220116 CreateActiveStorageVariantRecords: migrated (0.0002s) =======
2025-07-25T09:37:50.101321437Z 
2025-07-25T09:37:50.101329183Z Migrating to RemoveNotNullOnActiveStorageBlobsChecksum (20220612220117)
2025-07-25T09:37:50.101337199Z == 20220612220117 RemoveNotNullOnActiveStorageBlobsChecksum: migrating ========
2025-07-25T09:37:50.101345405Z -- table_exists?(:active_storage_blobs)
2025-07-25T09:37:50.101353522Z    -> 0.0001s
2025-07-25T09:37:50.101361488Z == 20220612220117 RemoveNotNullOnActiveStorageBlobsChecksum: migrated (0.0001s) 
2025-07-25T09:37:50.101369594Z 
2025-07-25T09:37:50.101377390Z Migrating to DeviseCreateUsers (20220614210023)
2025-07-25T09:37:50.101385346Z == 20220614210023 DeviseCreateUsers: migrating ================================
2025-07-25T09:37:50.101393753Z -- create_table(:users)
2025-07-25T09:37:50.101401979Z    -> 0.0024s
2025-07-25T09:37:50.101409885Z -- add_index(:users, :email, {:unique=>true, :name=>"index_users_on_email"})
2025-07-25T09:37:50.101418542Z    -> 0.0004s
2025-07-25T09:37:50.101427531Z == 20220614210023 DeviseCreateUsers: migrated (0.0028s) =======================
2025-07-25T09:37:50.101457040Z 
2025-07-25T09:37:50.101465106Z Migrating to AddUsernameToUsers (20220614211256)
2025-07-25T09:37:50.101473182Z == 20220614211256 AddUsernameToUsers: migrating ===============================
2025-07-25T09:37:50.101481469Z -- add_column(:users, :username, :string, {:null=>false})
2025-07-25T09:37:50.101489866Z    -> 0.0064s
2025-07-25T09:37:50.101497882Z -- add_index(:users, :username, {:unique=>true, :name=>"index_users_on_username"})
2025-07-25T09:37:50.101506610Z    -> 0.0001s
2025-07-25T09:37:50.101514796Z == 20220614211256 AddUsernameToUsers: migrated (0.0066s) ======================
2025-07-25T09:37:50.101523073Z 
2025-07-25T09:37:50.101530758Z Migrating to AddAdminToUsers (20220614213902)
2025-07-25T09:37:50.101538995Z == 20220614213902 AddAdminToUsers: migrating ==================================
2025-07-25T09:37:50.101547171Z -- add_column(:users, :admin, :boolean, {:default=>false, :null=>false})
2025-07-25T09:37:50.101555378Z    -> 0.0005s
2025-07-25T09:37:50.101563304Z == 20220614213902 AddAdminToUsers: migrated (0.0006s) =========================
2025-07-25T09:37:50.101571390Z 
2025-07-25T09:37:50.101579226Z Migrating to AddPaginationSettingsToUser (20220617122809)
2025-07-25T09:37:50.101588675Z == 20220617122809 AddPaginationSettingsToUser: migrating ======================
2025-07-25T09:37:50.101596932Z -- add_column(:users, :pagination_settings, :json, {:default=>{"models"=>true, "creators"=>true, "collections"=>true, "per_page"=>12}})
2025-07-25T09:37:50.101606290Z    -> 0.0035s
2025-07-25T09:37:50.101614276Z == 20220617122809 AddPaginationSettingsToUser: migrated (0.0036s) =============
2025-07-25T09:37:50.101622363Z 
2025-07-25T09:37:50.101630088Z Migrating to CreateSettings (20220619174307)
2025-07-25T09:37:50.101638074Z == 20220619174307 CreateSettings: migrating ===================================
2025-07-25T09:37:50.101646271Z -- create_table(:settings)
2025-07-25T09:37:50.101654187Z    -> 0.0007s
2025-07-25T09:37:50.101662113Z -- add_index(:settings, [:var], {:unique=>true, :name=>"index_settings_on_var"})
2025-07-25T09:37:50.101670550Z    -> 0.0002s
2025-07-25T09:37:50.101678486Z == 20220619174307 CreateSettings: migrated (0.0010s) ==========================
2025-07-25T09:37:50.101686542Z 
2025-07-25T09:37:50.101694308Z Migrating to AddScaleFactorToModels (20220626152444)
2025-07-25T09:37:50.101702304Z == 20220626152444 AddScaleFactorToModels: migrating ===========================
2025-07-25T09:37:50.101710410Z -- add_column(:models, :scale_factor, :decimal, {:null=>false, :default=>100.0})
2025-07-25T09:37:50.101718727Z    -> 0.0035s
2025-07-25T09:37:50.101727023Z == 20220626152444 AddScaleFactorToModels: migrated (0.0039s) ==================
2025-07-25T09:37:50.102142690Z 
2025-07-25T09:37:50.102153422Z Migrating to AddDigestToModelFiles (20220702202932)
2025-07-25T09:37:50.102161478Z == 20220702202932 AddDigestToModelFiles: migrating ============================
2025-07-25T09:37:50.102169554Z -- add_column(:model_files, :digest, :string)
2025-07-25T09:37:50.102177521Z    -> 0.0008s
2025-07-25T09:37:50.102185587Z -- add_index(:model_files, :digest, {:name=>"index_model_files_on_digest"})
2025-07-25T09:37:50.102193823Z    -> 0.0002s
2025-07-25T09:37:50.102201649Z == 20220702202932 AddDigestToModelFiles: migrated (0.0015s) ===================
2025-07-25T09:37:50.102210066Z 
2025-07-25T09:37:50.102217731Z Migrating to AddRendererSettingsToUsers (20221128165903)
2025-07-25T09:37:50.102225728Z == 20221128165903 AddRendererSettingsToUsers: migrating =======================
2025-07-25T09:37:50.102233884Z -- add_column(:users, :renderer_settings, :json, {:default=>{"grid_width"=>200, "grid_depth"=>200, "show_grid"=>true, "enable_pan_zoom"=>false, "background_colour"=>"#000000", "object_colour"=>"#ffffff", "render_style"=>"original"}})
2025-07-25T09:37:50.102245658Z    -> 0.0006s
2025-07-25T09:37:50.102253874Z == 20221128165903 AddRendererSettingsToUsers: migrated (0.0008s) ==============
2025-07-25T09:37:50.102261940Z 
2025-07-25T09:37:50.102269947Z Migrating to CreateProblems (20221210001132)
2025-07-25T09:37:50.102277883Z == 20221210001132 CreateProblems: migrating ===================================
2025-07-25T09:37:50.102285969Z -- create_table(:problems)
2025-07-25T09:37:50.102293965Z    -> 0.0006s
2025-07-25T09:37:50.102301861Z == 20221210001132 CreateProblems: migrated (0.0008s) ==========================
2025-07-25T09:37:50.102309977Z 
2025-07-25T09:37:50.102318645Z Migrating to AddNewDefaultsToRendererSettings (20221214230757)
2025-07-25T09:37:50.102326731Z == 20221214230757 AddNewDefaultsToRendererSettings: migrating =================
2025-07-25T09:37:50.102334757Z == 20221214230757 AddNewDefaultsToRendererSettings: migrated (0.0045s) ========
2025-07-25T09:37:50.102342803Z 
2025-07-25T09:37:50.102350789Z Migrating to ActsAsFavoritorMigration (20221219204414)
2025-07-25T09:37:50.102358775Z == 20221219204414 ActsAsFavoritorMigration: migrating =========================
2025-07-25T09:37:50.102366982Z -- create_table(:favorites, {:force=>true})
2025-07-25T09:37:50.102375088Z    -> 0.0021s
2025-07-25T09:37:50.102383295Z -- add_index(:favorites, ["favoritor_id", "favoritor_type"], {:name=>"fk_favorites"})
2025-07-25T09:37:50.102391912Z    -> 0.0001s
2025-07-25T09:37:50.102399958Z -- add_index(:favorites, ["favoritable_id", "favoritable_type"], {:name=>"fk_favoritables"})
2025-07-25T09:37:50.102419728Z    -> 0.0001s
2025-07-25T09:37:50.102427804Z -- add_index(:favorites, ["favoritable_type", "favoritable_id", "favoritor_type", "favoritor_id", "scope"], {:name=>"uniq_favorites__and_favoritables", :unique=>true})
2025-07-25T09:37:50.102437033Z    -> 0.0001s
2025-07-25T09:37:50.102445099Z == 20221219204414 ActsAsFavoritorMigration: migrated (0.0027s) ================
2025-07-25T09:37:50.102453426Z 
2025-07-25T09:37:50.102461232Z Migrating to MovePrintedToFavorites (20221220223040)
2025-07-25T09:37:50.102469188Z == 20221220223040 MovePrintedToFavorites: migrating ===========================
2025-07-25T09:37:50.102477204Z == 20221220223040 MovePrintedToFavorites: migrated (0.0054s) ==================
2025-07-25T09:37:50.102485270Z 
2025-07-25T09:37:50.102493026Z Migrating to DropPrintedFromModelFiles (20221220223340)
2025-07-25T09:37:50.102501302Z == 20221220223340 DropPrintedFromModelFiles: migrating ========================
2025-07-25T09:37:50.102509729Z -- remove_column(:model_files, :printed, :boolean)
2025-07-25T09:37:50.102517816Z    -> 0.0082s
2025-07-25T09:37:50.102526182Z == 20221220223340 DropPrintedFromModelFiles: migrated (0.0083s) ===============
2025-07-25T09:37:50.102534419Z 
2025-07-25T09:37:50.102542355Z Migrating to AddNotesExcerptToModels (20230202210000)
2025-07-25T09:37:50.102550301Z == 20230202210000 AddNotesExcerptToModels: migrating ==========================
2025-07-25T09:37:50.102558578Z -- add_column(:models, :notes, :text)
2025-07-25T09:37:50.102566784Z    -> 0.0005s
2025-07-25T09:37:50.102574911Z -- add_column(:models, :excerpt, :text)
2025-07-25T09:37:50.102583077Z    -> 0.0008s
2025-07-25T09:37:50.102591294Z == 20230202210000 AddNotesExcerptToModels: migrated (0.0013s) =================
2025-07-25T09:37:50.102599330Z 
2025-07-25T09:37:50.102607286Z Migrating to AddNotesExcerptToCreators (20230202210001)
2025-07-25T09:37:50.102615552Z == 20230202210001 AddNotesExcerptToCreators: migrating ========================
2025-07-25T09:37:50.102623629Z -- add_column(:creators, :notes, :text)
2025-07-25T09:37:50.102631515Z    -> 0.0005s
2025-07-25T09:37:50.102639441Z -- add_column(:creators, :excerpt, :text)
2025-07-25T09:37:50.102647397Z    -> 0.0006s
2025-07-25T09:37:50.102655433Z == 20230202210001 AddNotesExcerptToCreators: migrated (0.0011s) ===============
2025-07-25T09:37:50.102663479Z 
2025-07-25T09:37:50.102671836Z Migrating to AddNotesExcerptToModelFiles (20230203150000)
2025-07-25T09:37:50.102679852Z == 20230203150000 AddNotesExcerptToModelFiles: migrating ======================
2025-07-25T09:37:50.102687998Z -- add_column(:model_files, :notes, :text)
2025-07-25T09:37:50.102705413Z    -> 0.0005s
2025-07-25T09:37:50.102713409Z -- add_column(:model_files, :excerpt, :text)
2025-07-25T09:37:50.102723079Z    -> 0.0004s
2025-07-25T09:37:50.102731025Z == 20230203150000 AddNotesExcerptToModelFiles: migrated (0.0010s) =============
2025-07-25T09:37:50.102739131Z 
2025-07-25T09:37:50.102746877Z Migrating to MoveScaleFactorIntoNote (20230221174212)
2025-07-25T09:37:50.102754893Z == 20230221174212 MoveScaleFactorIntoNote: migrating ==========================
2025-07-25T09:37:50.102762909Z == 20230221174212 MoveScaleFactorIntoNote: migrated (0.0050s) =================
2025-07-25T09:37:50.102771066Z 
2025-07-25T09:37:50.102778801Z Migrating to RemoveScaleFactorFromModels (20230221180921)
2025-07-25T09:37:50.102786857Z == 20230221180921 RemoveScaleFactorFromModels: migrating ======================
2025-07-25T09:37:50.102795174Z -- remove_column(:models, :scale_factor, :decimal, {:default=>"100.0", :null=>false})
2025-07-25T09:37:50.102803571Z    -> 0.0126s
2025-07-25T09:37:50.102811427Z == 20230221180921 RemoveScaleFactorFromModels: migrated (0.0127s) =============
2025-07-25T09:37:50.102819693Z 
2025-07-25T09:37:50.102827539Z Migrating to RenameExcerptToCaption (20230222155910)
2025-07-25T09:37:50.102835445Z == 20230222155910 RenameExcerptToCaption: migrating ===========================
2025-07-25T09:37:50.102843682Z -- rename_column(:creators, :excerpt, :caption)
2025-07-25T09:37:50.102851688Z    -> 0.0068s
2025-07-25T09:37:50.102859734Z -- rename_column(:models, :excerpt, :caption)
2025-07-25T09:37:50.102867640Z    -> 0.0083s
2025-07-25T09:37:50.102875536Z -- rename_column(:model_files, :excerpt, :caption)
2025-07-25T09:37:50.102883502Z    -> 0.0078s
2025-07-25T09:37:50.102891378Z == 20230222155910 RenameExcerptToCaption: migrated (0.0233s) ==================
2025-07-25T09:37:50.102899414Z 
2025-07-25T09:37:50.102907129Z Migrating to AddNotesNameCaptionToLibrary (20230303150029)
2025-07-25T09:37:50.102915516Z == 20230303150029 AddNotesNameCaptionToLibrary: migrating =====================
2025-07-25T09:37:50.102923593Z -- add_column(:libraries, :notes, :string)
2025-07-25T09:37:50.102931569Z    -> 0.0008s
2025-07-25T09:37:50.102939715Z -- add_column(:libraries, :caption, :string)
2025-07-25T09:37:50.102947932Z    -> 0.0004s
2025-07-25T09:37:50.102955868Z -- add_column(:libraries, :name, :string)
2025-07-25T09:37:50.102963974Z    -> 0.0004s
2025-07-25T09:37:50.102972100Z == 20230303150029 AddNotesNameCaptionToLibrary: migrated (0.0027s) ============
2025-07-25T09:37:50.102980437Z 
2025-07-25T09:37:50.102988253Z Migrating to AddTagregexToLibrary (20230305180823)
2025-07-25T09:37:50.103006359Z == 20230305180823 AddTagregexToLibrary: migrating =============================
2025-07-25T09:37:50.103014826Z -- add_column(:libraries, :tag_regex, :text)
2025-07-25T09:37:50.103022983Z    -> 0.0008s
2025-07-25T09:37:50.103031189Z == 20230305180823 AddTagregexToLibrary: migrated (0.0011s) ====================
2025-07-25T09:37:50.103039716Z 
2025-07-25T09:37:50.103047632Z Migrating to AddIconToLibrary (20230307215826)
2025-07-25T09:37:50.103055759Z == 20230307215826 AddIconToLibrary: migrating =================================
2025-07-25T09:37:50.293391478Z -- add_column(:libraries, :icon, :text)
2025-07-25T09:37:50.293435958Z    -> 0.0008s
2025-07-25T09:37:50.293446329Z == 20230307215826 AddIconToLibrary: migrated (0.0011s) ========================
2025-07-25T09:37:50.293454856Z 
2025-07-25T09:37:50.293463132Z Migrating to CreateCollection (20230308004237)
2025-07-25T09:37:50.293471409Z == 20230308004237 CreateCollection: migrating =================================
2025-07-25T09:37:50.293479666Z -- create_table(:collections)
2025-07-25T09:37:50.293489445Z    -> 0.0010s
2025-07-25T09:37:50.293499926Z == 20230308004237 CreateCollection: migrated (0.0014s) ========================
2025-07-25T09:37:50.293510137Z 
2025-07-25T09:37:50.293518324Z Migrating to AddCollectionToModels (20230308005021)
2025-07-25T09:37:50.293526480Z == 20230308005021 AddCollectionToModels: migrating ============================
2025-07-25T09:37:50.293534697Z -- add_reference(:models, :collection, {:null=>true, :foreign_key=>true})
2025-07-25T09:37:50.293543224Z    -> 0.0094s
2025-07-25T09:37:50.293551370Z == 20230308005021 AddCollectionToModels: migrated (0.0095s) ===================
2025-07-25T09:37:50.293561551Z 
2025-07-25T09:37:50.293571290Z Migrating to MoveCollectionTagIntoObject (20230308006000)
2025-07-25T09:37:50.293580950Z == 20230308006000 MoveCollectionTagIntoObject: migrating ======================
2025-07-25T09:37:50.293589066Z == 20230308006000 MoveCollectionTagIntoObject: migrated (0.0010s) =============
2025-07-25T09:37:50.293597242Z 
2025-07-25T09:37:50.293605008Z Migrating to RenameCollectionExcerptToCaption (20230313000000)
2025-07-25T09:37:50.293613806Z == 20230313000000 RenameCollectionExcerptToCaption: migrating =================
2025-07-25T09:37:50.293623726Z -- rename_column(:collections, :excerpt, :caption)
2025-07-25T09:37:50.293633525Z    -> 0.0032s
2025-07-25T09:37:50.293642504Z == 20230313000000 RenameCollectionExcerptToCaption: migrated (0.0032s) ========
2025-07-25T09:37:50.293650690Z 
2025-07-25T09:37:50.293659578Z Migrating to ChangePaginationSettingsOnUser (20230313000001)
2025-07-25T09:37:50.293670019Z == 20230313000001 ChangePaginationSettingsOnUser: migrating ===================
2025-07-25T09:37:50.293701813Z == 20230313000001 ChangePaginationSettingsOnUser: migrated (0.0000s) ==========
2025-07-25T09:37:50.293710410Z 
2025-07-25T09:37:50.293718226Z Migrating to AddTagCloudSettingsToUser (20230316184012)
2025-07-25T09:37:50.293726603Z == 20230316184012 AddTagCloudSettingsToUser: migrating ========================
2025-07-25T09:37:50.293734719Z -- add_column(:users, :tag_cloud_settings, :json, {:default=>{"threshold"=>2, "heatmap"=>true, "keypair"=>true, "sorting"=>"frequency"}})
2025-07-25T09:37:50.293744920Z    -> 0.0007s
2025-07-25T09:37:50.293753247Z == 20230316184012 AddTagCloudSettingsToUser: migrated (0.0008s) ===============
2025-07-25T09:37:50.293761914Z 
2025-07-25T09:37:50.293769720Z Migrating to AddCollectionToCollections (20230324000000)
2025-07-25T09:37:50.293777776Z == 20230324000000 AddCollectionToCollections: migrating =======================
2025-07-25T09:37:50.293786053Z -- add_reference(:collections, :collection, {:null=>true, :foreign_key=>true})
2025-07-25T09:37:50.293795051Z    -> 0.0053s
2025-07-25T09:37:50.293804780Z == 20230324000000 AddCollectionToCollections: migrated (0.0055s) ==============
2025-07-25T09:37:50.293813077Z 
2025-07-25T09:37:50.293821053Z Migrating to RemoveDestinationExistsProblems (20230612080306)
2025-07-25T09:37:50.293829710Z == 20230612080306 RemoveDestinationExistsProblems: migrating ==================
2025-07-25T09:37:50.293838027Z == 20230612080306 RemoveDestinationExistsProblems: migrated (0.0014s) =========
2025-07-25T09:37:50.293846264Z 
2025-07-25T09:37:50.293854039Z Migrating to RemoveLeadingSeparatorsFromModelFilenames (20230613134254)
2025-07-25T09:37:50.293862587Z == 20230613134254 RemoveLeadingSeparatorsFromModelFilenames: migrating ========
2025-07-25T09:37:50.293871224Z == 20230613134254 RemoveLeadingSeparatorsFromModelFilenames: migrated (0.0015s) 
2025-07-25T09:37:50.293879551Z 
2025-07-25T09:37:50.293887547Z Migrating to AddSlugs (20230615135601)
2025-07-25T09:37:50.293895663Z == 20230615135601 AddSlugs: migrating =========================================
2025-07-25T09:37:50.293904120Z -- add_column(:models, :slug, :string)
2025-07-25T09:37:50.293912327Z    -> 0.0005s
2025-07-25T09:37:50.293921074Z -- add_index(:models, :slug, {:name=>"index_models_on_slug"})
2025-07-25T09:37:50.293930293Z    -> 0.0003s
2025-07-25T09:37:50.293938399Z -- add_column(:collections, :slug, :string)
2025-07-25T09:37:50.293946606Z    -> 0.0004s
2025-07-25T09:37:50.293954712Z -- add_index(:collections, :slug, {:name=>"index_collections_on_slug"})
2025-07-25T09:37:50.293962939Z    -> 0.0001s
2025-07-25T09:37:50.293970815Z -- add_column(:creators, :slug, :string)
2025-07-25T09:37:50.293989372Z    -> 0.0006s
2025-07-25T09:37:50.293997328Z -- add_index(:creators, :slug, {:name=>"index_creators_on_slug"})
2025-07-25T09:37:50.294006286Z    -> 0.0001s
2025-07-25T09:37:50.294014172Z == 20230615135601 AddSlugs: migrated (0.0024s) ================================
2025-07-25T09:37:50.294022559Z 
2025-07-25T09:37:50.294030334Z Migrating to GenerateSlugs (20230617222353)
2025-07-25T09:37:50.294038531Z == 20230617222353 GenerateSlugs: migrating ====================================
2025-07-25T09:37:50.294046838Z == 20230617222353 GenerateSlugs: migrated (0.0112s) ===========================
2025-07-25T09:37:50.294054904Z 
2025-07-25T09:37:50.294062669Z Migrating to MakeNamesUnique (20230628194944)
2025-07-25T09:37:50.294070816Z == 20230628194944 MakeNamesUnique: migrating ==================================
2025-07-25T09:37:50.294079243Z == 20230628194944 MakeNamesUnique: migrated (0.0008s) =========================
2025-07-25T09:37:50.294087510Z 
2025-07-25T09:37:50.294095265Z Migrating to AddUniqueConstraintToNamesAndSlugs (20230628195018)
2025-07-25T09:37:50.294103301Z == 20230628195018 AddUniqueConstraintToNamesAndSlugs: migrating ===============
2025-07-25T09:37:50.294111358Z -- add_index(:creators, :name, {:unique=>true, :name=>"index_creators_on_name"})
2025-07-25T09:37:50.294119724Z    -> 0.0002s
2025-07-25T09:37:50.294127620Z -- remove_index(:creators, :slug)
2025-07-25T09:37:50.294135797Z    -> 0.0004s
2025-07-25T09:37:50.294143713Z -- add_index(:creators, :slug, {:unique=>true, :name=>"index_creators_on_slug"})
2025-07-25T09:37:50.294152019Z    -> 0.0001s
2025-07-25T09:37:50.294159995Z -- add_index(:collections, :name, {:unique=>true, :name=>"index_collections_on_name"})
2025-07-25T09:37:50.294168312Z    -> 0.0001s
2025-07-25T09:37:50.294176168Z -- remove_index(:collections, :slug)
2025-07-25T09:37:50.294184094Z    -> 0.0031s
2025-07-25T09:37:50.294192371Z -- add_index(:collections, :slug, {:unique=>true, :name=>"index_collections_on_slug"})
2025-07-25T09:37:50.294200818Z    -> 0.0002s
2025-07-25T09:37:50.294208693Z == 20230628195018 AddUniqueConstraintToNamesAndSlugs: migrated (0.0044s) ======
2025-07-25T09:37:50.294216780Z 
2025-07-25T09:37:50.294224555Z Migrating to AddSizeToModelFiles (20230707082403)
2025-07-25T09:37:50.294232511Z == 20230707082403 AddSizeToModelFiles: migrating ==============================
2025-07-25T09:37:50.294240618Z -- add_column(:model_files, :size, :integer)
2025-07-25T09:37:50.294249776Z    -> 0.0006s
2025-07-25T09:37:50.294259436Z == 20230707082403 AddSizeToModelFiles: migrated (0.0007s) =====================
2025-07-25T09:37:50.294279436Z 
2025-07-25T09:37:50.294287422Z Migrating to ChangeFileSizeToBigInt (20230710102250)
2025-07-25T09:37:50.294295468Z == 20230710102250 ChangeFileSizeToBigInt: migrating ===========================
2025-07-25T09:37:50.294303585Z -- change_column(:model_files, :size, :bigint)
2025-07-25T09:37:50.294311601Z    -> 0.0063s
2025-07-25T09:37:50.294320549Z == 20230710102250 ChangeFileSizeToBigInt: migrated (0.0065s) ==================
2025-07-25T09:37:50.294330569Z 
2025-07-25T09:37:50.294340188Z Migrating to AddNoteToProblems (20230711111009)
2025-07-25T09:37:50.294348385Z == 20230711111009 AddNoteToProblems: migrating ================================
2025-07-25T09:37:50.294356451Z -- add_column(:problems, :note, :string, {:default=>nil})
2025-07-25T09:37:50.294364497Z    -> 0.0008s
2025-07-25T09:37:50.294372383Z == 20230711111009 AddNoteToProblems: migrated (0.0008s) =======================
2025-07-25T09:37:50.294380389Z 
2025-07-25T09:37:50.294388596Z Migrating to AddProblemSettingsToUser (20240122114207)
2025-07-25T09:37:50.294396492Z == 20240122114207 AddProblemSettingsToUser: migrating =========================
2025-07-25T09:37:50.294405249Z -- add_column(:users, :problem_settings, :json, {:default=>{"missing"=>:danger, "empty"=>:info, "nesting"=>:warning, "inefficient"=>:info, "duplicate"=>:warning, "no_image"=>:silent, "no_3d_model"=>:silent, "non_manifold"=>:warning, "inside_out"=>:warning, "no_license"=>:silent, "no_links"=>:silent, "no_creator"=>:silent, "no_tags"=>:silent}})
2025-07-25T09:37:50.294418376Z    -> 0.0006s
2025-07-25T09:37:50.294426282Z == 20240122114207 AddProblemSettingsToUser: migrated (0.0006s) ================
2025-07-25T09:37:50.294434318Z 
2025-07-25T09:37:50.294442043Z Migrating to AddLicenseToModel (20240127143358)
2025-07-25T09:37:50.294449969Z == 20240127143358 AddLicenseToModel: migrating ================================
2025-07-25T09:37:50.294457985Z -- add_column(:models, :license, :string)
2025-07-25T09:37:50.294465901Z    -> 0.0005s
2025-07-25T09:37:50.294473757Z == 20240127143358 AddLicenseToModel: migrated (0.0006s) =======================
2025-07-25T09:37:50.294482204Z 
2025-07-25T09:37:50.294490351Z Migrating to AddIgnoredToProblems (20240131134832)
2025-07-25T09:37:50.294498507Z == 20240131134832 AddIgnoredToProblems: migrating =============================
2025-07-25T09:37:50.294506563Z -- add_column(:problems, :ignored, :boolean, {:default=>false, :null=>false})
2025-07-25T09:37:50.294514850Z    -> 0.0007s
2025-07-25T09:37:50.294523397Z == 20240131134832 AddIgnoredToProblems: migrated (0.0007s) ====================
2025-07-25T09:37:50.294531744Z 
2025-07-25T09:37:50.294539510Z Migrating to AddPresupportedVersionToModelFiles (20240208143319)
2025-07-25T09:37:50.294557516Z == 20240208143319 AddPresupportedVersionToModelFiles: migrating ===============
2025-07-25T09:37:50.294565983Z -- add_reference(:model_files, :presupported_version, {:foreign_key=>{:to_table=>:model_files}})
2025-07-25T09:37:50.294574590Z    -> 0.0092s
2025-07-25T09:37:50.294582656Z == 20240208143319 AddPresupportedVersionToModelFiles: migrated (0.0092s) ======
2025-07-25T09:37:50.294590733Z 
2025-07-25T09:37:50.294598639Z Migrating to AddFileListSettingsToUser (20240209125409)
2025-07-25T09:37:50.294606795Z == 20240209125409 AddFileListSettingsToUser: migrating ========================
2025-07-25T09:37:50.294615062Z -- add_column(:users, :file_list_settings, :json, {:default=>{"hide_presupported_versions"=>true}})
2025-07-25T09:37:50.294623829Z    -> 0.0007s
2025-07-25T09:37:50.294631886Z == 20240209125409 AddFileListSettingsToUser: migrated (0.0007s) ===============
2025-07-25T09:37:50.294640052Z 
2025-07-25T09:37:50.294648579Z Migrating to AddMissingUniqueIndexes (20240228130246)
2025-07-25T09:37:50.294656695Z == 20240228130246 AddMissingUniqueIndexes: migrating ==========================
2025-07-25T09:37:50.294665223Z -- add_index(:libraries, :path, {:unique=>true, :name=>"index_libraries_on_path"})
2025-07-25T09:37:50.294674010Z    -> 0.0002s
2025-07-25T09:37:50.294682167Z -- add_index(:models, [:path, :library_id], {:unique=>true, :name=>"index_models_on_path_and_library_id"})
2025-07-25T09:37:50.294691195Z    -> 0.0001s
2025-07-25T09:37:50.294699502Z -- add_index(:model_files, [:filename, :model_id], {:unique=>true, :name=>"index_model_files_on_filename_and_model_id"})
2025-07-25T09:37:50.294708179Z    -> 0.0001s
2025-07-25T09:37:50.294716336Z -- add_index(:problems, [:category, :problematic_id, :problematic_type], {:unique=>true, :name=>"index_problems_on_category_and_problematic_id_and_type"})
2025-07-25T09:37:50.294726456Z    -> 0.0006s
2025-07-25T09:37:50.294736466Z == 20240228130246 AddMissingUniqueIndexes: migrated (0.0011s) =================
2025-07-25T09:37:50.294746897Z 
2025-07-25T09:37:50.294756316Z Migrating to CreateFlipperTables (20240306095646)
2025-07-25T09:37:50.294764843Z == 20240306095646 CreateFlipperTables: migrating ==============================
2025-07-25T09:37:50.294772889Z -- create_table(:flipper_features)
2025-07-25T09:37:50.294780956Z    -> 0.0007s
2025-07-25T09:37:50.294788872Z -- add_index(:flipper_features, :key, {:unique=>true, :name=>"index_flipper_features_on_key"})
2025-07-25T09:37:50.294797198Z    -> 0.0007s
2025-07-25T09:37:50.294805796Z -- create_table(:flipper_gates)
2025-07-25T09:37:50.294815455Z    -> 0.0002s
2025-07-25T09:37:50.294825095Z -- add_index(:flipper_gates, [:feature_key, :key, :value], {:unique=>true, :length=>{:value=>255}, :name=>"index_flipper_gates_on_feature_key_and_key_and_value"})
2025-07-25T09:37:50.294848231Z    -> 0.0001s
2025-07-25T09:37:50.520094056Z == 20240306095646 CreateFlipperTables: migrated (0.0019s) =====================
2025-07-25T09:37:50.520146351Z 
2025-07-25T09:37:50.520158445Z Migrating to RolifyCreateRoles (20240319155251)
2025-07-25T09:37:50.520169137Z == 20240319155251 RolifyCreateRoles: migrating ================================
2025-07-25T09:37:50.520180960Z -- create_table(:roles)
2025-07-25T09:37:50.520191482Z    -> 0.0039s
2025-07-25T09:37:50.520202774Z -- create_table(:users_roles, {:id=>false})
2025-07-25T09:37:50.520213336Z    -> 0.0004s
2025-07-25T09:37:50.520223747Z -- add_index(:roles, :name, {:name=>"index_roles_on_name"})
2025-07-25T09:37:50.520234789Z    -> 0.0006s
2025-07-25T09:37:50.520246021Z -- add_index(:roles, [:name, :resource_type, :resource_id], {:name=>"index_roles_on_name_and_resource_type_and_resource_id"})
2025-07-25T09:37:50.520257134Z    -> 0.0001s
2025-07-25T09:37:50.520267705Z -- add_index(:users_roles, [:user_id, :role_id], {:name=>"index_users_roles_on_user_id_and_role_id"})
2025-07-25T09:37:50.520278607Z    -> 0.0001s
2025-07-25T09:37:50.520288898Z == 20240319155251 RolifyCreateRoles: migrated (0.0072s) =======================
2025-07-25T09:37:50.520298677Z 
2025-07-25T09:37:50.520307806Z Migrating to ConvertAdminFlagToRole (20240319155526)
2025-07-25T09:37:50.520317205Z == 20240319155526 ConvertAdminFlagToRole: migrating ===========================
2025-07-25T09:37:50.520326694Z == 20240319155526 ConvertAdminFlagToRole: migrated (0.0035s) ==================
2025-07-25T09:37:50.520336574Z 
2025-07-25T09:37:50.520346374Z Migrating to RemoveAdminFromUsers (20240319155903)
2025-07-25T09:37:50.520355823Z == 20240319155903 RemoveAdminFromUsers: migrating =============================
2025-07-25T09:37:50.520365332Z -- remove_column(:users, :admin, :boolean, {:default=>false, :null=>false})
2025-07-25T09:37:50.520375111Z    -> 0.0162s
2025-07-25T09:37:50.520384370Z == 20240319155903 RemoveAdminFromUsers: migrated (0.0165s) ====================
2025-07-25T09:37:50.520394050Z 
2025-07-25T09:37:50.520403378Z Migrating to AddResetPasswordTokenToUsers (20240322143621)
2025-07-25T09:37:50.520413819Z == 20240322143621 AddResetPasswordTokenToUsers: migrating =====================
2025-07-25T09:37:50.520423749Z -- add_column(:users, :reset_password_token, :string)
2025-07-25T09:37:50.520434250Z    -> 0.0009s
2025-07-25T09:37:50.520444341Z -- add_index(:users, :reset_password_token, {:unique=>true, :name=>"index_users_on_reset_password_token"})
2025-07-25T09:37:50.520455122Z    -> 0.0004s
2025-07-25T09:37:50.520508590Z == 20240322143621 AddResetPasswordTokenToUsers: migrated (0.0018s) ============
2025-07-25T09:37:50.520520815Z 
2025-07-25T09:37:50.520530675Z Migrating to SetAdminPasswordResetToken (20240322150022)
2025-07-25T09:37:50.520541166Z == 20240322150022 SetAdminPasswordResetToken: migrating =======================
2025-07-25T09:37:50.520551486Z == 20240322150022 SetAdminPasswordResetToken: migrated (0.0052s) ==============
2025-07-25T09:37:50.520561817Z 
2025-07-25T09:37:50.520571968Z Migrating to AddRememberableToUsers (20240410221112)
2025-07-25T09:37:50.520582739Z == 20240410221112 AddRememberableToUsers: migrating ===========================
2025-07-25T09:37:50.520593080Z -- add_column(:users, :remember_created_at, :datetime)
2025-07-25T09:37:50.520602850Z    -> 0.0006s
2025-07-25T09:37:50.520613111Z == 20240410221112 AddRememberableToUsers: migrated (0.0009s) ==================
2025-07-25T09:37:50.520621297Z 
2025-07-25T09:37:50.520629103Z Migrating to AddResetPasswordSentAtToUsers (20240410222922)
2025-07-25T09:37:50.520637129Z == 20240410222922 AddResetPasswordSentAtToUsers: migrating ====================
2025-07-25T09:37:50.520645255Z -- add_column(:users, :reset_password_sent_at, :datetime)
2025-07-25T09:37:50.520653402Z    -> 0.0007s
2025-07-25T09:37:50.520661328Z == 20240410222922 AddResetPasswordSentAtToUsers: migrated (0.0021s) ===========
2025-07-25T09:37:50.520669404Z 
2025-07-25T09:37:50.520677500Z Migrating to DropDelayedJobs (20240418112821)
2025-07-25T09:37:50.520685807Z == 20240418112821 DropDelayedJobs: migrating ==================================
2025-07-25T09:37:50.520693913Z -- drop_table(:delayed_jobs)
2025-07-25T09:37:50.520701849Z    -> 0.0006s
2025-07-25T09:37:50.520710306Z == 20240418112821 DropDelayedJobs: migrated (0.0010s) =========================
2025-07-25T09:37:50.520718372Z 
2025-07-25T09:37:50.520726128Z Migrating to AddInterfaceLanguageToUsers (20240423102250)
2025-07-25T09:37:50.520734224Z == 20240423102250 AddInterfaceLanguageToUsers: migrating ======================
2025-07-25T09:37:50.520742301Z -- add_column(:users, :interface_language, :string)
2025-07-25T09:37:50.520750287Z    -> 0.0013s
2025-07-25T09:37:50.520758173Z == 20240423102250 AddInterfaceLanguageToUsers: migrated (0.0014s) =============
2025-07-25T09:37:50.520766229Z 
2025-07-25T09:37:50.520774015Z Migrating to AddLockableToUsers (20240610120318)
2025-07-25T09:37:50.520781991Z == 20240610120318 AddLockableToUsers: migrating ===============================
2025-07-25T09:37:50.520790367Z -- change_table(:users)
2025-07-25T09:37:50.520798263Z    -> 0.0013s
2025-07-25T09:37:50.520806119Z == 20240610120318 AddLockableToUsers: migrated (0.0014s) ======================
2025-07-25T09:37:50.520826029Z 
2025-07-25T09:37:50.520833915Z Migrating to AddAttachmentDataToModelFiles (20240614085913)
2025-07-25T09:37:50.520842142Z == 20240614085913 AddAttachmentDataToModelFiles: migrating ====================
2025-07-25T09:37:50.520850278Z -- add_column(:model_files, :attachment_data, :json)
2025-07-25T09:37:50.520858525Z    -> 0.0006s
2025-07-25T09:37:50.520866781Z == 20240614085913 AddAttachmentDataToModelFiles: migrated (0.0008s) ===========
2025-07-25T09:37:50.520875719Z 
2025-07-25T09:37:50.520883976Z Migrating to MoveFileDataIntoShrine (20240615085913)
2025-07-25T09:37:50.520895038Z == 20240615085913 MoveFileDataIntoShrine: migrating ===========================
2025-07-25T09:37:50.520903195Z == 20240615085913 MoveFileDataIntoShrine: migrated (0.0025s) ==================
2025-07-25T09:37:50.520911411Z 
2025-07-25T09:37:50.520919888Z Migrating to AddStorageServiceToLibraries (20240701142651)
2025-07-25T09:37:50.520928275Z == 20240701142651 AddStorageServiceToLibraries: migrating =====================
2025-07-25T09:37:50.520936562Z -- add_column(:libraries, :storage_service, :string, {:null=>false, :default=>"filesystem"})
2025-07-25T09:37:50.520945209Z    -> 0.0006s
2025-07-25T09:37:50.520953566Z == 20240701142651 AddStorageServiceToLibraries: migrated (0.0011s) ============
2025-07-25T09:37:50.520961903Z 
2025-07-25T09:37:50.520970240Z Migrating to AddS3FieldsToLibrary (20240703103707)
2025-07-25T09:37:50.520978927Z == 20240703103707 AddS3FieldsToLibrary: migrating =============================
2025-07-25T09:37:50.520987474Z -- add_column(:libraries, :s3_endpoint, :string, {:default=>nil})
2025-07-25T09:37:50.520995621Z    -> 0.0006s
2025-07-25T09:37:50.521003557Z -- add_column(:libraries, :s3_region, :string, {:default=>nil})
2025-07-25T09:37:50.521013256Z    -> 0.0005s
2025-07-25T09:37:50.521023036Z -- add_column(:libraries, :s3_bucket, :string, {:default=>nil})
2025-07-25T09:37:50.521033216Z    -> 0.0005s
2025-07-25T09:37:50.521042736Z -- add_column(:libraries, :s3_access_key_id, :string, {:default=>nil})
2025-07-25T09:37:50.521052946Z    -> 0.0005s
2025-07-25T09:37:50.521063718Z -- add_column(:libraries, :s3_secret_access_key, :string, {:default=>nil})
2025-07-25T09:37:50.521074059Z    -> 0.0006s
2025-07-25T09:37:50.521083989Z == 20240703103707 AddS3FieldsToLibrary: migrated (0.0030s) ====================
2025-07-25T09:37:50.521094700Z 
2025-07-25T09:37:50.521104861Z Migrating to ChangeIndexOnLibraryPath (20240703160732)
2025-07-25T09:37:50.521114500Z == 20240703160732 ChangeIndexOnLibraryPath: migrating =========================
2025-07-25T09:37:50.521122767Z -- remove_index(:libraries, :path)
2025-07-25T09:37:50.521141655Z    -> 0.0004s
2025-07-25T09:37:50.521150082Z == 20240703160732 ChangeIndexOnLibraryPath: migrated (0.0005s) ================
2025-07-25T09:37:50.521158138Z 
2025-07-25T09:37:50.521165883Z Migrating to CreateFederailsActors (20240727113215)
2025-07-25T09:37:50.521173799Z == 20240727113215 CreateFederailsActors: migrating ============================
2025-07-25T09:37:50.521182046Z -- create_table(:federails_actors)
2025-07-25T09:37:50.521189972Z    -> 0.0008s
2025-07-25T09:37:50.521197858Z -- foreign_key_exists?(:federails_actors, :users)
2025-07-25T09:37:50.521205844Z    -> 0.0007s
2025-07-25T09:37:50.521213820Z -- remove_foreign_key(:federails_actors, :users)
2025-07-25T09:37:50.521222177Z    -> 0.0073s
2025-07-25T09:37:50.521230093Z -- remove_index(:federails_actors, :user_id)
2025-07-25T09:37:50.521238049Z    -> 0.0004s
2025-07-25T09:37:50.521246005Z -- add_index(:federails_actors, :user_id, {:unique=>true, :name=>"index_federails_actors_on_user_id"})
2025-07-25T09:37:50.521254432Z    -> 0.0001s
2025-07-25T09:37:50.521262348Z -- add_foreign_key(:federails_actors, :users)
2025-07-25T09:37:50.521270294Z    -> 0.0072s
2025-07-25T09:37:50.521278270Z == 20240727113215 CreateFederailsActors: migrated (0.0166s) ===================
2025-07-25T09:37:50.521286356Z 
2025-07-25T09:37:50.521294112Z Migrating to CreateFederailsFollowings (20240727113216)
2025-07-25T09:37:50.521302428Z == 20240727113216 CreateFederailsFollowings: migrating ========================
2025-07-25T09:37:50.521310475Z -- create_table(:federails_followings)
2025-07-25T09:37:50.521318421Z    -> 0.0008s
2025-07-25T09:37:50.521326347Z == 20240727113216 CreateFederailsFollowings: migrated (0.0008s) ===============
2025-07-25T09:37:50.521334403Z 
2025-07-25T09:37:50.521342218Z Migrating to CreateFederailsActivities (20240727113217)
2025-07-25T09:37:50.521350225Z == 20240727113217 CreateFederailsActivities: migrating ========================
2025-07-25T09:37:50.521358251Z -- create_table(:federails_activities)
2025-07-25T09:37:50.521366117Z    -> 0.0017s
2025-07-25T09:37:50.521374023Z == 20240727113217 CreateFederailsActivities: migrated (0.0017s) ===============
2025-07-25T09:37:50.521382389Z 
2025-07-25T09:37:50.521390626Z Migrating to ChangeActorEntityRelToPolymorphic (20240731165646)
2025-07-25T09:37:50.521401498Z == 20240731165646 ChangeActorEntityRelToPolymorphic: migrating ================
2025-07-25T09:37:50.521412129Z -- remove_foreign_key(:federails_actors, {:column=>:user_id, :to_table=>"users"})
2025-07-25T09:37:50.521422961Z    -> 0.0077s
2025-07-25T09:37:50.521431679Z -- remove_index(:federails_actors, :user_id, {:unique=>true})
2025-07-25T09:37:50.521453202Z    -> 0.0004s
2025-07-25T09:37:50.521463753Z -- change_table(:federails_actors)
2025-07-25T09:37:50.521474144Z    -> 0.0067s
2025-07-25T09:37:50.521484144Z == 20240731165646 ChangeActorEntityRelToPolymorphic: migrated (0.0149s) =======
2025-07-25T09:37:50.521494485Z 
2025-07-25T09:37:50.521504415Z Migrating to CreateFederailsActors (20240731165647)
2025-07-25T09:37:50.521512531Z == 20240731165647 CreateFederailsActors: migrating ============================
2025-07-25T09:37:50.521520578Z == 20240731165647 CreateFederailsActors: migrated (0.0000s) ===================
2025-07-25T09:37:50.521528684Z 
2025-07-25T09:37:50.521537582Z Migrating to CreateMoreFederailsActors (20240802094448)
2025-07-25T09:37:50.521546169Z == 20240802094448 CreateMoreFederailsActors: migrating ========================
2025-07-25T09:37:50.521554195Z == 20240802094448 CreateMoreFederailsActors: migrated (0.0000s) ===============
2025-07-25T09:37:50.521562252Z 
2025-07-25T09:37:50.521570468Z Migrating to BackfillActivities (20240805111500)
2025-07-25T09:37:50.521578424Z == 20240805111500 BackfillActivities: migrating ===============================
2025-07-25T09:37:50.521586420Z == 20240805111500 BackfillActivities: migrated (0.0000s) ======================
2025-07-25T09:37:50.521594476Z 
2025-07-25T09:37:50.521602172Z Migrating to CreateCaberRelations (20240827155630)
2025-07-25T09:37:50.521610128Z == 20240827155630 CreateCaberRelations: migrating =============================
2025-07-25T09:37:50.521618274Z -- create_table(:caber_relations)
2025-07-25T09:37:50.521626170Z    -> 0.0054s
2025-07-25T09:37:50.521634086Z == 20240827155630 CreateCaberRelations: migrated (0.0054s) ====================
2025-07-25T09:37:50.521642192Z 
2025-07-25T09:37:50.521649938Z Migrating to AddDefaultAccessControls (20240830121749)
2025-07-25T09:37:50.521657924Z == 20240830121749 AddDefaultAccessControls: migrating =========================
2025-07-25T09:37:50.521665890Z == 20240830121749 AddDefaultAccessControls: migrated (0.0071s) ================
2025-07-25T09:37:50.521674217Z 
2025-07-25T09:37:50.521682113Z Migrating to RenameDefaultRoles (20240830151650)
2025-07-25T09:37:50.521690520Z == 20240830151650 RenameDefaultRoles: migrating ===============================
2025-07-25T09:37:50.521699307Z == 20240830151650 RenameDefaultRoles: migrated (0.0074s) ======================
2025-07-25T09:37:50.521707714Z 
2025-07-25T09:37:50.521715610Z Migrating to AddPublicIDsToModels (20240904151944)
2025-07-25T09:37:50.521723546Z == 20240904151944 AddPublicIDsToModels: migrating =============================
2025-07-25T09:37:50.521732264Z -- add_column(:models, :public_id, :string)
2025-07-25T09:37:50.521751442Z    -> 0.0007s
2025-07-25T09:37:50.521759599Z -- add_index(:models, :public_id)
2025-07-25T09:37:50.521767765Z    -> 0.0004s
2025-07-25T09:37:50.521776403Z -- add_column(:model_files, :public_id, :string)
2025-07-25T09:37:50.521784609Z    -> 0.0006s
2025-07-25T09:37:50.521792936Z -- add_index(:model_files, :public_id)
2025-07-25T09:37:50.521801704Z    -> 0.0001s
2025-07-25T09:37:50.521811573Z -- add_column(:problems, :public_id, :string)
2025-07-25T09:37:50.779326487Z    -> 0.0006s
2025-07-25T09:37:50.779364513Z -- add_index(:problems, :public_id)
2025-07-25T09:37:50.779374123Z    -> 0.0001s
2025-07-25T09:37:50.779382820Z -- add_column(:creators, :public_id, :string)
2025-07-25T09:37:50.779391768Z    -> 0.0006s
2025-07-25T09:37:50.779400055Z -- add_index(:creators, :public_id)
2025-07-25T09:37:50.779408542Z    -> 0.0001s
2025-07-25T09:37:50.779416729Z -- add_column(:collections, :public_id, :string)
2025-07-25T09:37:50.779425005Z    -> 0.0006s
2025-07-25T09:37:50.779433152Z -- add_index(:collections, :public_id)
2025-07-25T09:37:50.779441548Z    -> 0.0001s
2025-07-25T09:37:50.779449464Z -- add_column(:libraries, :public_id, :string)
2025-07-25T09:37:50.779457661Z    -> 0.0006s
2025-07-25T09:37:50.779465787Z -- add_index(:libraries, :public_id)
2025-07-25T09:37:50.779473884Z    -> 0.0001s
2025-07-25T09:37:50.779482260Z == 20240904151944 AddPublicIDsToModels: migrated (0.0051s) ====================
2025-07-25T09:37:50.779490457Z 
2025-07-25T09:37:50.779498333Z Migrating to GeneratePublicIDsForModels (20240904152358)
2025-07-25T09:37:50.779506459Z == 20240904152358 GeneratePublicIDsForModels: migrating =======================
2025-07-25T09:37:50.779514535Z Scoped order is ignored, use :cursor with :order to configure custom order.
2025-07-25T09:37:50.779522592Z == 20240904152358 GeneratePublicIDsForModels: migrated (0.0153s) ==============
2025-07-25T09:37:50.779530658Z 
2025-07-25T09:37:50.779538424Z Migrating to BackfillActivitiesAfterPermissions (20240909100000)
2025-07-25T09:37:50.779546670Z == 20240909100000 BackfillActivitiesAfterPermissions: migrating ===============
2025-07-25T09:37:50.779554696Z == 20240909100000 BackfillActivitiesAfterPermissions: migrated (0.0000s) ======
2025-07-25T09:37:50.779562752Z 
2025-07-25T09:37:50.779571400Z Migrating to DeduplicateRoles (20240923114515)
2025-07-25T09:37:50.779579386Z == 20240923114515 DeduplicateRoles: migrating =================================
2025-07-25T09:37:50.779587412Z == 20240923114515 DeduplicateRoles: migrated (0.0029s) ========================
2025-07-25T09:37:50.779626040Z 
2025-07-25T09:37:50.779634076Z Migrating to AddVirtualColumnsForSorting (20240924122004)
2025-07-25T09:37:50.779642092Z == 20240924122004 AddVirtualColumnsForSorting: migrating ======================
2025-07-25T09:37:50.779650148Z -- add_column(:models, :name_lower, :virtual, {:type=>:string, :as=>"LOWER(name)", :stored=>true})
2025-07-25T09:37:50.779658976Z    -> 0.0170s
2025-07-25T09:37:50.779667153Z -- add_index(:models, :name_lower)
2025-07-25T09:37:50.779675099Z    -> 0.0002s
2025-07-25T09:37:50.779683015Z -- add_column(:creators, :name_lower, :virtual, {:type=>:string, :as=>"LOWER(name)", :stored=>true})
2025-07-25T09:37:50.779691602Z    -> 0.0072s
2025-07-25T09:37:50.779700159Z -- add_index(:creators, :name_lower)
2025-07-25T09:37:50.779709067Z    -> 0.0001s
2025-07-25T09:37:50.779716993Z -- add_column(:collections, :name_lower, :virtual, {:type=>:string, :as=>"LOWER(name)", :stored=>true})
2025-07-25T09:37:50.779725450Z    -> 0.0085s
2025-07-25T09:37:50.779733887Z -- add_index(:collections, :name_lower)
2025-07-25T09:37:50.779742043Z    -> 0.0001s
2025-07-25T09:37:50.779750080Z == 20240924122004 AddVirtualColumnsForSorting: migrated (0.0332s) =============
2025-07-25T09:37:50.779758527Z 
2025-07-25T09:37:50.779766302Z Migrating to AddKeypairToActors (20240926162407)
2025-07-25T09:37:50.779774469Z == 20240926162407 AddKeypairToActors: migrating ===============================
2025-07-25T09:37:50.779784449Z -- change_table(:federails_actors)
2025-07-25T09:37:50.779792695Z    -> 0.0014s
2025-07-25T09:37:50.779801193Z == 20240926162407 AddKeypairToActors: migrated (0.0014s) ======================
2025-07-25T09:37:50.779809379Z 
2025-07-25T09:37:50.779817606Z Migrating to AddUuids (20241004194445)
2025-07-25T09:37:50.779825642Z == 20241004194445 AddUuids: migrating =========================================
2025-07-25T09:37:50.779833968Z -- change_table(:federails_actors)
2025-07-25T09:37:50.779842415Z    -> 0.0017s
2025-07-25T09:37:50.779866093Z -- change_table(:federails_activities)
2025-07-25T09:37:50.779874400Z    -> 0.0009s
2025-07-25T09:37:50.779882536Z -- change_table(:federails_followings)
2025-07-25T09:37:50.779890482Z    -> 0.0009s
2025-07-25T09:37:50.779898649Z == 20241004194445 AddUuids: migrated (0.0035s) ================================
2025-07-25T09:37:50.779906655Z 
2025-07-25T09:37:50.779914380Z Migrating to CreateComments (20241007182824)
2025-07-25T09:37:50.779922336Z == 20241007182824 CreateComments: migrating ===================================
2025-07-25T09:37:50.779930513Z -- create_table(:comments)
2025-07-25T09:37:50.779948339Z    -> 0.0013s
2025-07-25T09:37:50.779956806Z == 20241007182824 CreateComments: migrated (0.0013s) ==========================
2025-07-25T09:37:50.779964842Z 
2025-07-25T09:37:50.779972578Z Migrating to AddSystemToComments (20241009122540)
2025-07-25T09:37:50.779980794Z == 20241009122540 AddSystemToComments: migrating ==============================
2025-07-25T09:37:50.779988800Z -- add_column(:comments, :system, :boolean, {:null=>false, :default=>false})
2025-07-25T09:37:50.779997077Z    -> 0.0009s
2025-07-25T09:37:50.780004983Z == 20241009122540 AddSystemToComments: migrated (0.0009s) =====================
2025-07-25T09:37:50.780013039Z 
2025-07-25T09:37:50.780020975Z Migrating to BackfillActivitiesAfterUuids (20241013215000)
2025-07-25T09:37:50.780028971Z == 20241013215000 BackfillActivitiesAfterUuids: migrating =====================
2025-07-25T09:37:50.780037438Z == 20241013215000 BackfillActivitiesAfterUuids: migrated (0.0013s) ============
2025-07-25T09:37:50.780045554Z 
2025-07-25T09:37:50.780053480Z Migrating to AddOmniauthToUsers (20241015090803)
2025-07-25T09:37:50.780061767Z == 20241015090803 AddOmniauthToUsers: migrating ===============================
2025-07-25T09:37:50.780070064Z -- add_column(:users, :auth_provider, :string)
2025-07-25T09:37:50.780078010Z    -> 0.0008s
2025-07-25T09:37:50.780086387Z -- add_column(:users, :auth_uid, :string)
2025-07-25T09:37:50.780094303Z    -> 0.0007s
2025-07-25T09:37:50.780102178Z == 20241015090803 AddOmniauthToUsers: migrated (0.0016s) ======================
2025-07-25T09:37:50.780110295Z 
2025-07-25T09:37:50.780118000Z Migrating to AddSensitiveFlagToModelsAndComments (20241017093301)
2025-07-25T09:37:50.780126047Z == 20241017093301 AddSensitiveFlagToModelsAndComments: migrating ==============
2025-07-25T09:37:50.780134133Z -- add_column(:models, :sensitive, :boolean, {:null=>false, :default=>false})
2025-07-25T09:37:50.780142690Z    -> 0.0008s
2025-07-25T09:37:50.780151027Z -- add_column(:comments, :sensitive, :boolean, {:null=>false, :default=>false})
2025-07-25T09:37:50.780159203Z    -> 0.0009s
2025-07-25T09:37:50.780167751Z == 20241017093301 AddSensitiveFlagToModelsAndComments: migrated (0.0017s) =====
2025-07-25T09:37:50.780176248Z 
2025-07-25T09:37:50.780185025Z Migrating to AddSensitiveContentHandlingToUsers (20241017113112)
2025-07-25T09:37:50.780193122Z == 20241017113112 AddSensitiveContentHandlingToUsers: migrating ===============
2025-07-25T09:37:50.780201168Z -- add_column(:users, :sensitive_content_handling, :string, {:default=>nil})
2025-07-25T09:37:50.780209324Z    -> 0.0008s
2025-07-25T09:37:50.780217691Z == 20241017113112 AddSensitiveContentHandlingToUsers: migrated (0.0008s) ======
2025-07-25T09:37:50.780234906Z 
2025-07-25T09:37:50.780242701Z Migrating to AddPublicIDsToUsers (20241021124608)
2025-07-25T09:37:50.780250627Z == 20241021124608 AddPublicIDsToUsers: migrating ==============================
2025-07-25T09:37:50.780258644Z -- change_table(:users)
2025-07-25T09:37:50.780266499Z    -> 0.0010s
2025-07-25T09:37:50.780274375Z == 20241021124608 AddPublicIDsToUsers: migrated (0.0010s) =====================
2025-07-25T09:37:50.780282381Z 
2025-07-25T09:37:50.780290127Z Migrating to CreatePublicIDsForUsers (20241021125322)
2025-07-25T09:37:50.780298093Z == 20241021125322 CreatePublicIDsForUsers: migrating ==========================
2025-07-25T09:37:50.780306089Z == 20241021125322 CreatePublicIDsForUsers: migrated (0.0028s) =================
2025-07-25T09:37:50.780314095Z 
2025-07-25T09:37:50.780321801Z Migrating to RemoveUnneededIndexes (20241025110218)
2025-07-25T09:37:50.780330137Z == 20241025110218 RemoveUnneededIndexes: migrating ============================
2025-07-25T09:37:50.780338214Z -- remove_index(:favorites, {:name=>"index_favorites_on_favoritable", :column=>[:favoritable_type, :favoritable_id]})
2025-07-25T09:37:50.780346801Z    -> 0.0009s
2025-07-25T09:37:50.780354827Z -- remove_index(:federails_followings, {:name=>"index_federails_followings_on_actor_id", :column=>:actor_id})
2025-07-25T09:37:50.780363354Z    -> 0.0006s
2025-07-25T09:37:50.780371220Z -- remove_index(:roles, {:name=>"index_roles_on_name", :column=>:name})
2025-07-25T09:37:50.780379617Z    -> 0.0004s
2025-07-25T09:37:50.780390218Z -- remove_index(:taggings, {:name=>"index_taggings_on_tag_id", :column=>:tag_id})
2025-07-25T09:37:50.780398685Z    -> 0.0009s
2025-07-25T09:37:50.780406591Z -- remove_index(:taggings, {:name=>"index_taggings_on_taggable_id", :column=>:taggable_id})
2025-07-25T09:37:50.780415960Z    -> 0.0008s
2025-07-25T09:37:50.780424107Z -- remove_index(:taggings, {:name=>"index_taggings_on_tagger_id", :column=>:tagger_id})
2025-07-25T09:37:50.780432443Z    -> 0.0007s
2025-07-25T09:37:50.780440530Z -- remove_index(:users_roles, {:name=>"index_users_roles_on_user_id", :column=>:user_id})
2025-07-25T09:37:50.780448917Z    -> 0.0004s
2025-07-25T09:37:50.780456782Z == 20241025110218 RemoveUnneededIndexes: migrated (0.0049s) ===================
2025-07-25T09:37:50.780464879Z 
2025-07-25T09:37:50.780472835Z Migrating to AddInProgressToProblems (20241105121830)
2025-07-25T09:37:50.780480951Z == 20241105121830 AddInProgressToProblems: migrating ==========================
2025-07-25T09:37:50.780489198Z -- add_column(:problems, :in_progress, :boolean, {:default=>false, :null=>false})
2025-07-25T09:37:50.780497484Z    -> 0.0008s
2025-07-25T09:37:50.780515791Z == 20241105121830 AddInProgressToProblems: migrated (0.0009s) =================
2025-07-25T09:37:50.780524228Z 
2025-07-25T09:37:50.780532224Z Migrating to ClearStuckProblems (20241118155027)
2025-07-25T09:37:50.780540772Z == 20241118155027 ClearStuckProblems: migrating ===============================
2025-07-25T09:37:50.780548948Z == 20241118155027 ClearStuckProblems: migrated (0.0054s) ======================
2025-07-25T09:37:50.780557245Z 
2025-07-25T09:37:50.780565361Z Migrating to AddApprovedToUser (20241122121621)
2025-07-25T09:37:50.780573307Z == 20241122121621 AddApprovedToUser: migrating ================================
2025-07-25T09:37:50.780582526Z -- change_table(:users)
2025-07-25T09:37:50.780591003Z    -> 0.0018s
2025-07-25T09:37:50.780599099Z == 20241122121621 AddApprovedToUser: migrated (0.0018s) =======================
2025-07-25T09:37:50.780607115Z 
2025-07-25T09:37:50.780615672Z Migrating to CreateFederailsModerationReports (20241128162213)
2025-07-25T09:37:50.780623759Z == 20241128162213 CreateFederailsModerationReports: migrating =================
2025-07-25T09:37:50.780632416Z -- create_table(:federails_moderation_reports)
2025-07-25T09:37:50.780640472Z    -> 0.0012s
2025-07-25T09:37:50.780648539Z == 20241128162213 CreateFederailsModerationReports: migrated (0.0012s) ========
2025-07-25T09:37:50.780656795Z 
2025-07-25T09:37:50.780664701Z Migrating to CreateFederailsModerationDomainBlocks (20241128162214)
2025-07-25T09:37:50.780672918Z == 20241128162214 CreateFederailsModerationDomainBlocks: migrating ============
2025-07-25T09:37:50.780681154Z -- create_table(:federails_moderation_domain_blocks)
2025-07-25T09:37:50.780689311Z    -> 0.0005s
2025-07-25T09:37:50.780697517Z == 20241128162214 CreateFederailsModerationDomainBlocks: migrated (0.0006s) ===
2025-07-25T09:37:50.780705844Z 
2025-07-25T09:37:50.780714471Z Migrating to AddFederationAttributesToComments (20250114105808)
2025-07-25T09:37:50.780722718Z == 20250114105808 AddFederationAttributesToComments: migrating ================
2025-07-25T09:37:50.780730764Z -- change_column_null(:comments, :commenter_id, true)
2025-07-25T09:37:50.780738770Z    -> 0.0119s
2025-07-25T09:37:50.780748690Z -- change_column_null(:comments, :commenter_type, true)
2025-07-25T09:37:50.780758931Z    -> 0.0081s
2025-07-25T09:37:50.780769432Z -- add_column(:comments, :federated_url, :string, {:null=>true, :default=>nil})
2025-07-25T09:37:50.780779352Z    -> 0.0008s
2025-07-25T09:37:50.780789202Z -- add_reference(:comments, :federails_actor, {:null=>true, :foreign_key=>true})
2025-07-25T09:37:50.780799052Z    -> 0.0110s
2025-07-25T09:37:50.780817198Z == 20250114105808 AddFederationAttributesToComments: migrated (0.0320s) =======
2025-07-25T09:37:50.780825344Z 
2025-07-25T09:37:50.780834393Z Migrating to AddS3PathStyleToLibrary (20250121105010)
2025-07-25T09:37:50.780842409Z == 20250121105010 AddS3PathStyleToLibrary: migrating ==========================
2025-07-25T09:37:50.780850535Z -- add_column(:libraries, :s3_path_style, :boolean, {:default=>true, :null=>false})
2025-07-25T09:37:50.780858882Z    -> 0.0009s
2025-07-25T09:37:50.780866868Z == 20250121105010 AddS3PathStyleToLibrary: migrated (0.0009s) =================
2025-07-25T09:37:50.780875175Z 
2025-07-25T09:37:50.780882910Z Migrating to MakePublicIDsLowercase (20250121164452)
2025-07-25T09:37:50.780891568Z == 20250121164452 MakePublicIDsLowercase: migrating ===========================
2025-07-25T09:37:51.101665072Z == 20250121164452 MakePublicIDsLowercase: migrated (0.0246s) ==================
2025-07-25T09:37:51.101750444Z 
2025-07-25T09:37:51.101799052Z Migrating to AddExtensionsToFederailsActors (20250122171731)
2025-07-25T09:37:51.101810535Z == 20250122171731 AddExtensionsToFederailsActors: migrating ===================
2025-07-25T09:37:51.101821096Z -- add_column(:federails_actors, :extensions, :json, {:default=>nil, :null=>true})
2025-07-25T09:37:51.101832579Z    -> 0.0012s
2025-07-25T09:37:51.101842760Z == 20250122171731 AddExtensionsToFederailsActors: migrated (0.0012s) ==========
2025-07-25T09:37:51.101852890Z 
2025-07-25T09:37:51.101863010Z Migrating to AddCreatorToCollections (20250222000000)
2025-07-25T09:37:51.102044486Z == 20250222000000 AddCreatorToCollections: migrating ==========================
2025-07-25T09:37:51.102055698Z -- add_reference(:collections, :creator, {:null=>true, :foreign_key=>true})
2025-07-25T09:37:51.102066250Z    -> 0.0171s
2025-07-25T09:37:51.102076400Z == 20250222000000 AddCreatorToCollections: migrated (0.0171s) =================
2025-07-25T09:37:51.102086090Z 
2025-07-25T09:37:51.102107934Z Migrating to AddLocalToActors (20250305171530)
2025-07-25T09:37:51.102120088Z == 20250305171530 AddLocalToActors: migrating =================================
2025-07-25T09:37:51.102133094Z -- add_column(:federails_actors, :local, :boolean, {:null=>false, :default=>false})
2025-07-25T09:37:51.102143275Z    -> 0.0008s
2025-07-25T09:37:51.102152563Z -- exec_update("UPDATE federails_actors SET local=true WHERE entity_type IS NOT NULL")
2025-07-25T09:37:51.102167453Z    -> 0.0004s
2025-07-25T09:37:51.102181632Z    -> 0 rows
2025-07-25T09:37:51.102192324Z == 20250305171530 AddLocalToActors: migrated (0.0017s) ========================
2025-07-25T09:37:51.102201592Z 
2025-07-25T09:37:51.102213115Z Migrating to AddActorTypeToActors (20250407160721)
2025-07-25T09:37:51.102248396Z == 20250407160721 AddActorTypeToActors: migrating =============================
2025-07-25T09:37:51.102258146Z -- add_column(:federails_actors, :actor_type, :string, {:null=>true})
2025-07-25T09:37:51.102267775Z    -> 0.0009s
2025-07-25T09:37:51.102277485Z == 20250407160721 AddActorTypeToActors: migrated (0.0009s) ====================
2025-07-25T09:37:51.102287515Z 
2025-07-25T09:37:51.102297004Z Migrating to AddTombstonedAtToActors (20250407160722)
2025-07-25T09:37:51.102306794Z == 20250407160722 AddTombstonedAtToActors: migrating ==========================
2025-07-25T09:37:51.102317105Z -- add_column(:federails_actors, :tombstoned_at, :datetime, {:default=>nil})
2025-07-25T09:37:51.102327706Z    -> 0.0011s
2025-07-25T09:37:51.102337496Z == 20250407160722 AddTombstonedAtToActors: migrated (0.0012s) =================
2025-07-25T09:37:51.102346855Z 
2025-07-25T09:37:51.102356945Z Migrating to CreateDoorkeeperTables (20250408111644)
2025-07-25T09:37:51.102373378Z == 20250408111644 CreateDoorkeeperTables: migrating ===========================
2025-07-25T09:37:51.102382837Z -- create_table(:oauth_applications)
2025-07-25T09:37:51.102391996Z    -> 0.0004s
2025-07-25T09:37:51.102401745Z -- add_index(:oauth_applications, :uid, {:unique=>true})
2025-07-25T09:37:51.102411505Z    -> 0.0002s
2025-07-25T09:37:51.102420743Z -- create_table(:oauth_access_grants)
2025-07-25T09:37:51.102430413Z    -> 0.0006s
2025-07-25T09:37:51.102439992Z -- add_index(:oauth_access_grants, :token, {:unique=>true})
2025-07-25T09:37:51.102449882Z    -> 0.0001s
2025-07-25T09:37:51.102461335Z -- add_foreign_key(:oauth_access_grants, :oauth_applications, {:column=>:application_id})
2025-07-25T09:37:51.102472137Z    -> 0.0079s
2025-07-25T09:37:51.102482538Z -- create_table(:oauth_access_tokens)
2025-07-25T09:37:51.102492638Z    -> 0.0006s
2025-07-25T09:37:51.102502318Z -- add_index(:oauth_access_tokens, :token, {:unique=>true})
2025-07-25T09:37:51.102513580Z    -> 0.0001s
2025-07-25T09:37:51.102523901Z -- add_index(:oauth_access_tokens, :refresh_token, {:unique=>true})
2025-07-25T09:37:51.102550705Z    -> 0.0001s
2025-07-25T09:37:51.102581327Z -- add_foreign_key(:oauth_access_tokens, :oauth_applications, {:column=>:application_id})
2025-07-25T09:37:51.102594994Z    -> 0.0089s
2025-07-25T09:37:51.102609073Z -- add_foreign_key(:oauth_access_grants, :users, {:column=>:resource_owner_id})
2025-07-25T09:37:51.102624464Z    -> 0.0072s
2025-07-25T09:37:51.102634444Z -- add_foreign_key(:oauth_access_tokens, :users, {:column=>:resource_owner_id})
2025-07-25T09:37:51.102733223Z    -> 0.0090s
2025-07-25T09:37:51.102762291Z == 20250408111644 CreateDoorkeeperTables: migrated (0.0357s) ==================
2025-07-25T09:37:51.102773373Z 
2025-07-25T09:37:51.102783063Z Migrating to AddOwnerToApplication (20250408145956)
2025-07-25T09:37:51.102793644Z == 20250408145956 AddOwnerToApplication: migrating ============================
2025-07-25T09:37:51.102803785Z -- add_column(:oauth_applications, :owner_id, :bigint, {:null=>true})
2025-07-25T09:37:51.102813434Z    -> 0.0009s
2025-07-25T09:37:51.102822993Z -- add_column(:oauth_applications, :owner_type, :string, {:null=>true})
2025-07-25T09:37:51.102833194Z    -> 0.0008s
2025-07-25T09:37:51.102843384Z -- add_index(:oauth_applications, [:owner_id, :owner_type])
2025-07-25T09:37:51.102853384Z    -> 0.0002s
2025-07-25T09:37:51.102867603Z == 20250408145956 AddOwnerToApplication: migrated (0.0022s) ===================
2025-07-25T09:37:51.102926091Z 
2025-07-25T09:37:51.102937123Z Migrating to RemoveDefaultActorEntityType (20250409120155)
2025-07-25T09:37:51.102954238Z == 20250409120155 RemoveDefaultActorEntityType: migrating =====================
2025-07-25T09:37:51.102965360Z -- change_column_default(:federails_actors, :entity_type, nil)
2025-07-25T09:37:51.102976402Z    -> 0.0104s
2025-07-25T09:37:51.102987434Z == 20250409120155 RemoveDefaultActorEntityType: migrated (0.0107s) ============
2025-07-25T09:37:51.102997725Z 
2025-07-25T09:37:51.103007865Z Migrating to AddQuotaToUsers (20250409125753)
2025-07-25T09:37:51.103018537Z == 20250409125753 AddQuotaToUsers: migrating ==================================
2025-07-25T09:37:51.103029198Z -- add_column(:users, :quota, :integer, {:default=>1, :null=>false})
2025-07-25T09:37:51.103041633Z    -> 0.0009s
2025-07-25T09:37:51.103075111Z -- add_column(:users, :quota_use_site_default, :boolean, {:default=>true, :null=>false})
2025-07-25T09:37:51.103086033Z    -> 0.0008s
2025-07-25T09:37:51.103096454Z == 20250409125753 AddQuotaToUsers: migrated (0.0017s) =========================
2025-07-25T09:37:51.103107686Z 
2025-07-25T09:37:51.103117787Z Migrating to AddLowercaseFilenameVirtualFieldToModelFiles (20250423094525)
2025-07-25T09:37:51.103128057Z == 20250423094525 AddLowercaseFilenameVirtualFieldToModelFiles: migrating =====
2025-07-25T09:37:51.103140322Z -- add_column(:model_files, :filename_lower, :virtual, {:type=>:string, :as=>"LOWER(filename)", :stored=>true})
2025-07-25T09:37:51.103151815Z    -> 0.0113s
2025-07-25T09:37:51.103162056Z -- add_index(:model_files, :filename_lower)
2025-07-25T09:37:51.103172717Z    -> 0.0001s
2025-07-25T09:37:51.103183138Z == 20250423094525 AddLowercaseFilenameVirtualFieldToModelFiles: migrated (0.0119s) 
2025-07-25T09:37:51.103207838Z 
2025-07-25T09:37:51.103293070Z Migrating to AddUniqueIndexToLinks (20250425104619)
2025-07-25T09:37:51.103307128Z == 20250425104619 AddUniqueIndexToLinks: migrating ============================
2025-07-25T09:37:51.103318351Z -- add_index(:links, [:linkable_id, :linkable_type, :url])
2025-07-25T09:37:51.103329343Z    -> 0.0002s
2025-07-25T09:37:51.103339353Z == 20250425104619 AddUniqueIndexToLinks: migrated (0.0004s) ===================
2025-07-25T09:37:51.103371518Z 
2025-07-25T09:37:51.103380516Z Migrating to AddPreviewToModelFile (20250520111046)
2025-07-25T09:37:51.103705771Z == 20250520111046 AddPreviewToModelFile: migrating ============================
2025-07-25T09:37:51.103743937Z -- add_column(:model_files, :previewable, :boolean, {:default=>false, :null=>false})
2025-07-25T09:37:51.103754990Z    -> 0.0012s
2025-07-25T09:37:51.103764148Z == 20250520111046 AddPreviewToModelFile: migrated (0.0014s) ===================
2025-07-25T09:37:51.103772705Z 
2025-07-25T09:37:51.103780972Z Migrating to CreateAltchaSolutions (20250609210440)
2025-07-25T09:37:51.103789409Z == 20250609210440 CreateAltchaSolutions: migrating ============================
2025-07-25T09:37:51.103798217Z -- create_table(:altcha_solutions)
2025-07-25T09:37:51.103806523Z    -> 0.0004s
2025-07-25T09:37:51.103815021Z -- add_index(:altcha_solutions, [:algorithm, :challenge, :salt, :signature, :number], {:unique=>true, :name=>"index_altcha_solutions"})
2025-07-25T09:37:51.103824039Z    -> 0.0002s
2025-07-25T09:37:51.103832215Z == 20250609210440 CreateAltchaSolutions: migrated (0.0008s) ===================
2025-07-25T09:37:51.103840622Z 
2025-07-25T09:37:51.103866444Z Migrating to AddIndexableFields (20250620141805)
2025-07-25T09:37:51.103880282Z == 20250620141805 AddIndexableFields: migrating ===============================
2025-07-25T09:37:51.103892937Z -- change_table(:models)
2025-07-25T09:37:51.103901214Z    -> 0.0018s
2025-07-25T09:37:51.103909541Z -- change_table(:creators)
2025-07-25T09:37:51.103917717Z    -> 0.0016s
2025-07-25T09:37:51.103925804Z -- change_table(:collections)
2025-07-25T09:37:51.103934090Z    -> 0.0016s
2025-07-25T09:37:51.103942066Z == 20250620141805 AddIndexableFields: migrated (0.0050s) ======================
2025-07-25T09:37:51.103950223Z 
2025-07-25T09:37:51.103958079Z Migrating to ChangeIndexableFromIntegerToString (20250621223410)
2025-07-25T09:37:51.103966295Z == 20250621223410 ChangeIndexableFromIntegerToString: migrating ===============
2025-07-25T09:37:51.103974482Z -- change_column(:models, :indexable, :string)
2025-07-25T09:37:51.103982568Z    -> 0.0174s
2025-07-25T09:37:51.103990724Z -- change_column(:models, :ai_indexable, :string)
2025-07-25T09:37:51.104035665Z    -> 0.0176s
2025-07-25T09:37:51.104043771Z -- change_column(:creators, :indexable, :string)
2025-07-25T09:37:51.104051837Z    -> 0.0086s
2025-07-25T09:37:51.104059793Z -- change_column(:creators, :ai_indexable, :string)
2025-07-25T09:37:51.104067810Z    -> 0.0082s
2025-07-25T09:37:51.104076297Z -- change_column(:collections, :indexable, :string)
2025-07-25T09:37:51.104084673Z    -> 0.0169s
2025-07-25T09:37:51.104096096Z -- change_column(:collections, :ai_indexable, :string)
2025-07-25T09:37:51.104104263Z    -> 0.0166s
2025-07-25T09:37:51.104112259Z == 20250621223410 ChangeIndexableFromIntegerToString: migrated (0.0855s) ======
2025-07-25T09:37:51.104120987Z 
2025-07-25T09:37:51.104128812Z Migrating to AddOrderIndexesToTables (20250629212656)
2025-07-25T09:37:51.104136839Z == 20250629212656 AddOrderIndexesToTables: migrating ==========================
2025-07-25T09:37:51.104144965Z -- change_table(:models)
2025-07-25T09:37:51.104152941Z    -> 0.0003s
2025-07-25T09:37:51.104160907Z -- change_table(:creators)
2025-07-25T09:37:51.104168883Z    -> 0.0003s
2025-07-25T09:37:51.104176769Z -- change_table(:collections)
2025-07-25T09:37:51.104184665Z    -> 0.0002s
2025-07-25T09:37:51.104192641Z == 20250629212656 AddOrderIndexesToTables: migrated (0.0009s) =================
2025-07-25T09:37:51.104200767Z 
2025-07-25T09:37:51.104208503Z Migrating to AddIndexOnLinkUrl (20250716093106)
2025-07-25T09:37:51.104216549Z == 20250716093106 AddIndexOnLinkUrl: migrating ================================
2025-07-25T09:37:51.104224585Z -- change_table(:links)
2025-07-25T09:37:51.104233132Z    -> 0.0002s
2025-07-25T09:37:51.104241068Z == 20250716093106 AddIndexOnLinkUrl: migrated (0.0002s) =======================
2025-07-25T09:37:51.104249215Z 
2025-07-25T09:37:51.153528009Z s6-rc: info: service init-manyfold-config successfully started
2025-07-25T09:37:51.153808915Z s6-rc: info: service init-config-end: starting
2025-07-25T09:37:51.156100739Z s6-rc: info: service init-config-end successfully started
2025-07-25T09:37:51.156341073Z s6-rc: info: service init-mods: starting
2025-07-25T09:37:51.158192631Z s6-rc: info: service init-mods successfully started
2025-07-25T09:37:51.158458647Z s6-rc: info: service init-mod-universal-redis-add-package: starting
2025-07-25T09:37:51.167315368Z s6-rc: info: service init-mod-universal-redis-add-package successfully started
2025-07-25T09:37:51.167455861Z s6-rc: info: service init-mods-package-install: starting
2025-07-25T09:37:51.178357399Z [pkg-install-init] **** Installing all mod packages ****
2025-07-25T09:37:51.189388308Z fetch http://dl-cdn.alpinelinux.org/alpine/v3.21/main/x86_64/APKINDEX.tar.gz
2025-07-25T09:37:51.264893656Z fetch http://dl-cdn.alpinelinux.org/alpine/v3.21/community/x86_64/APKINDEX.tar.gz
2025-07-25T09:37:51.581150597Z (1/1) Installing redis (7.2.9-r0)
2025-07-25T09:37:51.594253868Z Executing redis-7.2.9-r0.pre-install
2025-07-25T09:37:51.838208530Z Executing redis-7.2.9-r0.post-install
2025-07-25T09:37:51.846992295Z Executing busybox-1.37.0-r12.trigger
2025-07-25T09:37:51.860762709Z OK: 352 MiB in 100 packages
2025-07-25T09:37:51.947020224Z s6-rc: info: service init-mods-package-install successfully started
2025-07-25T09:37:51.947254947Z s6-rc: info: service init-mods-end: starting
2025-07-25T09:37:51.987585035Z s6-rc: info: service init-mods-end successfully started
2025-07-25T09:37:51.987906222Z s6-rc: info: service init-custom-files: starting
2025-07-25T09:37:51.994919691Z [custom-init] No custom files found, skipping...
2025-07-25T09:37:52.012402090Z s6-rc: info: service init-custom-files successfully started
2025-07-25T09:37:52.012671452Z s6-rc: info: service init-services: starting
2025-07-25T09:37:52.014241904Z s6-rc: info: service init-services successfully started
2025-07-25T09:37:52.014464963Z s6-rc: info: service svc-mod-universal-redis: starting
2025-07-25T09:37:52.014788965Z s6-rc: info: service svc-manyfold: starting
2025-07-25T09:37:52.015147437Z s6-rc: info: service svc-cron: starting
2025-07-25T09:37:52.046881729Z 249:C 25 Jul 2025 09:37:52.046 # WARNING Memory overcommit must be enabled! Without it, a background save or replication may fail under low memory condition. To fix this issue add 'vm.overcommit_memory = 1' to /etc/sysctl.conf and then reboot or run the command 'sysctl vm.overcommit_memory=1' for this to take effect.
2025-07-25T09:37:52.046932611Z 249:C 25 Jul 2025 09:37:52.046 * oO0OoO0OoO0Oo Redis is starting oO0OoO0OoO0Oo
2025-07-25T09:37:52.046953172Z 249:C 25 Jul 2025 09:37:52.046 * Redis version=7.2.9, bits=64, commit=00000000, modified=0, pid=249, just started
2025-07-25T09:37:52.046961309Z 249:C 25 Jul 2025 09:37:52.046 # Warning: no config file specified, using the default config. In order to specify a config file use redis-server /path/to/redis.conf
2025-07-25T09:37:52.047896381Z 249:M 25 Jul 2025 09:37:52.047 * monotonic clock: POSIX clock_gettime
2025-07-25T09:37:52.048765541Z 249:M 25 Jul 2025 09:37:52.048 * Running mode=standalone, port=6379.
2025-07-25T09:37:52.049051627Z 249:M 25 Jul 2025 09:37:52.048 * Server initialized
2025-07-25T09:37:52.049091588Z 249:M 25 Jul 2025 09:37:52.049 * Ready to accept connections tcp
2025-07-25T09:37:52.049220337Z s6-rc: info: service svc-mod-universal-redis successfully started
2025-07-25T09:37:52.054911615Z s6-rc: info: service svc-cron successfully started
2025-07-25T09:37:52.272753734Z 09:37:52 rails.1              | started with pid 269
2025-07-25T09:37:52.272796440Z 09:37:52 default_worker.1     | started with pid 270
2025-07-25T09:37:52.272838445Z 09:37:52 performance_worker.1 | started with pid 271
2025-07-25T09:37:53.568069157Z 09:37:53 rails.1              | `/root` is not writable.
2025-07-25T09:37:53.568116984Z 09:37:53 rails.1              | Bundler will use `/tmp/bundler20250725-269-zahos269' as your home directory temporarily.
2025-07-25T09:37:54.142792728Z 09:37:54 default_worker.1     | `/root` is not writable.
2025-07-25T09:37:54.142844923Z 09:37:54 default_worker.1     | Bundler will use `/tmp/bundler20250725-270-4nko2d270' as your home directory temporarily.
2025-07-25T09:37:54.153392670Z 09:37:54 performance_worker.1 | `/root` is not writable.
2025-07-25T09:37:54.153516439Z 09:37:54 performance_worker.1 | Bundler will use `/tmp/bundler20250725-271-tu1eam271' as your home directory temporarily.
2025-07-25T09:37:54.922408776Z 09:37:54 rails.1              | => Booting Puma
2025-07-25T09:37:54.922472875Z 09:37:54 rails.1              | => Rails 8.0.2 application starting in production 
2025-07-25T09:37:54.922693870Z 09:37:54 rails.1              | => Run `bin/rails server --help` for more startup options
2025-07-25T09:37:55.331555125Z 09:37:55 rails.1              | Server: 0d65cd0027d2, Context: rails, Role: web, data: {:cpu=>{:one_min=>2.08, :five_min=>1.65, :fifteen_min=>1.9}, :memory=>0.174485504e9, :disk=>{:available=>860797632512, :total=>938656133120, :used=>77858500608}}
2025-07-25T09:37:55.689950004Z 09:37:55 default_worker.1     | Server: 0d65cd0027d2, Context: rails, Role: web, data: {:cpu=>{:one_min=>2.08, :five_min=>1.65, :fifteen_min=>1.9}, :memory=>0.178659328e9, :disk=>{:available=>860765978624, :total=>938656133120, :used=>77890154496}}
2025-07-25T09:37:55.704437001Z 09:37:55 performance_worker.1 | Server: 0d65cd0027d2, Context: rails, Role: web, data: {:cpu=>{:one_min=>2.08, :five_min=>1.65, :fifteen_min=>1.9}, :memory=>0.179974144e9, :disk=>{:available=>860764270592, :total=>938656133120, :used=>77891862528}}
2025-07-25T09:37:57.303049736Z 09:37:57 performance_worker.1 | Scoped order is ignored, use :cursor with :order to configure custom order.
2025-07-25T09:37:57.304120141Z 09:37:57 performance_worker.1 | INFO  2025-07-25T09:37:57.303Z pid=271 tid=5sj: Sidekiq 8.0.5 connecting to Redis with options {:size=>10, :pool_name=>"internal", :url=>nil}
2025-07-25T09:37:57.339257824Z 09:37:57 default_worker.1     | Scoped order is ignored, use :cursor with :order to configure custom order.
2025-07-25T09:37:57.340276616Z 09:37:57 default_worker.1     | INFO  2025-07-25T09:37:57.340Z pid=270 tid=5si: Sidekiq 8.0.5 connecting to Redis with options {:size=>10, :pool_name=>"internal", :url=>nil}
2025-07-25T09:37:57.375190700Z 09:37:57 performance_worker.1 | INFO  2025-07-25T09:37:57.374Z pid=271 tid=5sj: Booted Rails 8.0.2 application in production environment
2025-07-25T09:37:57.375223696Z 09:37:57 performance_worker.1 | INFO  2025-07-25T09:37:57.374Z pid=271 tid=5sj: Running in ruby 3.3.8 (2025-04-09 revision b200bad6cd) +YJIT [x86_64-linux-musl]
2025-07-25T09:37:57.375366033Z 09:37:57 performance_worker.1 | INFO  2025-07-25T09:37:57.374Z pid=271 tid=5sj: See LICENSE and the LGPL-3.0 for licensing details.
2025-07-25T09:37:57.375399330Z 09:37:57 performance_worker.1 | INFO  2025-07-25T09:37:57.374Z pid=271 tid=5sj: Upgrade to Sidekiq Pro for more features and support: https://sidekiq.org
2025-07-25T09:37:57.376780070Z 09:37:57 performance_worker.1 | INFO  2025-07-25T09:37:57.376Z pid=271 tid=5sj: Sidekiq 8.0.5 connecting to Redis with options {:size=>1, :pool_name=>"default", :url=>nil}
2025-07-25T09:37:57.412545207Z 09:37:57 default_worker.1     | INFO  2025-07-25T09:37:57.412Z pid=270 tid=5si: Booted Rails 8.0.2 application in production environment
2025-07-25T09:37:57.412579826Z 09:37:57 default_worker.1     | INFO  2025-07-25T09:37:57.412Z pid=270 tid=5si: Running in ruby 3.3.8 (2025-04-09 revision b200bad6cd) +YJIT [x86_64-linux-musl]
2025-07-25T09:37:57.412704708Z 09:37:57 default_worker.1     | INFO  2025-07-25T09:37:57.412Z pid=270 tid=5si: See LICENSE and the LGPL-3.0 for licensing details.
2025-07-25T09:37:57.412737905Z 09:37:57 default_worker.1     | INFO  2025-07-25T09:37:57.412Z pid=270 tid=5si: Upgrade to Sidekiq Pro for more features and support: https://sidekiq.org
2025-07-25T09:37:57.414124967Z 09:37:57 default_worker.1     | INFO  2025-07-25T09:37:57.413Z pid=270 tid=5si: Sidekiq 8.0.5 connecting to Redis with options {:size=>4, :pool_name=>"default", :url=>nil}
2025-07-25T09:37:57.419023189Z 09:37:57 rails.1              | Scoped order is ignored, use :cursor with :order to configure custom order.
2025-07-25T09:37:57.419046596Z 09:37:57 rails.1              | INFO  2025-07-25T09:37:57.269Z pid=269 tid=5ix: Sidekiq 8.0.5 connecting to Redis with options {:size=>10, :pool_name=>"internal", :url=>nil}
2025-07-25T09:37:57.419079543Z 09:37:57 rails.1              | INFO  2025-07-25T09:37:57.273Z pid=269 tid=5ix: Cron Jobs - added job with name clear-shrine-cache in the namespace default
2025-07-25T09:37:57.419123361Z 09:37:57 rails.1              | INFO  2025-07-25T09:37:57.275Z pid=269 tid=5ix: Cron Jobs - added job with name clear-downloads in the namespace default
2025-07-25T09:37:57.419167259Z 09:37:57 rails.1              | [ActiveJob] Enqueued Upgrade::FixNilFileSizeValues (Job ID: a948eb8c-f824-4a31-8e71-2cf725409d8a) to Sidekiq(upgrade)
2025-07-25T09:37:57.419205075Z 09:37:57 rails.1              | [ActiveJob] Enqueued Upgrade::BackfillDataPackages (Job ID: 3570dfc4-3b08-4d48-b62d-f33bb317dfdf) to Sidekiq(upgrade)
2025-07-25T09:37:57.419250507Z 09:37:57 rails.1              | [ActiveJob] Enqueued Upgrade::DisambiguateUsernamesJob (Job ID: cf8f5f1a-b3f2-4ace-b1f0-55af6f517beb) to Sidekiq(upgrade)
2025-07-25T09:37:57.419297852Z 09:37:57 rails.1              | [ActiveJob] Enqueued Upgrade::UpdateActorsJob (Job ID: dd3e81b4-5b0b-4ad9-9738-97647f91d3f6) to Sidekiq(upgrade)
2025-07-25T09:37:57.419341510Z 09:37:57 rails.1              | [ActiveJob] Enqueued Upgrade::FixParentCollections (Job ID: 5a47746a-8b32-47b5-8090-7436e2b57535) to Sidekiq(upgrade)
2025-07-25T09:37:57.419392914Z 09:37:57 rails.1              | [ActiveJob] Enqueued Upgrade::PruneOrphanedProblems (Job ID: f995c8a5-1a5d-4fbd-b7c2-3eee5c4a83a4) to Sidekiq(upgrade)
2025-07-25T09:37:57.419446020Z 09:37:57 rails.1              | [269] Puma starting in cluster mode...
2025-07-25T09:37:57.419480029Z 09:37:57 rails.1              | [269] * Puma version: 6.6.0 ("Return to Forever")
2025-07-25T09:37:57.419545861Z 09:37:57 rails.1              | [269] * Ruby version: ruby 3.3.8 (2025-04-09 revision b200bad6cd) +YJIT [x86_64-linux-musl]
2025-07-25T09:37:57.419887469Z 09:37:57 rails.1              | [269] *  Min threads: 4
2025-07-25T09:37:57.419901728Z 09:37:57 rails.1              | [269] *  Max threads: 16
2025-07-25T09:37:57.419910105Z 09:37:57 rails.1              | [269] *  Environment: production
2025-07-25T09:37:57.419918462Z 09:37:57 rails.1              | [269] *   Master PID: 269
2025-07-25T09:37:57.419927961Z 09:37:57 rails.1              | [269] *      Workers: 4
2025-07-25T09:37:57.419978503Z 09:37:57 rails.1              | [269] *     Restarts: (✔) hot (✖) phased
2025-07-25T09:37:57.420027281Z 09:37:57 rails.1              | [269] * Preloading application
2025-07-25T09:37:57.420064025Z 09:37:57 rails.1              | [269] * Listening on http://[::]:3214
2025-07-25T09:37:57.420111891Z 09:37:57 rails.1              | [269] Use Ctrl-C to stop
2025-07-25T09:37:57.446787187Z 09:37:57 rails.1              | [269] - Worker 0 (PID: 313) booted in 0.02s, phase: 0
2025-07-25T09:37:57.446809883Z 09:37:57 rails.1              | [269] - Worker 1 (PID: 317) booted in 0.01s, phase: 0
2025-07-25T09:37:57.449261338Z 09:37:57 rails.1              | [269] - Worker 2 (PID: 330) booted in 0.01s, phase: 0
2025-07-25T09:37:57.449292581Z 09:37:57 rails.1              | [269] - Worker 3 (PID: 345) booted in 0.0s, phase: 0
2025-07-25T09:37:57.608794823Z 09:37:57 performance_worker.1 | Server: 0d65cd0027d2, Context: sidekiq, Role: background, data: {:cpu=>{:one_min=>2.39, :five_min=>1.72, :fifteen_min=>1.93}, :memory=>0.21065728e9, :disk=>{:available=>860722335744, :total=>938656133120, :used=>77933797376}}
2025-07-25T09:37:57.634172607Z 09:37:57 default_worker.1     | INFO  2025-07-25T09:37:57.633Z pid=270 tid=1hzq jid=d5423c47f39805c83d3fd84a class=Upgrade::FixNilFileSizeValues: start
2025-07-25T09:37:57.635584971Z 09:37:57 default_worker.1     | [ActiveJob] [Upgrade::FixNilFileSizeValues] [a948eb8c-f824-4a31-8e71-2cf725409d8a] Performing Upgrade::FixNilFileSizeValues (Job ID: a948eb8c-f824-4a31-8e71-2cf725409d8a) from Sidekiq(upgrade) enqueued at 2025-07-25T09:37:57.283471909Z
2025-07-25T09:37:57.635954825Z 09:37:57 default_worker.1     | INFO  2025-07-25T09:37:57.633Z pid=270 tid=1i02 jid=a462084703e90c4429e3a1c1 class=Upgrade::BackfillDataPackages: start
2025-07-25T09:37:57.637204301Z 09:37:57 default_worker.1     | [ActiveJob] [Upgrade::BackfillDataPackages] [3570dfc4-3b08-4d48-b62d-f33bb317dfdf] Performing Upgrade::BackfillDataPackages (Job ID: 3570dfc4-3b08-4d48-b62d-f33bb317dfdf) from Sidekiq(upgrade) enqueued at 2025-07-25T09:37:57.284261108Z
2025-07-25T09:37:57.637893629Z 09:37:57 default_worker.1     | INFO  2025-07-25T09:37:57.633Z pid=270 tid=1i1a jid=1494266bc4aa11ee36d3c768 class=Upgrade::DisambiguateUsernamesJob: start
2025-07-25T09:37:57.638408706Z 09:37:57 default_worker.1     | Server: 0d65cd0027d2, Context: sidekiq, Role: background, data: {:cpu=>{:one_min=>2.39, :five_min=>1.72, :fifteen_min=>1.93}, :memory=>0.210735104e9, :disk=>{:available=>860722335744, :total=>938656133120, :used=>77933797376}}
2025-07-25T09:37:57.638784162Z 09:37:57 default_worker.1     | INFO  2025-07-25T09:37:57.634Z pid=270 tid=1i1m jid=b8c78e6f9fe25f6fe8d6c360 class=Upgrade::UpdateActorsJob: start
2025-07-25T09:37:57.640414334Z 09:37:57 default_worker.1     | [ActiveJob] [Upgrade::DisambiguateUsernamesJob] [cf8f5f1a-b3f2-4ace-b1f0-55af6f517beb] Performing Upgrade::DisambiguateUsernamesJob (Job ID: cf8f5f1a-b3f2-4ace-b1f0-55af6f517beb) from Sidekiq(upgrade) enqueued at 2025-07-25T09:37:57.284827047Z
2025-07-25T09:37:57.640690740Z 09:37:57 default_worker.1     | [ActiveJob] [Upgrade::UpdateActorsJob] [dd3e81b4-5b0b-4ad9-9738-97647f91d3f6] Performing Upgrade::UpdateActorsJob (Job ID: dd3e81b4-5b0b-4ad9-9738-97647f91d3f6) from Sidekiq(upgrade) enqueued at 2025-07-25T09:37:57.285396954Z
2025-07-25T09:37:57.647617867Z 09:37:57 default_worker.1     | [ActiveJob] [Upgrade::UpdateActorsJob] [dd3e81b4-5b0b-4ad9-9738-97647f91d3f6] Scoped order is ignored, use :cursor with :order to configure custom order.
2025-07-25T09:37:57.649269713Z 09:37:57 default_worker.1     | [ActiveJob] [Upgrade::BackfillDataPackages] [3570dfc4-3b08-4d48-b62d-f33bb317dfdf] Scoped order is ignored, use :cursor with :order to configure custom order.
2025-07-25T09:37:57.653826006Z 09:37:57 default_worker.1     | [ActiveJob] [Upgrade::DisambiguateUsernamesJob] [cf8f5f1a-b3f2-4ace-b1f0-55af6f517beb] Scoped order is ignored, use :cursor with :order to configure custom order.
2025-07-25T09:37:57.727581260Z 09:37:57 default_worker.1     | [ActiveJob] [Upgrade::FixNilFileSizeValues] [a948eb8c-f824-4a31-8e71-2cf725409d8a] Scoped order is ignored, use :cursor with :order to configure custom order.
2025-07-25T09:37:57.764767409Z 09:37:57 default_worker.1     | [ActiveJob] [Upgrade::FixNilFileSizeValues] [a948eb8c-f824-4a31-8e71-2cf725409d8a] [JobIteration::Iteration] Enumerator found nothing to iterate! times_interrupted=0 cursor_position=
2025-07-25T09:37:57.767646145Z 09:37:57 default_worker.1     | [ActiveJob] [Upgrade::FixNilFileSizeValues] [a948eb8c-f824-4a31-8e71-2cf725409d8a] [JobIteration::Iteration] Completed iterating. times_interrupted=0 total_time=0.024
2025-07-25T09:37:57.795730267Z 09:37:57 default_worker.1     | [ActiveJob] [Upgrade::UpdateActorsJob] [dd3e81b4-5b0b-4ad9-9738-97647f91d3f6] Performed Upgrade::UpdateActorsJob (Job ID: dd3e81b4-5b0b-4ad9-9738-97647f91d3f6) from Sidekiq(upgrade) in 155.28ms
2025-07-25T09:37:57.796475988Z 09:37:57 default_worker.1     | [ActiveJob] [Upgrade::BackfillDataPackages] [3570dfc4-3b08-4d48-b62d-f33bb317dfdf] Performed Upgrade::BackfillDataPackages (Job ID: 3570dfc4-3b08-4d48-b62d-f33bb317dfdf) from Sidekiq(upgrade) in 159.19ms
2025-07-25T09:37:57.797601204Z 09:37:57 default_worker.1     | INFO  2025-07-25T09:37:57.796Z pid=270 tid=1i1m jid=b8c78e6f9fe25f6fe8d6c360 class=Upgrade::UpdateActorsJob elapsed=0.162: done
2025-07-25T09:37:57.798005358Z 09:37:57 default_worker.1     | [ActiveJob] [Upgrade::DisambiguateUsernamesJob] [cf8f5f1a-b3f2-4ace-b1f0-55af6f517beb] Performed Upgrade::DisambiguateUsernamesJob (Job ID: cf8f5f1a-b3f2-4ace-b1f0-55af6f517beb) from Sidekiq(upgrade) in 158.34ms
2025-07-25T09:37:57.798997124Z 09:37:57 default_worker.1     | [ActiveJob] [Upgrade::FixNilFileSizeValues] [a948eb8c-f824-4a31-8e71-2cf725409d8a] Performed Upgrade::FixNilFileSizeValues (Job ID: a948eb8c-f824-4a31-8e71-2cf725409d8a) from Sidekiq(upgrade) in 163.38ms
2025-07-25T09:37:57.803385961Z 09:37:57 default_worker.1     | INFO  2025-07-25T09:37:57.797Z pid=270 tid=1i02 jid=a462084703e90c4429e3a1c1 class=Upgrade::BackfillDataPackages elapsed=0.164: done
2025-07-25T09:37:57.803410270Z 09:37:57 default_worker.1     | INFO  2025-07-25T09:37:57.797Z pid=270 tid=1i1m jid=9060b2298a8ef9b1f97317ab class=Upgrade::FixParentCollections: start
2025-07-25T09:37:57.804209038Z 09:37:57 default_worker.1     | [ActiveJob] [Upgrade::FixParentCollections] [5a47746a-8b32-47b5-8090-7436e2b57535] Performing Upgrade::FixParentCollections (Job ID: 5a47746a-8b32-47b5-8090-7436e2b57535) from Sidekiq(upgrade) enqueued at 2025-07-25T09:37:57.286039117Z
2025-07-25T09:37:57.804801070Z 09:37:57 default_worker.1     | INFO  2025-07-25T09:37:57.804Z pid=270 tid=1i02 jid=e592f0d2ed305d1098b903a4 class=Upgrade::PruneOrphanedProblems: start
2025-07-25T09:37:57.805164922Z 09:37:57 default_worker.1     | [ActiveJob] [Upgrade::PruneOrphanedProblems] [f995c8a5-1a5d-4fbd-b7c2-3eee5c4a83a4] Performing Upgrade::PruneOrphanedProblems (Job ID: f995c8a5-1a5d-4fbd-b7c2-3eee5c4a83a4) from Sidekiq(upgrade) enqueued at 2025-07-25T09:37:57.286620077Z
2025-07-25T09:37:57.805775682Z 09:37:57 default_worker.1     | INFO  2025-07-25T09:37:57.803Z pid=270 tid=1hzq jid=d5423c47f39805c83d3fd84a class=Upgrade::FixNilFileSizeValues elapsed=0.169: done
2025-07-25T09:37:57.806223473Z 09:37:57 default_worker.1     | INFO  2025-07-25T09:37:57.802Z pid=270 tid=1i1a jid=1494266bc4aa11ee36d3c768 class=Upgrade::DisambiguateUsernamesJob elapsed=0.169: done
2025-07-25T09:37:57.806710524Z 09:37:57 default_worker.1     | [ActiveJob] [Upgrade::FixParentCollections] [5a47746a-8b32-47b5-8090-7436e2b57535] Scoped order is ignored, use :cursor with :order to configure custom order.
2025-07-25T09:37:57.849814346Z 09:37:57 default_worker.1     | [ActiveJob] [Upgrade::PruneOrphanedProblems] [f995c8a5-1a5d-4fbd-b7c2-3eee5c4a83a4] Scoped order is ignored, use :cursor with :order to configure custom order.
2025-07-25T09:37:57.946039921Z 09:37:57 default_worker.1     | [ActiveJob] [Upgrade::PruneOrphanedProblems] [f995c8a5-1a5d-4fbd-b7c2-3eee5c4a83a4] [JobIteration::Iteration] Enumerator found nothing to iterate! times_interrupted=0 cursor_position=
2025-07-25T09:37:57.946817857Z 09:37:57 default_worker.1     | [ActiveJob] [Upgrade::PruneOrphanedProblems] [f995c8a5-1a5d-4fbd-b7c2-3eee5c4a83a4] [JobIteration::Iteration] Completed iterating. times_interrupted=0 total_time=0.067
2025-07-25T09:37:57.947773100Z 09:37:57 default_worker.1     | [ActiveJob] [Upgrade::FixParentCollections] [5a47746a-8b32-47b5-8090-7436e2b57535] Performed Upgrade::FixParentCollections (Job ID: 5a47746a-8b32-47b5-8090-7436e2b57535) from Sidekiq(upgrade) in 143.76ms
2025-07-25T09:37:57.958641823Z 09:37:57 default_worker.1     | INFO  2025-07-25T09:37:57.958Z pid=270 tid=1i1m jid=9060b2298a8ef9b1f97317ab class=Upgrade::FixParentCollections elapsed=0.16: done
2025-07-25T09:37:57.958666292Z 09:37:57 default_worker.1     | [ActiveJob] [Upgrade::PruneOrphanedProblems] [f995c8a5-1a5d-4fbd-b7c2-3eee5c4a83a4] Performed Upgrade::PruneOrphanedProblems (Job ID: f995c8a5-1a5d-4fbd-b7c2-3eee5c4a83a4) from Sidekiq(upgrade) in 153.42ms
2025-07-25T09:37:57.959079965Z 09:37:57 default_worker.1     | INFO  2025-07-25T09:37:57.958Z pid=270 tid=1i02 jid=e592f0d2ed305d1098b903a4 class=Upgrade::PruneOrphanedProblems elapsed=0.155: done
2025-07-25T09:37:58.071788555Z Connection to localhost (::1) 3214 port [tcp/*] succeeded!
2025-07-25T09:37:58.073198935Z s6-rc: info: service svc-manyfold successfully started
2025-07-25T09:37:58.073431373Z s6-rc: info: service legacy-services: starting
2025-07-25T09:37:58.085644512Z s6-rc: info: service legacy-services successfully started
2025-07-25T09:37:58.085858623Z s6-rc: info: service ci-service-check: starting
2025-07-25T09:37:58.089135180Z [ls.io-init] done.
2025-07-25T09:37:58.091212823Z s6-rc: info: service ci-service-check successfully started
2025-07-25T09:38:27.057302067Z 09:38:27 rails.1              | [56e57526-29a8-467a-b62b-4e507bf4fed8] {"method":"GET","path":"/","format":"*/*","controller":"HomeController","action":"index","status":0,"allocations":1551,"duration":33.64,"view":0.0,"db":3.12,"@timestamp":"2025-07-25T09:38:27.056Z","@version":"1","message":"[0] GET / (HomeController#index)"}
2025-07-25T09:38:27.580483743Z 09:38:27 rails.1              | [923584e4-2412-4615-9dc7-5f7d1adb7066] {"method":"GET","path":"/users/sign_in","format":"*/*","controller":"Users::SessionsController","action":"new","status":302,"allocations":80564,"duration":506.73,"view":0.0,"db":10.55,"location":"http://172.17.0.4:3214/","@timestamp":"2025-07-25T09:38:27.580Z","@version":"1","message":"[302] GET /users/sign_in (Users::SessionsController#new)"}
2025-07-25T09:38:27.604362760Z 09:38:27 rails.1              | [1dae4e9b-62e0-4b26-8bdf-728efc64ace1] {"method":"GET","path":"/","format":"*/*","controller":"HomeController","action":"index","status":302,"allocations":1164,"duration":10.39,"view":0.0,"db":0.38,"location":"http://172.17.0.4:3214/users/edit","@timestamp":"2025-07-25T09:38:27.597Z","@version":"1","message":"[302] GET / (HomeController#index)"}
2025-07-25T09:38:27.897939572Z 09:38:27 rails.1              | [b3cb297b-f3ed-41d4-b895-1e988d147e87] {"method":"GET","path":"/users/edit","format":"*/*","controller":"Users::RegistrationsController","action":"edit","status":200,"allocations":26505,"duration":284.07,"view":223.96,"db":24.66,"@timestamp":"2025-07-25T09:38:27.897Z","@version":"1","message":"[200] GET /users/edit (Users::RegistrationsController#edit)"}
2025-07-25T09:38:27.971003976Z 09:38:27 rails.1              | [f7d39df5-e959-481a-ab78-17f389b11210] {"method":"GET","path":"/","format":"html","controller":"HomeController","action":"index","status":0,"allocations":2179,"duration":40.25,"view":0.0,"db":3.08,"@timestamp":"2025-07-25T09:38:27.969Z","@version":"1","message":"[0] GET / (HomeController#index)"}
2025-07-25T09:38:28.131293134Z 09:38:28 rails.1              | [e09888b7-abe6-4492-974f-0429955f3a8a] {"method":"GET","path":"/users/sign_in","format":"html","controller":"Users::SessionsController","action":"new","status":302,"allocations":15888,"duration":107.99,"view":0.0,"db":2.13,"location":"http://172.17.0.4:3214/","@timestamp":"2025-07-25T09:38:28.115Z","@version":"1","message":"[302] GET /users/sign_in (Users::SessionsController#new)"}
2025-07-25T09:38:28.146319617Z 09:38:28 rails.1              | [545f9787-9cbf-4949-b952-1269854a9858] {"method":"GET","path":"/","format":"html","controller":"HomeController","action":"index","status":302,"allocations":1181,"duration":9.55,"view":0.0,"db":0.99,"location":"http://172.17.0.4:3214/users/edit","@timestamp":"2025-07-25T09:38:28.145Z","@version":"1","message":"[302] GET / (HomeController#index)"}
2025-07-25T09:38:28.294336958Z 09:38:28 rails.1              | [7dff546f-3c23-4376-adf5-1370a823a068] {"method":"GET","path":"/users/edit","format":"html","controller":"Users::RegistrationsController","action":"edit","status":200,"allocations":26634,"duration":134.79,"view":101.08,"db":1.01,"@timestamp":"2025-07-25T09:38:28.289Z","@version":"1","message":"[200] GET /users/edit (Users::RegistrationsController#edit)"}