[Bug 1828534] Re: [19.04][Queens -> Rocky] Upgrading to Rocky resulted in "Services not running that should be: designate-producer"

[OpenStack Infra]

Reviewed:  https://review.opendev.org/673360
Committed: https://git.openstack.org/cgit/openstack/designate/commit/?id=556a27e4e9c9c4e21fb0ea46d8d8832d28c85314
Submitter: Zuul
Branch:    master

commit 556a27e4e9c9c4e21fb0ea46d8d8832d28c85314
Author: Corey Bryant <corey.bryant at canonical.com>
Date:   Mon Jul 29 15:44:48 2019 -0400

    Ensure coordination IDs are encoded
    
    Ensure coordination IDs are encoded when working with coordination
    backend. This fixes an issue when upgrading to Python 3 (where bytes
    and str are different types) and _update_partitions() attempts to
    sort types of 'str' and 'bytes', causing designate-producer to crash.
    
    Change-Id: Id8206ee5285d3a73e00ef21b7d3961a29c23ab4b
    Closes-Bug: #1828534


** Changed in: designate
       Status: In Progress => Fix Released

-- 
You received this bug notification because you are a member of Ubuntu
OpenStack, which is subscribed to designate in Ubuntu.
https://bugs.launchpad.net/bugs/1828534

Title:
  [19.04][Queens -> Rocky] Upgrading to Rocky resulted in "Services not
  running that should be: designate-producer"

Status in OpenStack Designate Charm:
  Invalid
Status in Designate:
  Fix Released
Status in designate package in Ubuntu:
  Triaged

Bug description:
  Designate has to use Worker and Producer as of Rocky as the support
  for zone manager and pool manager was up for removal in Rocky. This
  was addressed in https://bugs.launchpad.net/charm-
  designate/+bug/1773190

  During a Queens to Rocky upgrade I ran into an issue with designate-
  producer being down (see the details below).

  I was able to successfully start designate-producer by hand. It looks
  like there were several attempts to restart the service by systemd
  itself ("Scheduled restart job, restart counter is at 5.") which
  eventually failed when the failcount became higher than 5. Debugging
  mode was disabled so I did not see anything in the producer log.

  designate/0*                  blocked   idle       2/lxd/2  10.232.46.153   9001/tcp            Services not running that should be: designate-producer
    hacluster-designate/0*      active    idle                10.232.46.153                       Unit is ready and clustered

  systemctl list-unit-files | grep designate-
  designate-agent.service                  enabled
  designate-api.service                    enabled
  designate-central.service                enabled
  designate-mdns.service                   enabled
  designate-producer.service               enabled
  designate-sink.service                   enabled
  designate-worker.service                 enabled

  ubuntu at juju-eeda89-2-lxd-2:~$ journalctl -u designate-producer.service
  https://paste.ubuntu.com/p/WRXYvfynnd/

  ubuntu at juju-eeda89-2-lxd-2:~$ pgrep -af designate
  172877 bash /lib/systemd/system/jujud-unit-hacluster-designate-0/exec-start.sh
  172878 bash /lib/systemd/system/jujud-unit-designate-0/exec-start.sh
  172884 /var/lib/juju/tools/unit-designate-0/jujud unit --data-dir /var/lib/juju --unit-name designate/0 --debug
  172886 /var/lib/juju/tools/unit-hacluster-designate-0/jujud unit --data-dir /var/lib/juju --unit-name hacluster-designate/0 --debug
  392388 /usr/bin/python3.6 /usr/bin/designate-mdns --config-file=/etc/designate/designate.conf --log-file=/var/log/designate/designate-mdns.log
  392399 /usr/bin/python3.6 /usr/bin/designate-agent --config-file=/etc/designate/designate.conf --log-file=/var/log/designate/designate-agent.log
  392405 /usr/bin/python3.6 /usr/bin/designate-worker --config-file=/etc/designate/designate.conf --log-file=/var/log/designate/designate-worker.log
  392411 /usr/bin/python3.6 /usr/bin/designate-central --config-file=/etc/designate/designate.conf --log-file=/var/log/designate/designate-central.log
  392415 /usr/bin/python3.6 /usr/bin/designate-sink --config-file=/etc/designate/designate.conf --log-file=/var/log/designate/designate-sink.log
  392423 /usr/bin/python3.6 /usr/bin/designate-api --config-file=/etc/designate/designate.conf --log-file=/var/log/designate/designate-api.log
  392481 /usr/bin/python3.6 /usr/bin/designate-central --config-file=/etc/designate/designate.conf --log-file=/var/log/designate/designate-central.log
  392482 /usr/bin/python3.6 /usr/bin/designate-central --config-file=/etc/designate/designate.conf --log-file=/var/log/designate/designate-central.log
  392483 /usr/bin/python3.6 /usr/bin/designate-central --config-file=/etc/designate/designate.conf --log-file=/var/log/designate/designate-central.log
  392484 /usr/bin/python3.6 /usr/bin/designate-central --config-file=/etc/designate/designate.conf --log-file=/var/log/designate/designate-central.log

  ----------

  designate/0 unit log:

  2019-05-09 00:20:38 DEBUG openstack-upgrade Setting up designate-producer (1:7.0.0-0ubuntu1~cloud0) ...
  2019-05-09 00:20:38 DEBUG openstack-upgrade Created symlink /etc/systemd/system/multi-user.target.wants/designate-producer.service → /lib/systemd/system/designate-producer.service.

  # journalctl -u designate-producer
  journalctl -u designate-producer | grep start
  May 09 00:20:40 juju-eeda89-2-lxd-2 systemd[1]: designate-producer.service: Service hold-off time over, scheduling restart.
  May 09 00:20:40 juju-eeda89-2-lxd-2 systemd[1]: designate-producer.service: Scheduled restart job, restart counter is at 1.
  May 09 00:20:41 juju-eeda89-2-lxd-2 systemd[1]: designate-producer.service: Service hold-off time over, scheduling restart.
  May 09 00:20:41 juju-eeda89-2-lxd-2 systemd[1]: designate-producer.service: Scheduled restart job, restart counter is at 2.
  May 09 00:20:43 juju-eeda89-2-lxd-2 systemd[1]: designate-producer.service: Service hold-off time over, scheduling restart.
  May 09 00:20:43 juju-eeda89-2-lxd-2 systemd[1]: designate-producer.service: Scheduled restart job, restart counter is at 3.
  May 09 00:20:44 juju-eeda89-2-lxd-2 systemd[1]: designate-producer.service: Service hold-off time over, scheduling restart.
  May 09 00:20:44 juju-eeda89-2-lxd-2 systemd[1]: designate-producer.service: Scheduled restart job, restart counter is at 4.
  May 09 00:20:46 juju-eeda89-2-lxd-2 systemd[1]: designate-producer.service: Service hold-off time over, scheduling restart.
  May 09 00:20:46 juju-eeda89-2-lxd-2 systemd[1]: designate-producer.service: Scheduled restart job, restart counter is at 5.
  May 09 00:20:46 juju-eeda89-2-lxd-2 systemd[1]: Failed to start OpenStack Designate DNSaaS producer.

  designate/0 unit log (continued):

  2019-05-09 00:20:58 INFO juju-log Purging ['designate-pool-manager',
  'designate-zone-manager', 'python-designate', 'python-memcache']

  2019-05-09 00:20:59 DEBUG openstack-upgrade Removing designate-pool-manager (1:7.0.0-0ubuntu1~cloud0) ...
  2019-05-09 00:21:15 DEBUG openstack-upgrade Removing designate-zone-manager (1:7.0.0-0ubuntu1~cloud0) ...
  2019-05-09 00:21:31 DEBUG openstack-upgrade Removing python-designate (1:7.0.0-0ubuntu1~cloud0) ...

  2019-05-09 00:21:31 DEBUG openstack-upgrade update-alternatives: using
  /usr/bin/python3-designate-producer to provide /usr/bin/designate-
  producer (designate-producer) in auto mode

  -------------------

  grep producer /var/log/juju/unit-designate-0.log
  2019-05-09 00:18:43 DEBUG openstack-upgrade update-alternatives: using /usr/bin/python2-designate-producer to provide /usr/bin/designate-producer (designate-producer) in auto mode
  2019-05-09 00:19:58 INFO juju-log Installing ['designate-agent', 'designate-api', 'designate-central', 'designate-common', 'designate-mdns', 'designate-worker', 'designate-sink', 'designate-producer', 'bind9utils', 'python3-designate', 'python-apt', 'memcached', 'python3-memcache', 'haproxy', 'apache2'] with options: ['--option', 'Dpkg::Options::=--force-confnew', '--option', 'Dpkg::Options::=--force-confdef']
  2019-05-09 00:19:58 DEBUG openstack-upgrade   designate-producer designate-worker python3-amqp python3-anyjson
  2019-05-09 00:20:09 DEBUG openstack-upgrade Get:112 http://ubuntu-cloud.archive.canonical.com/ubuntu bionic-updates/rocky/main amd64 designate-producer all 1:7.0.0-0ubuntu1~cloud0 [10.6 kB]
  2019-05-09 00:20:20 DEBUG openstack-upgrade Selecting previously unselected package designate-producer.
  2019-05-09 00:20:20 DEBUG openstack-upgrade Preparing to unpack .../105-designate-producer_1%3a7.0.0-0ubuntu1~cloud0_all.deb ...
  2019-05-09 00:20:20 DEBUG openstack-upgrade Unpacking designate-producer (1:7.0.0-0ubuntu1~cloud0) ...
  2019-05-09 00:20:38 DEBUG openstack-upgrade Setting up designate-producer (1:7.0.0-0ubuntu1~cloud0) ...
  2019-05-09 00:20:38 DEBUG openstack-upgrade Created symlink /etc/systemd/system/multi-user.target.wants/designate-producer.service → /lib/systemd/system/designate-producer.service.
  2019-05-09 00:21:31 DEBUG openstack-upgrade update-alternatives: using /usr/bin/python3-designate-producer to provide /usr/bin/designate-producer (designate-producer) in auto mode

To manage notifications about this bug go to:
https://bugs.launchpad.net/charm-designate/+bug/1828534/+subscriptions