Horde Upgrade 5.2.7-3 -> 5.2.17-2 fails

horde

#1

Hello,
the update of horde fails with univention-app register: error: Unable to find version 5.2.17-2 of app horde.
We’re on UCS 4.3-1 errata218. Horde runs on a member server, the message is the same regardless of starting the update from the domain controller or the member server.

From the log:

 13105 actions.update                   18-08-26 16:17:12 [   DEBUG]: Calling update
 13105 actions.update.progress          18-08-26 16:17:12 [   DEBUG]: 0
 13105 actions.update                   18-08-26 16:17:12 [    INFO]: Downloading "https://appcenter.software-univention.de/meta-inf/categories.ini"...
 13105 actions.update                   18-08-26 16:17:12 [   DEBUG]:   ... Not Modified
 13105 actions.update                   18-08-26 16:17:12 [    INFO]: Downloading "https://appcenter.software-univention.de/meta-inf/rating.ini"...
 13105 actions.update                   18-08-26 16:17:12 [   DEBUG]:   ... Not Modified
 13105 actions.update                   18-08-26 16:17:12 [    INFO]: Downloading "https://appcenter.software-univention.de/meta-inf/license_types.ini"...
 13105 actions.update                   18-08-26 16:17:12 [   DEBUG]:   ... Not Modified
 13105 actions.update                   18-08-26 16:17:12 [    INFO]: Downloading "https://appcenter.software-univention.de/meta-inf/ucs.ini"...
 13105 actions.update                   18-08-26 16:17:12 [   DEBUG]:   ... Not Modified
 13105 actions.update                   18-08-26 16:17:12 [    INFO]: Downloading "https://appcenter.software-univention.de/meta-inf/4.3/index.json.gz"...
 13105 actions.update                   18-08-26 16:17:12 [   DEBUG]:   ... Not Modified
 13105 actions.update                   18-08-26 16:17:12 [    INFO]: Downloading "https://appcenter.software-univention.de/meta-inf/4.3/index.json.gz.gpg"...
 13105 actions.update                   18-08-26 16:17:13 [   DEBUG]:   ... Not Modified
 13105 actions.update                   18-08-26 16:17:13 [    INFO]: Downloading "https://appcenter.software-univention.de/meta-inf/4.3/all.tar.gpg"...
 13105 actions.update                   18-08-26 16:17:13 [   DEBUG]:   ... Not Modified
 13105 actions.update                   18-08-26 16:17:13 [    INFO]: Downloading "https://appcenter.software-univention.de/meta-inf/4.2/index.json.gz"...
 13105 actions.update                   18-08-26 16:17:13 [   DEBUG]:   ... Not Modified
 13105 actions.update                   18-08-26 16:17:13 [    INFO]: Downloading "https://appcenter.software-univention.de/meta-inf/4.2/index.json.gz.gpg"...
 13105 actions.update                   18-08-26 16:17:13 [   DEBUG]:   ... Not Modified
 13105 actions.update                   18-08-26 16:17:13 [    INFO]: Downloading "https://appcenter.software-univention.de/meta-inf/4.2/all.tar.gpg"...
 13105 actions.update                   18-08-26 16:17:13 [   DEBUG]:   ... Not Modified
 13105 actions.update                   18-08-26 16:17:13 [    INFO]: Downloading "https://appcenter.software-univention.de/meta-inf/4.1/index.json.gz"...
 13105 actions.update                   18-08-26 16:17:13 [   DEBUG]:   ... Not Modified
 13105 actions.update                   18-08-26 16:17:13 [    INFO]: Downloading "https://appcenter.software-univention.de/meta-inf/4.1/index.json.gz.gpg"...
 13105 actions.update                   18-08-26 16:17:13 [   DEBUG]:   ... Not Modified
 13105 actions.update                   18-08-26 16:17:13 [    INFO]: Downloading "https://appcenter.software-univention.de/meta-inf/4.1/all.tar.gpg"...
 13105 actions.update                   18-08-26 16:17:13 [   DEBUG]:   ... Not Modified
 13105 actions.update.progress          18-08-26 16:17:13 [   DEBUG]: 100
 13105 actions.upgrade                  18-08-26 16:17:16 [   DEBUG]: Calling upgrade
 13105 actions.upgrade.progress         18-08-26 16:17:16 [   DEBUG]: 0
 13105 actions.upgrade                  18-08-26 16:17:16 [    INFO]: Going to upgrade Horde Groupware Webmail Edition (5.2.17-2)
 13105 actions.upgrade                  18-08-26 16:17:16 [   DEBUG]: Calling prescript (preinst)
 13105 actions.upgrade                  18-08-26 16:17:16 [   DEBUG]: /var/cache/univention-appcenter/appcenter.software-univention.de/4.3/horde_20180621115801.preinst does not exist
 13105 actions.upgrade.readme           18-08-26 16:17:16 [   DEBUG]: Calling elinks -dump /var/cache/univention-appcenter/appcenter.software-univention.de/4.3/horde_20180621115801.README_UPDATE_EN
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:   Changes with version 5.2.17-2
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:    This update covers the following topics:
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:      * The Horde Hook for the LDAP authentication has been fixed (correct
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:        LDAP hostname and port and starttls).
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:   Changes with version 5.2.17-1
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:    This update covers the following topics:
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:      * The Docker container is now based on UCS 4.3, therefor this update
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:        replaces the old container.
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:      * Horde update to version 5.2.17
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:      * From now on the horde configuration files as well as the php settings
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:        file
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:        (/var/lib/univention-appcenter/apps/horde/etc-horde/php-settings.ini)
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:        are stored in a Docker volume
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:        /var/lib/univention-appcenter/apps/horde/etc-horde on the Docker Host
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:        (/etc/horde in the container) and thus are update safe. Changes to the
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:        horde/php configuration can be made in the files in
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:        /var/lib/univention-appcenter/apps/horde/etc-horde/ on the Docker host
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:        which take effect after a restart of the horde app
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:      * During this update the /etc/horde configuration files are copied from
 13105 actions.upgrade.readme           18-08-26 16:17:16 [    INFO]:        the old to the new container.
 13105 packages                         18-08-26 16:17:17 [   DEBUG]: Holding LOCK
 13105 actions.start                    18-08-26 16:17:17 [   DEBUG]: Calling start
 13105 actions.start.progress           18-08-26 16:17:17 [   DEBUG]: 0
 13105 actions.start                    18-08-26 16:17:17 [   DEBUG]: Calling /etc/init.d/docker-app-horde start
 13105 actions.start                    18-08-26 16:17:17 [    INFO]: Starting docker-app-horde (via systemctl): docker-app-horde.service.
 13105 actions.start                    18-08-26 16:17:17 [   DEBUG]: /etc/init.d/docker-app-horde returned with 0
 13105 actions.start.progress           18-08-26 16:17:17 [   DEBUG]: 100
 13105 actions.upgrade                  18-08-26 16:17:17 [    INFO]: Executing interface update_available for horde
 13105 actions.upgrade.container.db0c   18-08-26 16:17:17 [   DEBUG]: Using container.db0c for container db0cb49ed4ae127ac1eb4deebd0800287147a5aa091c3f7223de254a8c45c854
 13105 actions.upgrade.container.db0c   18-08-26 16:17:17 [   DEBUG]: Calling docker exec -u root db0cb49ed4ae127ac1eb4deebd0800287147a5aa091c3f7223de254a8c45c854 /usr/share/univention-docker-container-mode/update_available --app horde --app-version 5.2.17-2 --error-file /var/univention/tmp/tmpT6tCV9
 13105 actions.upgrade                  18-08-26 16:17:19 [    INFO]: Upgrading app (u'5.2.17-2')
 13105 actions.upgrade                  18-08-26 16:17:19 [    INFO]: Executing interface update_app_version for horde
 13105 actions.upgrade.container.db0c   18-08-26 16:17:19 [   DEBUG]: Using container.db0c for container db0cb49ed4ae127ac1eb4deebd0800287147a5aa091c3f7223de254a8c45c854
 13105 actions.upgrade.container.db0c   18-08-26 16:17:19 [   DEBUG]: Calling docker exec -u root db0cb49ed4ae127ac1eb4deebd0800287147a5aa091c3f7223de254a8c45c854 /usr/share/univention-docker-container-mode/update_app_version --username Administrator --app horde --error-file /var/univention/tmp/tmp1gwGDa --password-file /var/univention/tmp/tmpudsOTh --app-version 5.2.17-2
 13105 actions.upgrade.container.db0c   18-08-26 16:17:19 [    INFO]: Installing packages for horde=5.2.17-2
 13105 actions.upgrade.container.db0c   18-08-26 16:17:22 [    INFO]: Downloading "https://appcenter.software-univention.de/meta-inf/4.1/index.json.gz"...
 13105 actions.upgrade.container.db0c   18-08-26 16:17:22 [    INFO]: Downloading "https://appcenter.software-univention.de/meta-inf/4.1/index.json.gz.gpg"...
 13105 actions.upgrade.container.db0c   18-08-26 16:17:22 [    INFO]: Downloading "https://appcenter.software-univention.de/meta-inf/4.1/all.tar.gpg"...
 13105 actions.upgrade.container.db0c   18-08-26 16:17:23 [    INFO]: Downloading "https://appcenter.software-univention.de/meta-inf/categories.ini"...
 13105 actions.upgrade.container.db0c   18-08-26 16:17:23 [    INFO]: Downloading "https://appcenter.software-univention.de/meta-inf/rating.ini"...
 13105 actions.upgrade.container.db0c   18-08-26 16:17:23 [    INFO]: Downloading "https://appcenter.software-univention.de/meta-inf/license_types.ini"...
 13105 actions.upgrade.container.db0c   18-08-26 16:17:23 [    INFO]: Downloading "http://appcenter.software-univention.de/meta-inf/4.1/all.tar.zsync"...
 13105 actions.upgrade.container.db0c   18-08-26 16:17:27 [ WARNING]: usage: univention-app register [-h] [--noninteractive] [--username USERNAME]
 13105 actions.upgrade.container.db0c   18-08-26 16:17:27 [ WARNING]:                                [--pwdfile PWDFILE] [--component] [--files]
 13105 actions.upgrade.container.db0c   18-08-26 16:17:27 [ WARNING]:                                [--host] [--app] [--database] [--attributes]
 13105 actions.upgrade.container.db0c   18-08-26 16:17:27 [ WARNING]:                                [--do-it] [--undo-it]
 13105 actions.upgrade.container.db0c   18-08-26 16:17:27 [ WARNING]:                                [apps [apps ...]]
 13105 actions.upgrade.container.db0c   18-08-26 16:17:27 [ WARNING]: univention-app register: error: Unable to find version 5.2.17-2 of app horde. Maybe "/usr/bin/univention-app update" to get the latest list of applications?
 13105 actions.upgrade.container.db0c   18-08-26 16:17:27 [ WARNING]: Could not register Component
 13105 actions.upgrade                  18-08-26 16:17:27 [CRITICAL]: Could not register Component

 13105 packages                         18-08-26 16:17:27 [   DEBUG]: Releasing LOCK
 13105 actions.upgrade                  18-08-26 16:17:27 [CRITICAL]: App upgrade script failed
 13105 actions.upgrade                  18-08-26 16:17:27 [ WARNING]: Aborting...
 13105 actions.start                    18-08-26 16:17:27 [   DEBUG]: Calling start
 13105 actions.start.progress           18-08-26 16:17:27 [   DEBUG]: 0
 13105 actions.start                    18-08-26 16:17:27 [   DEBUG]: Calling /etc/init.d/docker-app-horde start
 13105 actions.start                    18-08-26 16:17:27 [    INFO]: Starting docker-app-horde (via systemctl): docker-app-horde.service.
 13105 actions.start                    18-08-26 16:17:27 [   DEBUG]: /etc/init.d/docker-app-horde returned with 0
 13105 actions.start.progress           18-08-26 16:17:27 [   DEBUG]: 100
 13105 utils                            18-08-26 16:17:27 [   DEBUG]: send_information: action=upgrade app=horde value=None status=431
 13105 utils                            18-08-26 16:17:27 [   DEBUG]: tracking information: {'status': 431, 'uuid': '6b85fbcb-4a8b-4756-b9f1-21552fddb873', 'app': u'horde', 'version': u'5.2.17-2', 'role': 'memberserver', 'action': 'upgrade', 'system-uuid': '213a29ad-80b0-4b87-b3b6-9743203235f8'}
 13105 actions.upgrade-search           18-08-26 16:17:28 [   DEBUG]: Calling upgrade-search
 13105 actions.upgrade-search.progress  18-08-26 16:17:28 [   DEBUG]: 0
 13105 actions.upgrade-search           18-08-26 16:17:28 [   DEBUG]: Checking horde=5.2.17-2
 13105 actions.upgrade-search.progress  18-08-26 16:17:28 [   DEBUG]: 100
 13105 actions.upgrade.progress         18-08-26 16:17:28 [   DEBUG]: 100

Can someone please help on this?
Thank you,
Norbert


#2

No one any idea? What does the message actually refer to?


#3

Hi,

seems that we had faulty configuration option in the horde app. This has been fixed now. Could you retry the update?

Best regards,
Felix


#4

Gave it a try, unfortunately no change (exactly the same error logs).
We ran “univention-app register horde=5.2.7-3” (since the problem sounds related to finding applications and solved an update problem here Docker - Horde - Login_problem), might that cause troubles now?

We’ve also upgraded to 4.3-2 errata234.

Please advice (the system runs for a customer we initially convinced to switch to an UCS installation instead of Windows… now too many calendar related problems (in particular when moving appointments) already disappoints them and we hope for stability improvements in this regard with the horde upgrade).
Thank you.