Difficulties with Bench Update and pip upgrade

Hi,

I did a bench update and one of the messages I got was that pip is an older version. So while the Bench Update went through without any errors (I think), I did a pip upgrade as suggsted which threw up a few errors.

For some reason I tried bench update again and this time I got errors as described below. When I ran a bench start, the bench started all right and the output is produced below.

But when I point to the site, I get "Updating, We will be back soon…

Please help. This is an installation that is on the verge of going live.

Thanks

Jay

proman@ERPNProd:~/frappe-bench$ bench update
Already up-to-date.
From https://github.com/frappe/erpnext

  • branch develop -> FETCH_HEAD
    Already up-to-date.
    From https://github.com/frappe/frappe
  • branch develop -> FETCH_HEAD
    Already up-to-date.
    You are using pip version 6.1.1, however version 7.1.0 is available.
    You should consider upgrading via the ‘pip install --upgrade pip’ command.
    You are using pip version 6.1.1, however version 7.1.0 is available.
    You should consider upgrading via the ‘pip install --upgrade pip’ command.
    Database backed up /home/proman/frappe-bench/sites/site1.local/private/backups/20150716_87618838_database.sql.gz
    Migrating site1.local
    Executing erpnext.patches.v5_1.rename_roles in site1.local (1bd3e0294d)
    Traceback (most recent call last):
    File “/usr/lib/python2.7/runpy.py”, line 162, in _run_module_as_main
    main”, fname, loader, pkg_name)
    File “/usr/lib/python2.7/runpy.py”, line 72, in _run_code
    exec code in run_globals
    File “/home/proman/frappe-bench/apps/frappe/frappe/utils/bench_helper.py”, line 77, in
    main()
    File “/home/proman/frappe-bench/apps/frappe/frappe/utils/bench_helper.py”, line 14, in main
    click.Group(commands=commands)(prog_name=‘bench’)
    File “/home/proman/frappe-bench/env/local/lib/python2.7/site-packages/click/core.py”, line 664, in call
    return self.main(*args, **kwargs)
    File “/home/proman/frappe-bench/env/local/lib/python2.7/site-packages/click/core.py”, line 644, in main
    rv = self.invoke(ctx)
    File “/home/proman/frappe-bench/env/local/lib/python2.7/site-packages/click/core.py”, line 991, in invoke
    return _process_result(sub_ctx.command.invoke(sub_ctx))
    File “/home/proman/frappe-bench/env/local/lib/python2.7/site-packages/click/core.py”, line 991, in invoke
    return _process_result(sub_ctx.command.invoke(sub_ctx))
    File “/home/proman/frappe-bench/env/local/lib/python2.7/site-packages/click/core.py”, line 837, in invoke
    return ctx.invoke(self.callback, **ctx.params)
    File “/home/proman/frappe-bench/env/local/lib/python2.7/site-packages/click/core.py”, line 464, in invoke
    return callback(*args, **kwargs)
    File “/home/proman/frappe-bench/apps/frappe/frappe/commands.py”, line 28, in _func
    ret = f(frappe.dict(ctx.obj), *args, **kwargs)
    File “/home/proman/frappe-bench/apps/frappe/frappe/commands.py”, line 205, in migrate
    frappe.modules.patch_handler.run_all()
    File “/home/proman/frappe-bench/apps/frappe/frappe/modules/patch_handler.py”, line 25, in run_all
    if not run_single(patchmodule = patch):
    File “/home/proman/frappe-bench/apps/frappe/frappe/modules/patch_handler.py”, line 52, in run_single
    return execute_patch(patchmodule, method, methodargs)
    File “/home/proman/frappe-bench/apps/frappe/frappe/modules/patch_handler.py”, line 68, in execute_patch
    frappe.get_attr(patchmodule.split()[0] + “.execute”)()
    File “/home/proman/frappe-bench/apps/erpnext/erpnext/patches/v5_1/rename_roles.py”, line 5, in execute
    merge=frappe.db.exists(“Role”, “Stock User”))
    File “/home/proman/frappe-bench/apps/frappe/frappe/init.py”, line 560, in rename_doc
    return rename_doc(doctype, old, new, force=force, merge=merge, ignore_permissions=ignore_permissions)
    File “/home/proman/frappe-bench/apps/frappe/frappe/model/rename_doc.py”, line 30, in rename_doc
    new = validate_rename(doctype, new, meta, merge, force, ignore_permissions)
    File “/home/proman/frappe-bench/apps/frappe/frappe/model/rename_doc.py”, line 94, in validate_rename
    frappe.msgprint(
    (“Another {0} with name {1} exists, select another name”).format(doctype, new), raise_exception=1)
    File “/home/proman/frappe-bench/apps/frappe/frappe/init.py”, line 245, in msgprint
    _raise_exception()
    File “/home/proman/frappe-bench/apps/frappe/frappe/init.py”, line 232, in _raise_exception
    raise ValidationError, encode(msg)
    frappe.exceptions.ValidationError: Another Role with name Stock User exists, select another name

This is the output of the bench start command.

proman@ERPNProd:~/frappe-bench$ bench start
11:46:00 system | worker.1 started (pid=3552)
11:46:00 system | redis_cache.1 started (pid=3555)
11:46:00 system | web.1 started (pid=3553)
11:46:00 system | workerbeat.1 started (pid=3554)
11:46:00 redis_cache.1 | [3562] 16 Jul 11:46:00.073 # Unable to set the max number of files limit to 10032 (Operation not permitted), setting the max clients configuration to 3984.
11:46:00 redis_cache.1 | .
11:46:00 redis_cache.1 | .-__ ''-._ 11:46:00 redis_cache.1 | _.- .. ‘’-._ Redis 2.8.4 (00000000/0) 64 bit
11:46:00 redis_cache.1 | .-.-```. ```\/ _.,_ ''-._ 11:46:00 redis_cache.1 | ( ' , .-` | `, ) Running in stand alone mode 11:46:00 redis_cache.1 | |`-._`-...-` __...-.-.|’_.-'| Port: 11311 11:46:00 redis_cache.1 | |-. ._ / _.-' | PID: 3562 11:46:00 redis_cache.1 |-._ -._-./ .-’ .-’
11:46:00 redis_cache.1 | |-._-.
-.__.-' _.-'_.-'| 11:46:00 redis_cache.1 | |-.
-._ _.-'_.-' | http://redis.io 11:46:00 redis_cache.1 |-._ -._-..-’.-’ .-’
11:46:00 redis_cache.1 | |-._-.
-.__.-' _.-'_.-'| 11:46:00 redis_cache.1 | |-.
-._ _.-'_.-' | 11:46:00 redis_cache.1 |-._ -._-.
.-’_.-’ _.-’
11:46:00 redis_cache.1 | -._-..-’ _.-’
11:46:00 redis_cache.1 | -._ _.-' 11:46:00 redis_cache.1 |-.
.-’
11:46:00 redis_cache.1 |
11:46:00 redis_cache.1 | [3562] 16 Jul 11:46:00.073 # Server started, Redis version 2.8.4
11:46:00 redis_cache.1 | [3562] 16 Jul 11:46:00.073 # WARNING overcommit_memory is set to 0! Background save 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.
11:46:00 redis_cache.1 | [3562] 16 Jul 11:46:00.073 * The server is now ready to accept connections on port 11311
11:46:00 web.1 | * Running on http://0.0.0.0:8000/ (Press CTRL+C to quit)
11:46:00 workerbeat.1 | celery beat v3.1.18 (Cipater) is starting.
11:46:00 web.1 | * Restarting with stat
11:46:01 workerbeat.1 | __ - … __ - _
11:46:01 workerbeat.1 | Configuration ->
11:46:01 workerbeat.1 | . broker -> redis://localhost:6379//
11:46:01 workerbeat.1 | . loader -> celery.loaders.app.AppLoader
11:46:01 workerbeat.1 | . scheduler -> celery.beat.PersistentScheduler
11:46:01 workerbeat.1 | . db -> scheduler.schedule
11:46:01 workerbeat.1 | . logfile -> [stderr]@%INFO
11:46:01 workerbeat.1 | . maxinterval -> now (0s)
11:46:01 workerbeat.1 | [2015-07-16 11:46:01,031: INFO/MainProcess] beat: Starting…
11:46:01 worker.1 |
11:46:01 worker.1 | -------------- celery@ERPNProd v3.1.18 (Cipater)
11:46:01 worker.1 | ---- **** -----
11:46:01 worker.1 | — * *** * – Linux-3.13.0-24-generic-x86_64-with-Ubuntu-14.04-trusty
11:46:01 worker.1 | – * - **** —
11:46:01 worker.1 | - ** ---------- [config]
11:46:01 worker.1 | - ** ---------- .> app: frappe:0x7f7a4e899950
11:46:01 worker.1 | - ** ---------- .> transport: redis://localhost:6379//
11:46:01 worker.1 | - ** ---------- .> results: disabled
11:46:01 worker.1 | - *** — * — .> concurrency: 4 (prefork)
11:46:01 worker.1 | – ******* ----
11:46:01 worker.1 | — ***** ----- [queues]
11:46:01 worker.1 | -------------- .> celery exchange=celery(direct) key=celery
11:46:01 worker.1 |
11:46:01 worker.1 |
11:46:01 workerbeat.1 | [2015-07-16 11:46:01,274: INFO/MainProcess] Scheduler: Sending due task scheduler (frappe.tasks.enqueue_scheduler_events)
11:46:02 worker.1 | [2015-07-16 11:46:02,162: WARNING/MainProcess] celery@ERPNProd ready.
11:46:29 web.1 | 10.10.10.222 - - [16/Jul/2015 11:46:29] “GET / HTTP/1.1” 503 -
11:46:29 web.1 | 10.10.10.222 - - [16/Jul/2015 11:46:29] “GET /favicon.ico HTTP/1.1” 503 -
^C11:47:04 system | SIGINT received
11:47:04 system | sending SIGTERM to worker.1 (pid 3552)
11:47:04 system | sending SIGTERM to redis_cache.1 (pid 3555)
11:47:04 system | sending SIGTERM to web.1 (pid 3553)
11:47:04 system | sending SIGTERM to workerbeat.1 (pid 3554)
11:47:04 redis_cache.1 | [3562 | signal handler] (1437027424) Received SIGTERM, scheduling shutdown…
11:47:04 worker.1 |
11:47:04 worker.1 | worker: Warm shutdown (MainProcess)
11:47:04 redis_cache.1 | [3562] 16 Jul 11:47:04.187 # User requested shutdown…
11:47:04 redis_cache.1 | [3562] 16 Jul 11:47:04.187 # Redis is now ready to exit, bye bye…
11:47:04 system | redis_cache.1 stopped (rc=-15)
11:47:04 system | web.1 stopped (rc=-15)
11:47:04 system | workerbeat.1 stopped (rc=-15)
11:47:05 system | worker.1 stopped (rc=-15)

There was an issue. Fixed now.

Problem fixed. Thanks much!