builder: mozilla-central_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-027 starttime: 1494244373.09 results: success (0) revision: 1fda52a1f3b81cf1a821155998dca637bb64e3d9 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-05-08 04:52:53.090604) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-05-08 04:52:53.091142) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-05-08 04:52:53.093533) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-05-08 04:52:53.127068) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-08 04:52:53.127518) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-05-08 04:52:54-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 20.1M=0.001s 2017-05-08 04:52:54 (20.1 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.093448 ========= master_lag: 0.04 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-05-08 04:52:53.262081) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-05-08 04:52:53.266941) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018370 ========= master_lag: 0.06 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-05-08 04:52:53.344870) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-05-08 04:52:53.345193) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 1fda52a1f3b81cf1a821155998dca637bb64e3d9 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo mozilla-central --rev 1fda52a1f3b81cf1a821155998dca637bb64e3d9 --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-05-08 04:52:54,451 truncating revision to first 12 chars 2017-05-08 04:52:54,451 Setting DEBUG logging. 2017-05-08 04:52:54,451 attempt 1/10 2017-05-08 04:52:54,451 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/1fda52a1f3b8?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-05-08 04:52:55,753 unpacking tar archive at: mozilla-central-1fda52a1f3b8/testing/mozharness/ program finished with exit code 0 elapsedTime=1.567003 ========= master_lag: 0.07 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2017-05-08 04:52:54.981244) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-05-08 04:52:54.981641) ========= script_repo_revision: 1fda52a1f3b81cf1a821155998dca637bb64e3d9 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-05-08 04:52:54.982091) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-05-08 04:52:54.982385) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-05-08 04:52:55.018120) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 48 secs) (at 2017-05-08 04:52:55.021454) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox-Non-PGO', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox-Non-PGO'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 04:52:56 INFO - MultiFileLogger online at 20170508 04:52:56 in /builds/slave/test 04:52:56 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox-Non-PGO --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox-Non-PGO 04:52:56 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 04:52:56 INFO - {'append_to_log': False, 04:52:56 INFO - 'base_work_dir': '/builds/slave/test', 04:52:56 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 04:52:56 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 04:52:56 INFO - 'branch': 'Firefox-Non-PGO', 04:52:56 INFO - 'buildbot_json_path': 'buildprops.json', 04:52:56 INFO - 'config_files': ('talos/linux_config.py',), 04:52:56 INFO - 'default_actions': ('clobber', 04:52:56 INFO - 'read-buildbot-config', 04:52:56 INFO - 'download-and-extract', 04:52:56 INFO - 'populate-webroot', 04:52:56 INFO - 'create-virtualenv', 04:52:56 INFO - 'install', 04:52:56 INFO - 'run-tests'), 04:52:56 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:52:56 INFO - 'download_minidump_stackwalk': True, 04:52:56 INFO - 'download_symbols': 'ondemand', 04:52:56 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 04:52:56 INFO - 'tooltool.py': '/tools/tooltool.py', 04:52:56 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 04:52:56 INFO - '/tools/misc-python/virtualenv.py')}, 04:52:56 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:52:56 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:52:56 INFO - 'gecko_profile': False, 04:52:56 INFO - 'gecko_profile_interval': 0, 04:52:56 INFO - 'installer_path': 'installer.exe', 04:52:56 INFO - 'log_level': 'info', 04:52:56 INFO - 'log_name': 'talos', 04:52:56 INFO - 'log_to_console': True, 04:52:56 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 04:52:56 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 04:52:56 INFO - 'opt_config_files': (), 04:52:56 INFO - 'pip_index': False, 04:52:56 INFO - 'suite': 'dromaeojs-e10s', 04:52:56 INFO - 'system_bits': '32', 04:52:56 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 04:52:56 INFO - 'title': 'talos-linux64-ix-027', 04:52:56 INFO - 'tooltool_cache': '/builds/tooltool_cache', 04:52:56 INFO - 'use_talos_json': True, 04:52:56 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 04:52:56 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:52:56 INFO - 'work_dir': 'build'} 04:52:56 INFO - [mozharness: 2017-05-08 11:52:56.206915Z] Running clobber step. 04:52:56 INFO - Running pre-action listener: _resource_record_pre_action 04:52:56 INFO - Running main action method: clobber 04:52:56 INFO - rmtree: /builds/slave/test/build 04:52:56 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 04:52:57 INFO - Running post-action listener: _resource_record_post_action 04:52:57 INFO - [mozharness: 2017-05-08 11:52:57.664066Z] Finished clobber step (success) 04:52:57 INFO - [mozharness: 2017-05-08 11:52:57.664163Z] Running read-buildbot-config step. 04:52:57 INFO - Running pre-action listener: _resource_record_pre_action 04:52:57 INFO - Running main action method: read_buildbot_config 04:52:57 INFO - Using buildbot properties: 04:52:57 INFO - { 04:52:57 INFO - "project": "", 04:52:57 INFO - "product": "firefox", 04:52:57 INFO - "who": "nobody@mozilla.org", 04:52:57 INFO - "installer_path": "public/build/target.tar.bz2", 04:52:57 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-e10s", 04:52:57 INFO - "repository": "https://hg.mozilla.org/mozilla-central", 04:52:57 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs-e10s", 04:52:57 INFO - "stage_platform": "linux64", 04:52:57 INFO - "basedir": "/builds/slave/test", 04:52:57 INFO - "buildnumber": 588, 04:52:57 INFO - "platform": "ubuntu64_hw", 04:52:57 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 04:52:57 INFO - "slavebuilddir": "test", 04:52:57 INFO - "taskId": "QylnOEH3SjucOCnPP6vKaw", 04:52:57 INFO - "branch": "mozilla-central", 04:52:57 INFO - "script_repo_revision": "production", 04:52:57 INFO - "revision": "1fda52a1f3b81cf1a821155998dca637bb64e3d9", 04:52:57 INFO - "slavename": "talos-linux64-ix-027", 04:52:57 INFO - "repo_path": "mozilla-central" 04:52:57 INFO - } 04:52:57 INFO - Finding installer, test and symbols from parent task. 04:52:57 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/QylnOEH3SjucOCnPP6vKaw'}, attempt #1 04:52:58 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/QylnOEH3SjucOCnPP6vKaw'}, attempt #1 04:52:58 INFO - Task dependencies: Ux01QjPkRBa95o8xlSG6LQ 04:52:58 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ'}, attempt #1 04:52:59 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.tar.bz2 04:52:59 INFO - Set test_url: https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/test_packages.json 04:52:59 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.crashreporter-symbols.zip 04:52:59 INFO - Running post-action listener: _resource_record_post_action 04:52:59 INFO - [mozharness: 2017-05-08 11:52:59.024296Z] Finished read-buildbot-config step (success) 04:52:59 INFO - [mozharness: 2017-05-08 11:52:59.024512Z] Running download-and-extract step. 04:52:59 INFO - Running pre-action listener: _resource_record_pre_action 04:52:59 INFO - Running main action method: download_and_extract 04:52:59 INFO - mkdir: /builds/slave/test/build/tests 04:52:59 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:52:59 INFO - trying https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.test_packages.json 04:52:59 INFO - Downloading https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 04:52:59 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 04:52:59 INFO - Downloaded 986 bytes. 04:52:59 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 04:52:59 INFO - Using the following test package requirements: 04:52:59 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 04:52:59 INFO - u'common': [u'target.common.tests.zip'], 04:52:59 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 04:52:59 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 04:52:59 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 04:52:59 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 04:52:59 INFO - u'mozbase': [u'target.common.tests.zip'], 04:52:59 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 04:52:59 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 04:52:59 INFO - u'web-platform': [u'target.common.tests.zip', 04:52:59 INFO - u'target.web-platform.tests.zip'], 04:52:59 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 04:52:59 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 04:52:59 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.common.tests.zip 04:52:59 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.common.tests.zip'}, attempt #1 04:52:59 INFO - Fetch https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.common.tests.zip into memory 04:53:02 INFO - Content-Length response header: 60564935 04:53:02 INFO - Bytes received: 60564935 04:53:11 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 04:53:11 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.common.tests.zip 04:53:11 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.common.tests.zip'}, attempt #1 04:53:11 INFO - Fetch https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.common.tests.zip into memory 04:53:13 INFO - Content-Length response header: 60564935 04:53:13 INFO - Bytes received: 60564935 04:53:24 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.talos.tests.zip 04:53:24 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.talos.tests.zip'}, attempt #1 04:53:24 INFO - Fetch https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.talos.tests.zip into memory 04:53:25 INFO - Content-Length response header: 14409362 04:53:25 INFO - Bytes received: 14409362 04:53:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:53:25 INFO - trying https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.tar.bz2 04:53:25 INFO - Downloading https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 04:53:25 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 04:53:28 INFO - Downloaded 64038401 bytes. 04:53:28 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.tar.bz2 04:53:28 INFO - mkdir: /builds/slave/test/properties 04:53:28 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 04:53:28 INFO - Writing to file /builds/slave/test/properties/build_url 04:53:28 INFO - Contents: 04:53:28 INFO - build_url:https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.tar.bz2 04:53:28 INFO - Running post-action listener: _resource_record_post_action 04:53:28 INFO - Running post-action listener: set_extra_try_arguments 04:53:28 INFO - [mozharness: 2017-05-08 11:53:28.270474Z] Finished download-and-extract step (success) 04:53:28 INFO - [mozharness: 2017-05-08 11:53:28.270570Z] Running populate-webroot step. 04:53:28 INFO - Running pre-action listener: _resource_record_pre_action 04:53:28 INFO - Running main action method: populate_webroot 04:53:28 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 04:53:28 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 04:53:28 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 04:53:28 INFO - '--tppagecycles', 04:53:28 INFO - '7'], 04:53:28 INFO - 'tests': ['tsvgm']}}, 04:53:28 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 04:53:28 INFO - 'tests': ['tresize', 'tcanvasmark']}, 04:53:28 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 04:53:28 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 04:53:28 INFO - 'tests': ['dromaeo_css', 'kraken']}, 04:53:28 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 04:53:28 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 04:53:28 INFO - 'talos_options': ['--disable-e10s'], 04:53:28 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:53:28 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 04:53:28 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:53:28 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 04:53:28 INFO - 'talos_options': ['--disable-e10s'], 04:53:28 INFO - 'tests': ['damp', 'tps']}, 04:53:28 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 04:53:28 INFO - 'tests': ['damp', 'tps']}, 04:53:28 INFO - 'g3': {'talos_options': ['--disable-e10s'], 04:53:28 INFO - 'tests': ['dromaeo_dom']}, 04:53:28 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 04:53:28 INFO - 'g4': {'talos_options': ['--disable-e10s'], 04:53:28 INFO - 'tests': ['basic_compositor_video', 'glvideo']}, 04:53:28 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 04:53:28 INFO - 'other': {'talos_options': ['--disable-e10s'], 04:53:28 INFO - 'tests': ['a11yr', 04:53:28 INFO - 'ts_paint', 04:53:28 INFO - 'tpaint', 04:53:28 INFO - 'sessionrestore', 04:53:28 INFO - 'sessionrestore_no_auto_restore', 04:53:28 INFO - 'tabpaint']}, 04:53:28 INFO - 'other-e10s': {'tests': ['a11yr', 04:53:28 INFO - 'ts_paint', 04:53:28 INFO - 'tpaint', 04:53:28 INFO - 'sessionrestore', 04:53:28 INFO - 'sessionrestore_no_auto_restore', 04:53:28 INFO - 'tabpaint']}, 04:53:28 INFO - 'other-e10s_l64': {'tests': ['a11yr', 04:53:28 INFO - 'ts_paint', 04:53:28 INFO - 'tpaint', 04:53:28 INFO - 'sessionrestore', 04:53:28 INFO - 'sessionrestore_no_auto_restore', 04:53:28 INFO - 'tabpaint']}, 04:53:28 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 04:53:28 INFO - 'ts_paint', 04:53:28 INFO - 'tpaint', 04:53:28 INFO - 'sessionrestore', 04:53:28 INFO - 'sessionrestore_no_auto_restore', 04:53:28 INFO - 'tabpaint']}, 04:53:28 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 04:53:28 INFO - 'tests': ['a11yr', 04:53:28 INFO - 'ts_paint', 04:53:28 INFO - 'tpaint', 04:53:28 INFO - 'sessionrestore', 04:53:28 INFO - 'sessionrestore_no_auto_restore', 04:53:28 INFO - 'tabpaint']}, 04:53:28 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 04:53:28 INFO - 'tests': ['a11yr', 04:53:28 INFO - 'ts_paint', 04:53:28 INFO - 'tpaint', 04:53:28 INFO - 'sessionrestore', 04:53:28 INFO - 'sessionrestore_no_auto_restore', 04:53:28 INFO - 'tabpaint']}, 04:53:28 INFO - 'perf-reftest': {'tests': ['bloom_basic', 'bloom_basic_ref']}, 04:53:28 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic', 04:53:28 INFO - 'bloom_basic_ref']}, 04:53:28 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 04:53:28 INFO - 'tests': ['tsvgx', 04:53:28 INFO - 'tsvgr_opacity', 04:53:28 INFO - 'tart', 04:53:28 INFO - 'tscrollx', 04:53:28 INFO - 'cart', 04:53:28 INFO - 'tsvg_static']}, 04:53:28 INFO - 'svgr-e10s': {'tests': ['tsvgx', 04:53:28 INFO - 'tsvgr_opacity', 04:53:28 INFO - 'tart', 04:53:28 INFO - 'tscrollx', 04:53:28 INFO - 'cart', 04:53:28 INFO - 'tsvg_static']}, 04:53:28 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 04:53:28 INFO - 'talos_options': ['--disable-e10s'], 04:53:28 INFO - 'tests': ['tp5o']}, 04:53:28 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 04:53:28 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 04:53:28 INFO - 'talos_options': ['--disable-e10s', 04:53:28 INFO - '--xperf_path', 04:53:28 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:53:28 INFO - 'tests': ['tp5n']}, 04:53:28 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 04:53:28 INFO - 'talos_options': ['--xperf_path', 04:53:28 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:53:28 INFO - 'tests': ['tp5n']}}, 04:53:28 INFO - 'talos.zip': {'path': '', 04:53:28 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 04:53:28 INFO - Running post-action listener: _resource_record_post_action 04:53:28 INFO - [mozharness: 2017-05-08 11:53:28.284125Z] Finished populate-webroot step (success) 04:53:28 INFO - [mozharness: 2017-05-08 11:53:28.284214Z] Running create-virtualenv step. 04:53:28 INFO - Running pre-action listener: _resource_record_pre_action 04:53:28 INFO - Running main action method: create_virtualenv 04:53:28 INFO - Creating virtualenv /builds/slave/test/build/venv 04:53:28 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 04:53:28 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 04:53:28 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 04:53:28 INFO - Using real prefix '/usr' 04:53:28 INFO - New python executable in /builds/slave/test/build/venv/bin/python 04:53:28 INFO - Installing distribute.............................................................................................................................................................................................done. 04:53:30 INFO - Installing pip.................done. 04:53:30 INFO - Return code: 0 04:53:30 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 04:53:30 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 04:53:31 INFO - Reading from file tmpfile_stdout 04:53:31 INFO - Output received: 04:53:31 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 04:53:31 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 04:53:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:53:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:53:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:53:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:53:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:31 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x138c1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1558a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16fe770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16fba30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16fc7f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16fcca0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:53:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 04:53:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 04:53:31 INFO - Using env: {'DISPLAY': ':0', 04:53:31 INFO - 'HOME': '/home/cltbld', 04:53:31 INFO - 'LANG': 'en_US.UTF-8', 04:53:31 INFO - 'LANGUAGE': 'en_US:en', 04:53:31 INFO - 'LOGNAME': 'cltbld', 04:53:31 INFO - 'MAIL': '/var/mail/cltbld', 04:53:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:53:31 INFO - 'MOZ_NO_REMOTE': '1', 04:53:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:53:31 INFO - 'NO_EM_RESTART': '1', 04:53:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:53:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:53:31 INFO - 'PWD': '/builds/slave/test', 04:53:31 INFO - 'SHELL': '/bin/bash', 04:53:31 INFO - 'SHLVL': '1', 04:53:31 INFO - 'TERM': 'linux', 04:53:31 INFO - 'TMOUT': '86400', 04:53:31 INFO - 'USER': 'cltbld', 04:53:31 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662', 04:53:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:53:31 INFO - '_': '/tools/buildbot/bin/python'} 04:53:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:53:31 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 04:53:31 INFO - Cleaning up... 04:53:31 INFO - Return code: 0 04:53:31 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 04:53:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:53:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:53:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:31 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:53:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:53:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:31 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x138c1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1558a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16fe770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16fba30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16fc7f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16fcca0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:53:31 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 04:53:31 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 04:53:31 INFO - Using env: {'DISPLAY': ':0', 04:53:31 INFO - 'HOME': '/home/cltbld', 04:53:31 INFO - 'LANG': 'en_US.UTF-8', 04:53:31 INFO - 'LANGUAGE': 'en_US:en', 04:53:31 INFO - 'LOGNAME': 'cltbld', 04:53:31 INFO - 'MAIL': '/var/mail/cltbld', 04:53:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:53:31 INFO - 'MOZ_NO_REMOTE': '1', 04:53:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:53:31 INFO - 'NO_EM_RESTART': '1', 04:53:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:53:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:53:31 INFO - 'PWD': '/builds/slave/test', 04:53:31 INFO - 'SHELL': '/bin/bash', 04:53:31 INFO - 'SHLVL': '1', 04:53:31 INFO - 'TERM': 'linux', 04:53:31 INFO - 'TMOUT': '86400', 04:53:31 INFO - 'USER': 'cltbld', 04:53:31 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662', 04:53:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:53:31 INFO - '_': '/tools/buildbot/bin/python'} 04:53:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:53:31 INFO - Downloading/unpacking psutil>=3.1.1 04:53:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:53:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:53:31 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:53:31 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:53:31 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:53:31 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:53:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 04:53:32 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:53:32 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:53:32 INFO - Installing collected packages: psutil 04:53:32 INFO - Running setup.py install for psutil 04:53:32 INFO - building 'psutil._psutil_linux' extension 04:53:32 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 04:53:32 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 04:53:33 INFO - building 'psutil._psutil_posix' extension 04:53:33 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 04:53:33 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 04:53:33 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:53:33 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:53:33 INFO - Successfully installed psutil 04:53:33 INFO - Cleaning up... 04:53:33 INFO - Return code: 0 04:53:33 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 04:53:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:53:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:53:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:33 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:53:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:53:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:33 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x138c1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1558a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16fe770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16fba30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16fc7f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16fcca0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:53:33 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 04:53:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 04:53:33 INFO - Using env: {'DISPLAY': ':0', 04:53:33 INFO - 'HOME': '/home/cltbld', 04:53:33 INFO - 'LANG': 'en_US.UTF-8', 04:53:33 INFO - 'LANGUAGE': 'en_US:en', 04:53:33 INFO - 'LOGNAME': 'cltbld', 04:53:33 INFO - 'MAIL': '/var/mail/cltbld', 04:53:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:53:33 INFO - 'MOZ_NO_REMOTE': '1', 04:53:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:53:33 INFO - 'NO_EM_RESTART': '1', 04:53:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:53:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:53:33 INFO - 'PWD': '/builds/slave/test', 04:53:33 INFO - 'SHELL': '/bin/bash', 04:53:33 INFO - 'SHLVL': '1', 04:53:33 INFO - 'TERM': 'linux', 04:53:33 INFO - 'TMOUT': '86400', 04:53:33 INFO - 'USER': 'cltbld', 04:53:33 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662', 04:53:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:53:33 INFO - '_': '/tools/buildbot/bin/python'} 04:53:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:53:33 INFO - Downloading/unpacking mozsystemmonitor==0.3 04:53:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:53:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:53:33 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:53:33 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:53:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:53:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:53:34 INFO - Downloading mozsystemmonitor-0.3.tar.gz 04:53:34 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 04:53:34 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 04:53:34 INFO - Installing collected packages: mozsystemmonitor 04:53:34 INFO - Running setup.py install for mozsystemmonitor 04:53:34 INFO - Successfully installed mozsystemmonitor 04:53:34 INFO - Cleaning up... 04:53:34 INFO - Return code: 0 04:53:34 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 04:53:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:53:34 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:53:34 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:34 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:53:34 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:53:34 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:34 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x138c1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1558a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16fe770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16fba30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16fc7f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16fcca0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:53:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 04:53:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 04:53:34 INFO - Using env: {'DISPLAY': ':0', 04:53:34 INFO - 'HOME': '/home/cltbld', 04:53:34 INFO - 'LANG': 'en_US.UTF-8', 04:53:34 INFO - 'LANGUAGE': 'en_US:en', 04:53:34 INFO - 'LOGNAME': 'cltbld', 04:53:34 INFO - 'MAIL': '/var/mail/cltbld', 04:53:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:53:34 INFO - 'MOZ_NO_REMOTE': '1', 04:53:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:53:34 INFO - 'NO_EM_RESTART': '1', 04:53:34 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:53:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:53:34 INFO - 'PWD': '/builds/slave/test', 04:53:34 INFO - 'SHELL': '/bin/bash', 04:53:34 INFO - 'SHLVL': '1', 04:53:34 INFO - 'TERM': 'linux', 04:53:34 INFO - 'TMOUT': '86400', 04:53:34 INFO - 'USER': 'cltbld', 04:53:34 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662', 04:53:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:53:34 INFO - '_': '/tools/buildbot/bin/python'} 04:53:34 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:53:34 INFO - Downloading/unpacking jsonschema==2.5.1 04:53:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:53:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:53:34 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:53:34 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:53:34 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:53:34 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:53:36 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 04:53:36 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 04:53:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:53:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:53:36 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:53:36 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:53:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:53:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:53:36 INFO - Downloading functools32-3.2.3-2.tar.gz 04:53:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 04:53:36 INFO - warning: no files found matching '*.txt' 04:53:36 INFO - no previously-included directories found matching 'build' 04:53:36 INFO - no previously-included directories found matching 'dist' 04:53:36 INFO - no previously-included directories found matching '.git*' 04:53:36 INFO - Installing collected packages: jsonschema, functools32 04:53:36 INFO - Running setup.py install for functools32 04:53:36 INFO - warning: no files found matching '*.txt' 04:53:36 INFO - no previously-included directories found matching 'build' 04:53:36 INFO - no previously-included directories found matching 'dist' 04:53:36 INFO - no previously-included directories found matching '.git*' 04:53:36 INFO - Successfully installed jsonschema functools32 04:53:36 INFO - Cleaning up... 04:53:36 INFO - Return code: 0 04:53:36 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 04:53:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:53:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:53:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:53:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:53:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:36 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x138c1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1558a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16fe770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16fba30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16fc7f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16fcca0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:53:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 04:53:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 04:53:36 INFO - Using env: {'DISPLAY': ':0', 04:53:36 INFO - 'HOME': '/home/cltbld', 04:53:36 INFO - 'LANG': 'en_US.UTF-8', 04:53:36 INFO - 'LANGUAGE': 'en_US:en', 04:53:36 INFO - 'LOGNAME': 'cltbld', 04:53:36 INFO - 'MAIL': '/var/mail/cltbld', 04:53:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:53:36 INFO - 'MOZ_NO_REMOTE': '1', 04:53:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:53:36 INFO - 'NO_EM_RESTART': '1', 04:53:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:53:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:53:36 INFO - 'PWD': '/builds/slave/test', 04:53:36 INFO - 'SHELL': '/bin/bash', 04:53:36 INFO - 'SHLVL': '1', 04:53:36 INFO - 'TERM': 'linux', 04:53:36 INFO - 'TMOUT': '86400', 04:53:36 INFO - 'USER': 'cltbld', 04:53:36 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662', 04:53:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:53:36 INFO - '_': '/tools/buildbot/bin/python'} 04:53:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:53:36 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 04:53:36 INFO - Cleaning up... 04:53:36 INFO - Return code: 0 04:53:36 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 04:53:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:53:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:53:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:53:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:53:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:36 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x138c1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1558a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16fe770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16fba30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16fc7f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16fcca0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:53:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 04:53:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 04:53:36 INFO - Using env: {'DISPLAY': ':0', 04:53:36 INFO - 'HOME': '/home/cltbld', 04:53:36 INFO - 'LANG': 'en_US.UTF-8', 04:53:36 INFO - 'LANGUAGE': 'en_US:en', 04:53:36 INFO - 'LOGNAME': 'cltbld', 04:53:36 INFO - 'MAIL': '/var/mail/cltbld', 04:53:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:53:36 INFO - 'MOZ_NO_REMOTE': '1', 04:53:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:53:36 INFO - 'NO_EM_RESTART': '1', 04:53:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:53:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:53:36 INFO - 'PWD': '/builds/slave/test', 04:53:36 INFO - 'SHELL': '/bin/bash', 04:53:36 INFO - 'SHLVL': '1', 04:53:36 INFO - 'TERM': 'linux', 04:53:36 INFO - 'TMOUT': '86400', 04:53:36 INFO - 'USER': 'cltbld', 04:53:36 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662', 04:53:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:53:36 INFO - '_': '/tools/buildbot/bin/python'} 04:53:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:53:36 INFO - Downloading/unpacking blobuploader==1.2.4 04:53:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:53:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:53:36 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:53:36 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:53:36 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:53:36 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:53:38 INFO - Downloading blobuploader-1.2.4.tar.gz 04:53:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 04:53:38 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 04:53:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:53:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:53:38 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:53:38 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:53:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:53:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:53:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 04:53:38 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 04:53:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:53:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:53:38 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:53:38 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:53:38 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:53:38 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:53:38 INFO - Downloading docopt-0.6.1.tar.gz 04:53:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 04:53:38 INFO - Installing collected packages: blobuploader, requests, docopt 04:53:38 INFO - Running setup.py install for blobuploader 04:53:38 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 04:53:38 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 04:53:38 INFO - Running setup.py install for requests 04:53:39 INFO - Running setup.py install for docopt 04:53:39 INFO - Successfully installed blobuploader requests docopt 04:53:39 INFO - Cleaning up... 04:53:39 INFO - Return code: 0 04:53:39 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:53:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:53:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:53:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:53:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:53:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:39 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x138c1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1558a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16fe770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16fba30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16fc7f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16fcca0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:53:39 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 04:53:39 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 04:53:39 INFO - Using env: {'DISPLAY': ':0', 04:53:39 INFO - 'HOME': '/home/cltbld', 04:53:39 INFO - 'LANG': 'en_US.UTF-8', 04:53:39 INFO - 'LANGUAGE': 'en_US:en', 04:53:39 INFO - 'LOGNAME': 'cltbld', 04:53:39 INFO - 'MAIL': '/var/mail/cltbld', 04:53:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:53:39 INFO - 'MOZ_NO_REMOTE': '1', 04:53:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:53:39 INFO - 'NO_EM_RESTART': '1', 04:53:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:53:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:53:39 INFO - 'PWD': '/builds/slave/test', 04:53:39 INFO - 'SHELL': '/bin/bash', 04:53:39 INFO - 'SHLVL': '1', 04:53:39 INFO - 'TERM': 'linux', 04:53:39 INFO - 'TMOUT': '86400', 04:53:39 INFO - 'USER': 'cltbld', 04:53:39 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662', 04:53:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:53:39 INFO - '_': '/tools/buildbot/bin/python'} 04:53:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:53:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:53:39 INFO - Running setup.py (path:/tmp/pip-dYZsUL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:53:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:53:39 INFO - Running setup.py (path:/tmp/pip-uF_xuy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:53:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:53:39 INFO - Running setup.py (path:/tmp/pip-Fmmykq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:53:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:53:39 INFO - Running setup.py (path:/tmp/pip-JH5_I8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:53:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:53:39 INFO - Running setup.py (path:/tmp/pip-6Cl3v9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:53:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:53:39 INFO - Running setup.py (path:/tmp/pip-fxhq7D-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:53:40 INFO - Running setup.py (path:/tmp/pip-2Cz6nh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:53:40 INFO - Running setup.py (path:/tmp/pip-hyrdRk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:53:40 INFO - Running setup.py (path:/tmp/pip-7zNKgr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:53:40 INFO - Running setup.py (path:/tmp/pip-B2JZW_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:53:40 INFO - Running setup.py (path:/tmp/pip-W5_4N_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:53:40 INFO - Running setup.py (path:/tmp/pip-6nVnXy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:53:40 INFO - Running setup.py (path:/tmp/pip-faSGNe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:53:40 INFO - Running setup.py (path:/tmp/pip-aUYQ24-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:53:40 INFO - Running setup.py (path:/tmp/pip-A4u5CK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:53:40 INFO - Running setup.py (path:/tmp/pip-5Q1xCJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:53:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:53:40 INFO - Running setup.py (path:/tmp/pip-0hkS5e-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:53:40 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 04:53:40 INFO - Running setup.py install for manifestparser 04:53:40 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 04:53:40 INFO - Running setup.py install for mozcrash 04:53:40 INFO - Running setup.py install for mozdebug 04:53:41 INFO - Running setup.py install for mozdevice 04:53:41 INFO - Installing dm script to /builds/slave/test/build/venv/bin 04:53:41 INFO - Running setup.py install for mozfile 04:53:41 INFO - Running setup.py install for mozhttpd 04:53:41 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 04:53:41 INFO - Running setup.py install for mozinfo 04:53:41 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 04:53:41 INFO - Running setup.py install for mozInstall 04:53:41 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 04:53:41 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 04:53:41 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 04:53:41 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 04:53:41 INFO - Running setup.py install for mozleak 04:53:41 INFO - Running setup.py install for mozlog 04:53:41 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 04:53:41 INFO - Running setup.py install for moznetwork 04:53:41 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 04:53:41 INFO - Running setup.py install for mozprocess 04:53:42 INFO - Running setup.py install for mozprofile 04:53:42 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 04:53:42 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 04:53:42 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 04:53:42 INFO - Running setup.py install for mozrunner 04:53:42 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 04:53:42 INFO - Running setup.py install for mozscreenshot 04:53:42 INFO - Running setup.py install for moztest 04:53:42 INFO - Running setup.py install for mozversion 04:53:42 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 04:53:42 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 04:53:42 INFO - Cleaning up... 04:53:42 INFO - Return code: 0 04:53:42 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:53:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:53:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:53:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:53:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:53:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:42 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x138c1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1558a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16fe770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16fba30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16fc7f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16fcca0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:53:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 04:53:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 04:53:42 INFO - Using env: {'DISPLAY': ':0', 04:53:42 INFO - 'HOME': '/home/cltbld', 04:53:42 INFO - 'LANG': 'en_US.UTF-8', 04:53:42 INFO - 'LANGUAGE': 'en_US:en', 04:53:42 INFO - 'LOGNAME': 'cltbld', 04:53:42 INFO - 'MAIL': '/var/mail/cltbld', 04:53:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:53:42 INFO - 'MOZ_NO_REMOTE': '1', 04:53:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:53:42 INFO - 'NO_EM_RESTART': '1', 04:53:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:53:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:53:42 INFO - 'PWD': '/builds/slave/test', 04:53:42 INFO - 'SHELL': '/bin/bash', 04:53:42 INFO - 'SHLVL': '1', 04:53:42 INFO - 'TERM': 'linux', 04:53:42 INFO - 'TMOUT': '86400', 04:53:42 INFO - 'USER': 'cltbld', 04:53:42 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662', 04:53:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:53:42 INFO - '_': '/tools/buildbot/bin/python'} 04:53:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:53:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:53:42 INFO - Running setup.py (path:/tmp/pip-mwOKEb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:53:42 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 04:53:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:53:42 INFO - Running setup.py (path:/tmp/pip-O4c4Gc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:53:42 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:53:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:53:42 INFO - Running setup.py (path:/tmp/pip-ZHBtiu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:53:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 04:53:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:53:43 INFO - Running setup.py (path:/tmp/pip-8n4H7C-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:53:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.50 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:53:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:53:43 INFO - Running setup.py (path:/tmp/pip-Khzpp7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:53:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 04:53:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:53:43 INFO - Running setup.py (path:/tmp/pip-i4OHn9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:53:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 04:53:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:53:43 INFO - Running setup.py (path:/tmp/pip-9yTQ6X-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:53:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 04:53:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:53:43 INFO - Running setup.py (path:/tmp/pip-7arWCI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:53:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 04:53:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:53:43 INFO - Running setup.py (path:/tmp/pip-CYsIYR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:53:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 04:53:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:53:43 INFO - Running setup.py (path:/tmp/pip-lwNWcM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:53:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:53:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:53:43 INFO - Running setup.py (path:/tmp/pip-SLnVzN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:53:43 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 04:53:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:53:43 INFO - Running setup.py (path:/tmp/pip-EBspLN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:53:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 04:53:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:53:43 INFO - Running setup.py (path:/tmp/pip-EYXCUH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:53:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 04:53:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:53:43 INFO - Running setup.py (path:/tmp/pip-FgutEp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:53:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 04:53:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:53:43 INFO - Running setup.py (path:/tmp/pip-QxQHPg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:53:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 04:53:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:53:43 INFO - Running setup.py (path:/tmp/pip-CpkkKJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:53:43 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 04:53:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:53:43 INFO - Running setup.py (path:/tmp/pip-8efmrS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:53:44 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 04:53:44 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:53:44 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 04:53:44 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 04:53:44 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.50->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:53:44 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.50->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:53:44 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:53:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:53:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:53:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:53:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:53:44 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:53:44 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:53:45 INFO - Downloading blessings-1.6.tar.gz 04:53:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 04:53:45 INFO - Installing collected packages: blessings 04:53:45 INFO - Running setup.py install for blessings 04:53:45 INFO - Successfully installed blessings 04:53:45 INFO - Cleaning up... 04:53:45 INFO - Return code: 0 04:53:45 INFO - Done creating virtualenv /builds/slave/test/build/venv. 04:53:45 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:53:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:53:45 INFO - Reading from file tmpfile_stdout 04:53:45 INFO - Current package versions: 04:53:45 INFO - argparse == 1.2.1 04:53:45 INFO - blessings == 1.6 04:53:45 INFO - blobuploader == 1.2.4 04:53:45 INFO - docopt == 0.6.1 04:53:45 INFO - functools32 == 3.2.3-2 04:53:45 INFO - jsonschema == 2.5.1 04:53:45 INFO - manifestparser == 1.1 04:53:45 INFO - mozInstall == 1.12 04:53:45 INFO - mozcrash == 1.0 04:53:45 INFO - mozdebug == 0.1 04:53:45 INFO - mozdevice == 0.50 04:53:45 INFO - mozfile == 1.2 04:53:45 INFO - mozhttpd == 0.7 04:53:45 INFO - mozinfo == 0.9 04:53:45 INFO - mozleak == 0.1 04:53:45 INFO - mozlog == 3.4 04:53:45 INFO - moznetwork == 0.27 04:53:45 INFO - mozprocess == 0.25 04:53:45 INFO - mozprofile == 0.28 04:53:45 INFO - mozrunner == 6.13 04:53:45 INFO - mozscreenshot == 0.1 04:53:45 INFO - mozsystemmonitor == 0.3 04:53:45 INFO - moztest == 0.8 04:53:45 INFO - mozversion == 1.4 04:53:45 INFO - psutil == 3.1.1 04:53:45 INFO - requests == 1.2.3 04:53:45 INFO - wsgiref == 0.1.2 04:53:45 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:53:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:53:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:53:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:45 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:53:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:53:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:45 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x138c1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1558a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16fe770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16fba30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16fc7f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16fcca0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:53:45 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 04:53:45 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 04:53:45 INFO - Using env: {'DISPLAY': ':0', 04:53:45 INFO - 'HOME': '/home/cltbld', 04:53:45 INFO - 'LANG': 'en_US.UTF-8', 04:53:45 INFO - 'LANGUAGE': 'en_US:en', 04:53:45 INFO - 'LOGNAME': 'cltbld', 04:53:45 INFO - 'MAIL': '/var/mail/cltbld', 04:53:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:53:45 INFO - 'MOZ_NO_REMOTE': '1', 04:53:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:53:45 INFO - 'NO_EM_RESTART': '1', 04:53:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:53:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:53:45 INFO - 'PWD': '/builds/slave/test', 04:53:45 INFO - 'SHELL': '/bin/bash', 04:53:45 INFO - 'SHLVL': '1', 04:53:45 INFO - 'TERM': 'linux', 04:53:45 INFO - 'TMOUT': '86400', 04:53:45 INFO - 'USER': 'cltbld', 04:53:45 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662', 04:53:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:53:45 INFO - '_': '/tools/buildbot/bin/python'} 04:53:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:53:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 04:53:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 04:53:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 04:53:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 04:53:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 04:53:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 04:53:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 04:53:45 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 04:53:45 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 04:53:45 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 04:53:46 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 04:53:46 INFO - Cleaning up... 04:53:46 INFO - Return code: 0 04:53:46 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 04:53:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:53:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:53:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:53:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:53:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:46 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x138c1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1558a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x16fe770>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16fba30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16fc7f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16fcca0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 04:53:46 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 04:53:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 04:53:46 INFO - Using env: {'DISPLAY': ':0', 04:53:46 INFO - 'HOME': '/home/cltbld', 04:53:46 INFO - 'LANG': 'en_US.UTF-8', 04:53:46 INFO - 'LANGUAGE': 'en_US:en', 04:53:46 INFO - 'LOGNAME': 'cltbld', 04:53:46 INFO - 'MAIL': '/var/mail/cltbld', 04:53:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:53:46 INFO - 'MOZ_NO_REMOTE': '1', 04:53:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:53:46 INFO - 'NO_EM_RESTART': '1', 04:53:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:53:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:53:46 INFO - 'PWD': '/builds/slave/test', 04:53:46 INFO - 'SHELL': '/bin/bash', 04:53:46 INFO - 'SHLVL': '1', 04:53:46 INFO - 'TERM': 'linux', 04:53:46 INFO - 'TMOUT': '86400', 04:53:46 INFO - 'USER': 'cltbld', 04:53:46 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662', 04:53:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:53:46 INFO - '_': '/tools/buildbot/bin/python'} 04:53:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:53:46 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 04:53:46 INFO - Cleaning up... 04:53:46 INFO - Return code: 0 04:53:46 INFO - Running post-action listener: _resource_record_post_action 04:53:46 INFO - Running post-action listener: _start_resource_monitoring 04:53:46 INFO - Starting resource monitoring. 04:53:46 INFO - [mozharness: 2017-05-08 11:53:46.272312Z] Finished create-virtualenv step (success) 04:53:46 INFO - [mozharness: 2017-05-08 11:53:46.272824Z] Running install step. 04:53:46 INFO - Running pre-action listener: _resource_record_pre_action 04:53:46 INFO - Running main action method: install 04:53:46 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:53:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:53:46 INFO - Reading from file tmpfile_stdout 04:53:46 INFO - Detecting whether we're running mozinstall >=1.0... 04:53:46 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 04:53:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 04:53:46 INFO - Reading from file tmpfile_stdout 04:53:46 INFO - Output received: 04:53:46 INFO - Usage: mozinstall [options] installer 04:53:46 INFO - Options: 04:53:46 INFO - -h, --help show this help message and exit 04:53:46 INFO - -d DEST, --destination=DEST 04:53:46 INFO - Directory to install application into. [default: 04:53:46 INFO - "/builds/slave/test"] 04:53:46 INFO - --app=APP Application being installed. [default: firefox] 04:53:46 INFO - mkdir: /builds/slave/test/build/application 04:53:46 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 04:53:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 04:54:02 INFO - Reading from file tmpfile_stdout 04:54:02 INFO - Output received: 04:54:02 INFO - /builds/slave/test/build/application/firefox/firefox 04:54:02 INFO - Running post-action listener: _resource_record_post_action 04:54:02 INFO - [mozharness: 2017-05-08 11:54:02.800401Z] Finished install step (success) 04:54:02 INFO - [mozharness: 2017-05-08 11:54:02.800667Z] Running run-tests step. 04:54:02 INFO - Running pre-action listener: _resource_record_pre_action 04:54:02 INFO - Running main action method: run_tests 04:54:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 04:54:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 04:54:02 INFO - Python 2.7.3 04:54:02 INFO - Return code: 0 04:54:02 INFO - grabbing minidump binary from tooltool 04:54:02 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:54:02 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16fba30>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x16fc7f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x16fcca0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 04:54:02 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 04:54:02 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 04:54:02 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 04:54:02 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 04:54:02 INFO - Return code: 0 04:54:02 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 04:54:02 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 04:54:02 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 04:54:02 INFO - ENV: RUST_BACKTRACE is now 1 04:54:02 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 04:54:02 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 04:54:02 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-027', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 04:54:02 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox-Non-PGO --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-027 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 04:54:02 INFO - Using env: {'DISPLAY': ':0', 04:54:02 INFO - 'HOME': '/home/cltbld', 04:54:02 INFO - 'LANG': 'en_US.UTF-8', 04:54:02 INFO - 'LANGUAGE': 'en_US:en', 04:54:02 INFO - 'LOGNAME': 'cltbld', 04:54:02 INFO - 'MAIL': '/var/mail/cltbld', 04:54:02 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 04:54:02 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 04:54:02 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:54:02 INFO - 'MOZ_NO_REMOTE': '1', 04:54:02 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 04:54:02 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:54:02 INFO - 'NO_EM_RESTART': '1', 04:54:02 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:54:02 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:54:02 INFO - 'PWD': '/builds/slave/test', 04:54:02 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 04:54:02 INFO - 'RUST_BACKTRACE': '1', 04:54:02 INFO - 'SHELL': '/bin/bash', 04:54:02 INFO - 'SHLVL': '1', 04:54:02 INFO - 'TERM': 'linux', 04:54:02 INFO - 'TMOUT': '86400', 04:54:02 INFO - 'USER': 'cltbld', 04:54:02 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662', 04:54:02 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:54:02 INFO - '_': '/tools/buildbot/bin/python'} 04:54:02 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox-Non-PGO', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-027', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 04:54:03 INFO - mozversion application_buildid: 20170508100218 04:54:03 INFO - mozversion application_changeset: 1fda52a1f3b81cf1a821155998dca637bb64e3d9 04:54:03 INFO - mozversion application_display_name: Nightly 04:54:03 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 04:54:03 INFO - mozversion application_name: Firefox 04:54:03 INFO - mozversion application_remotingname: firefox 04:54:03 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 04:54:03 INFO - mozversion application_vendor: Mozilla 04:54:03 INFO - mozversion application_version: 55.0a1 04:54:03 INFO - mozversion platform_buildid: 20170508100218 04:54:03 INFO - mozversion platform_changeset: 1fda52a1f3b81cf1a821155998dca637bb64e3d9 04:54:03 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 04:54:03 INFO - mozversion platform_version: 55.0a1 04:54:03 INFO - using testdate: 1494244443 04:54:03 INFO - actual date: 1494244443 04:54:03 INFO - starting webserver on 'localhost:44776' 04:54:03 INFO - SUITE-START | Running 2 tests 04:54:03 INFO - TEST-START | dromaeo_css 04:54:03 INFO - operating with platform_type : linux_ 04:54:03 INFO - Initialising browser for dromaeo_css test... 04:54:03 INFO - TEST-INFO | started process 6948 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpiE8hQT/profile http://localhost:44776/getInfo.html) 04:54:07 INFO - PID 6948 | __metrics Screen width/height:1600/1200 04:54:07 INFO - PID 6948 | colorDepth:24 04:54:07 INFO - PID 6948 | Browser inner width/height: 1024/695 04:54:07 INFO - PID 6948 | __metrics 04:54:08 INFO - TEST-INFO | 6948: exit 0 04:54:08 INFO - Browser initialized. 04:54:08 INFO - Running cycle 1/1 for dromaeo_css test... 04:54:08 INFO - TEST-INFO | started process 7116 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpiE8hQT/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:54:20 INFO - PID 7116 | RSS: Main: 157270016 04:54:20 INFO - PID 7116 | 04:57:22 INFO - PID 7116 | Cycle 1(1): loaded http://localhost:44776/tests/dromaeo/cssquery-dojo.html (next: http://localhost:44776/tests/dromaeo/cssquery-ext.html) 04:57:23 INFO - PID 7116 | RSS: Main: 161456128 04:57:23 INFO - PID 7116 | 05:00:25 INFO - PID 7116 | Cycle 1(1): loaded http://localhost:44776/tests/dromaeo/cssquery-ext.html (next: http://localhost:44776/tests/dromaeo/cssquery-jquery.html) 05:00:26 INFO - PID 7116 | RSS: Main: 157130752 05:00:26 INFO - PID 7116 | 05:03:27 INFO - PID 7116 | Cycle 1(1): loaded http://localhost:44776/tests/dromaeo/cssquery-jquery.html (next: http://localhost:44776/tests/dromaeo/cssquery-mootools.html) 05:03:28 INFO - PID 7116 | RSS: Main: 164741120 05:03:28 INFO - PID 7116 | 05:06:29 INFO - PID 7116 | Cycle 1(1): loaded http://localhost:44776/tests/dromaeo/cssquery-mootools.html (next: http://localhost:44776/tests/dromaeo/cssquery-prototype.html) 05:06:30 INFO - PID 7116 | RSS: Main: 158068736 05:06:30 INFO - PID 7116 | 05:09:33 INFO - PID 7116 | Cycle 1(1): loaded http://localhost:44776/tests/dromaeo/cssquery-prototype.html (next: http://localhost:44776/tests/dromaeo/cssquery-yui.html) 05:09:33 INFO - PID 7116 | RSS: Main: 161587200 05:09:33 INFO - PID 7116 | 05:12:35 INFO - PID 7116 | Cycle 1(1): loaded http://localhost:44776/tests/dromaeo/cssquery-yui.html (next: http://localhost:44776/tests/dromaeo/cssquery-dojo.html) 05:12:35 INFO - PID 7116 | RSS: Main: 162938880 05:12:35 INFO - PID 7116 | 05:12:35 INFO - PID 7116 | __start_tp_report 05:12:35 INFO - PID 7116 | _x_x_mozilla_page_load 05:12:35 INFO - PID 7116 | _x_x_mozilla_page_load_details 05:12:35 INFO - PID 7116 | |i|pagename|runs| 05:12:35 INFO - PID 7116 | |0;dojo.html;3378.695917367438;3390.2541440883006;3411.215420453296;3412.539307193528;3417.1457135716073;5706.942930570693;5723.4848863602265;5733.655980641164;5753.309602847659;5791.565632577553;5716.8284951451415;5752.856178595537;5756.712164391774;5789.536837053026;5807.941920580793;5100.1584738518195;5128.076946149691;5131.435542090367;5135.922961155586;5218.373795144588;5165.070287348276;5181.766820493068;5225.980933717927;5226.137687281594;5229.581633469314;5022.296878437021;5049.671771334888;5086.821961231376;5110.952254787797;5162.6902385856965;5144.819931302386;5147.562457191143;5148.150555158394;5157.4584668610005;5165.63840531163;5094.923576146361;5129.5383415492415;5134.794608215667;5148.9742551287;5168.948310516922;5703.62926409782;5718.485336319751;5755.165501002373;5765.1352297155345;5817.272840894888;6254.906176407358;6280.528960327993;6285.717142728542;6300.243970723497;6311.936880631227;6293.244810622708;6309.526785491106;6337.397947195009;6350.682465876687;6355.046742988588;5821.359650438449;5830.067189249699;5870.236869207019;5870.4716575507555;5931.614445061057;6326.240851097898;6373.553851230462;6379.298277189506;6380.042993551005;6386.16979792624;6033.668148251801;6056.636601803906;6081.057436097412;6117.174181485531;6162.938370616326;6196.318404975449;6206.100115483229;6206.224221972254;6207;6209.813705588839;6122.816315510542;6179.5056395488255;6191.25704915404;6192.287886892975;6259.6870156492905;6207.906881396782;6247.687615619201;6277.686115694197;6282.874342513124;6296.685165741695;4731.432228132646;4739.857804265808;4751.168545504592;4767.856964291077;4789.784459699322;4134.297169481196;4187.5184353799705;4212.615025919575;4217.641500472433;4239.766812825263;5928.496077833346;5970.13433052205;5988.640681559121;5995.430434108753;6037.607555508878;6191.4118158774845;6255.40573645503;6278.466330361879;6281.591696539802;6287.779927702509;5899.616524925866;5904.586678932519;5975.940240597625;5982.40175982407;6019.939800602026;5319.946800532022;5338.786448542092;5391.56867450603;5392.622516423813;5407.486288802557;6381.1066450696935;6500.642464664489;6507.544471887017;6521;6527.086207930798;6284.402981716729;6287.371262873676;6290.622562646256;6298.149749783904;6315.684215789101;6488.188976377953;6608.273089960197;6627.602343859384;6630.436412904957;6643.833904152435;6096.526685943624;6122.733612273432;6122.785702500391;6133.304060594526;6184.350643182401;6228.346023667631;6321.399467050623;6330.936690633219;6341.365863413806;6347.650879201688;5961.791337303173;6039.909401359071;6053.606515576474;6066.332703402534;6119.8470038247615;6145.201123853871;6148.538859585638;6158.414950579688;6163.3836616338;6171.783987560414;6012.458878700938;6102.359252278625;6113.32428171423;6121.816345509642;6149.72326245329;6141.4553230608135;6146.508279337731;6152.723127459186;6184.134221208944;6195.628262304276;5975.223220981245;6027.879442411039;6029.397060293935;6034.63792172471;6056 05:12:35 INFO - PID 7116 | |1;ext.html;720.4884531982292;730.64563686612;1126.6000569797723;1132.8810474900135;1196.521391443423;35693.28613427733;36683.26633467329;36785.632143678624;36822.63177368225;36831.26337473249;34266.65733342666;34482.82758586203;34552.30895382091;34786.130346741345;34792.47811282826;6664.067030615705;6791.3208679132185;7155.356017958383;7341.155767086773;7348.301911318416;7212.134543854745;7219.530730502527;7257.419406447471;7281.635918204095;7295.927040729604;7271.091113610799;7279.235680253577;7298.890516642228;7302.744403945863;7328.596927169004;7231;7279;7288.344049035586;7289.0159828423275;7301.634918254119;7197.4601904857345;7249.347558719741;7257.201707812136;7260.34656880878;7282.963585182093;35825.46261806075;35991.4601280981;36128.277434451426;36198.8190059048;36281.45577816309;3574.392353299945;3577.2487777566744;3582.8925132246072;3586.1393265616325;3613.1509095362567;28404.573931391045;28573.42853142946;28667.13998580046;28764;28852.711472885214;3738.3831667775057;3745.4569087482164;3755.1926335837925;3766.9058273543105;3777.8111094445167;196159;197189;197966;200119.99999999854;200423;44196.55803441989;46475.76762116168;46550.301745473844;46723;46766.29850552244;48219.75890120597;48297.517024830006;48478.5152148474;48478.75760621245;48614;14636.926815366069;14665.120092794466;14685;14711.117332959842;14722.411103555738;11629.88370116305;11680.415979201007;11731.120165987584;11750.412479375997;11756.177067605186;13814.585562433143;13890.930545347208;13894.235817029958;14077.436902523988;14095.180963807075;5553.944460555424;5685.469965865151;5718.485336319751;5727.226824378656;5745.109508026179;1061.490484567412;1088.6951653537021;1089.7221208591916;1096.4627332607124;1108.3959242213014;25422.872885635825;25865.353366165997;25874.6118808218;25912;26017.219483415527;1171.1450641031925;1178.5580407347245;1185.2576712233003;1193.3675152169365;1209.9576514821938;13315.134516256607;13560.389782459813;13598.728025439634;13753.931230343784;13769.518066867611;262144;263221;263385;263474;263673;49803.501964979885;49990.25014624783;50436.49563504318;50543;50700;1470.4779803169934;1490.4485340424112;1513.122389014369;1514.3866733972538;1514.681916797485;23387;23740;23878.641820372362;24455.75544244535;24480.632790508513;36688.44967325439;36932.63067369292;36951.44572831463;37041;37048;207442;208518;209841;209966;210743;33944.32111357809;35402.64597353993;35941.1014724634;36007.87866062828;36142.457863131545;42733.35899961441;44402.333964991194;44775.552244478444;44856;45428.54571454243;32795;32842.343153136324;32867.671323286464;33967.4904876432;34034.31931361408;32932.83533582317;33063.669363307024;33612.495812562345;34688.132796680286;34704.82647586847;38385.808070959465;38394;38423;38576.22847542977;38598;31435.05694829159;31785.523217151298;31813.20466988344;32407.675923241408;33147.50278745869;26459;26949.595756064067;27000.594991074755;27196.592051118852;27519.44961100807 05:12:35 INFO - PID 7116 | |2;jquery.html;424.71968500789484;441.1353746656553;443.31507820417454;452.8664044106986;454.2346146742738;19062.618747625056;19687.31094411694;20466;20566.38300850975;20658.69011964818;21662.783372166272;22138.44653883654;22248.332550023486;22331.44171395712;22362.21732239372;5391.487808658171;5639.774409023655;5659.8585035374235;5660;5687.601867869251;5412;5490.890182196354;5500.28496295481;5503.752331145088;5557.499825015748;5506.146547285177;5530.451473587402;5542.695151766651;5550.389457159709;5563;5486.451354864522;5533.114701647737;5704.201411802351;5743.942560574404;5767.567432442584;5180.093483640348;5182.144946083891;5188.6367954243215;5189.481051894818;5192.6105542084115;25006.49987000268;26070.478590428276;26419.867900660374;26433;26509.3372665683;2153.935381938544;2164.7726988666277;2179.106566307822;2200.7689192634703;2202.9228976985887;16284.83715162845;16544.200288724238;16772.664546709;16901.323947042103;17171.656566868718;2146.270268108835;2228.5542891421783;2239.563285159378;2246.472079061419;2246.7079279693535;105911.47044264806;118353.99999999914;121703.3914830429;123473.38263308626;125840.37079814542;12070.27578345302;12071.637850864488;12596.370181490889;12707.85629293368;12733.36333183337;17073;17129.14354282281;17178.570535736708;17244.568885777957;17253.74119388185;8808.735737927873;8899.466032037968;8953.865692014626;9203;9301.302402319852;8507.404481686222;8522.531260780717;8720.171583699539;8814.294856411472;8887.333449991276;7760.185180556074;7815.687372505036;7889.763307100796;7989.520628762293;8069.838603227902;2196.670499425099;2217.4899773051966;2226.5769503794227;2226.6660000999977;2410.3853517352964;1050.2333296693457;1069.0485467933545;1074.7098283463422;1076.9730756730987;1087.2280680716622;20651.793482064986;20683.482912926997;20685.379438616867;20927.26754563583;21007;1100.4442756408123;1100.5432745410565;1102.873169585492;1104.7900898829196;1105.0441368216595;11106.833397499044;11480.368579728196;12876.678083047811;14128.929355353157;14374.496892608708;564901;565589;569090;588009.119908804;601082;99445.50277248568;102267.4886625562;103380.48309758553;104322;105552;1289.9551363395492;1314.6319030671427;1354.9390277437342;1357.5927221833608;1358.3819362190377;20630.381088567367;20997.790022100195;21294.893525532894;21468;21738.565228695654;44872.55127448684;44968.95402798263;45593.77203113963;45966.540334596226;46883.29675054945;60378.69810650919;60899;62043.37956620376;62528.374716252256;63130;9275.118863707938;9280.443173409618;9324.300677449082;9337.346385752931;9530.285228607743;14345.282735863373;14642.633934151732;14925.92537037308;15019.849801501845;15183.772243416137;12709.682257943625;12876;13007.804882926574;13089.672758181121;13382.799258011333;11473.368964706688;11543.480543375736;11842.11184161174;11998.160128790902;12048.01207800703;13166.144200626928;13227.867721322664;13256.734865302833;13308;13598.796018059935;9140.725778226664;9143.542822858697;9239.445633262027;9375.156235938799;9431.500652327277;12392.256464612152;12392.56626018085;12951.287679177736;13128.671783205496;13309.201447913156 05:12:35 INFO - PID 7116 | |3;mootools.html;1370.93830777615;1400.3838311143093;1401.5795261421572;1404.0382338098404;1404.950826721065;10810.837837432435;11245.100391968643;11255.662330130088;11426.143039272067;11545.249558778694;11390.08879289657;11427.942860285708;11556.364399957998;11563.768724625503;11642.359670218135;2339.2397470821966;2371.6679664846847;2398.568257713611;2405.927822165329;2408.6387041943763;2281.4752606900424;2298.9425264368356;2312.0636142362287;2332.323626148415;2338.368640467073;2340.578695834749;2344.9062037518565;2368.7039120109985;2387.7015373078366;2391.342380845264;2206.3270702435752;2263.1852533088077;2310.607196776544;2312.028947841902;2313.641385585237;2231.2413779314948;2262.162999690125;2262.694536237603;2309.4919117794057;2323.8373313868037;11371.147163962652;11447.484863181176;11467.369294688871;11541.884581154165;11549.711257218552;6493.610383377012;6675;6701.425165086201;6706.094677218562;6710.899336509956;3930.371140617516;4104.1381309924955;4161.146964872194;4167.791610419497;4230.238557059728;1349.6099018011366;1380.3029470117526;1394.5537428023038;1400.0619584878054;1404.115407293409;16773.161341932977;16921.407750728788;16969.236384362608;17113.203113673135;17117.22972466242;5047.974760126176;5147.536721695065;5413.106837371868;5418.945810541923;5480.862978425571;12529.43617537213;12614.55849045279;12627.558035468715;12652.114351995457;12677.873221267853;6527.3472652734345;6528.869422611521;6555.967220163964;6559.770408035696;6590.7693230736695;5993.190919225849;6015.578909476295;6139.877202455926;6204.224471941007;6243;4028.1540876415693;4126.1128857295225;4139.91720165595;4156.7921603919685;4158.480189976253;1250.306080125539;1252.2236213547658;1258.6349958512112;1268.1693490763564;1285.755706415778;825.2861274997084;829.2578142562494;845.0197770586091;852.3351785607236;865.3553102938351;5810.477057064884;5933.139694744238;5934.643921364732;5962.195103661037;6131.908021379683;581.3343721438929;589.3546566509665;599.5413508665874;604.1632339210225;608.7808388979963;3781.8487260509823;4320.4599425071865;4386.758728269912;4458.554144585581;4517.887052823706;14830.70338593222;15171.620709482351;15193.316300766492;15280.235988200546;15354.155521446428;14597.927010365092;15370;15458.5362439127;15535.766963495556;15582.376704931676;9404.482753448627;9445.14993650561;9537.804835380086;9622.711318660451;9633.036696330311;6517.3808488193545;6784.3894049535775;6786.898196527155;6797.286284940208;6819.318068193141;13476.865231347561;13524.661883452993;13879.375428105557;13894.166350019032;13929.721405571629;13781.793273101111;13789.379477923318;13904.096233744775;14119.43522259098;14130.081544699562;9425.481598511873;9663.226941844776;9705.175060119687;9728.513574321398;9787.902120978984;10474.68575942723;10484.79030419372;10513;10640.946795265974;10646.467676616294;8544.829103417773;8558.700445484377;8583.957080214559;8592.183742544448;8670.956645216733;8183.71357002502;8189.7133600323705;8259.793505162419;8391.454555453876;8500.14998500145;7863.724769633035;7943.205679432011;8015.318697910743;8029.59852007409;8035.879461807961;5357.8392648220615;5395.082835917825;5411.134218525017;5579.191017302387;5656.717164141694;5696.601237913306;5756.827295180984;5816.243888294494;5831.7667293307795;5940.376260492586 05:12:35 INFO - PID 7116 | |4;prototype.html;372.8154563491071;387.71696661437153;391.91573811630496;391.9255341485118;395.6794996053199;5820.854478638036;5948.583599148056;5966.880662386755;5988.431099045594;6000.279966404027;5781.479666829984;5851.385604511529;5869.823905282838;5878.353381128072;5882.000119959213;4421.557844215577;4424.269995450747;4429.269170586849;4432.667549933752;4444.355568442574;4270.444842170514;4361.302191649337;4406.140802543506;4412.536683648219;4424.535423780505;4368.781560921957;4372.759498227596;4375.8249670013165;4379.2117418864755;4380.97809510952;4377.824887004516;4381.014271788854;4413.271810151321;4415.602595766396;4429;3708.740388172829;3777.924441511182;3818.2554401891643;3823.7896915669626;3841.635044670752;5761.337446193657;5765.126333941485;5765.1928729977835;5775.104858746901;5804.738786754606;5152.124138896359;5154.329937108189;5155.536001759822;5156.9742151289;5161.303224064778;6178.41305076017;6189.288231853305;6224.657643829588;6262.808017193991;6272.843178920563;4277.700560960734;4292.80682369291;4293.2701440755145;4296.699231053827;4304.677149213821;6280.152179455807;6424.072778166578;6438.903416448757;6527.967360163217;6591.835204119888;4307.030918043478;4322.308430651081;4330.328799036154;4333.349997500337;4333.674974376934;4375.824967001285;4384.583464570861;4386.298192289282;4389.934150987738;4390.143921935256;5038.420581633086;5053.46938571452;5124.385073791169;5130.666506677054;5141.820036298712;6197.96901015501;6233.688315584202;6250.531210159256;6267.71795269214;6268.874622507525;1499.1904371639193;1505.9698806024037;1508.6077619818707;1515.6968606278788;1515.9469418570518;972.5526257921294;1000.7047920863363;1002.036009421542;1002.4636819301638;1005.2862467647906;6045.848853778691;6053.727582258809;6057.878842423127;6073.210482637317;6098.54260930432;6263.78076767311;6349.952257877399;6393.968030159819;6418.77534286307;6435.259945106279;6065.5450841187085;6072.39276072398;6094.481969032682;6123.38766123393;6136.9079463808075;3387.5765529308837;3406.4549672052353;3418.5043168740394;3419.8119103449053;3420.9486857697157;6641.701123449457;6679.666016699146;6823.283555226729;6823.488238382141;6826.078479405316;6597.406233439014;6602.372774586503;6642.435392991553;6666.699998499982;6667.566608170453;6646.501512386591;6731.225909020525;6792.694328755218;6820.283870193558;6844.384005439435;6466.385693359123;6490.935090649033;6503.414692677682;6506.974256970342;6537.313582073813;6271.466925311217;6294.276158241861;6400.807975760735;6417.358264173732;6464.159659244268;6686.966565167338;6745.25802161752;6757.121574195323;6762.256151823197;6774;4365.039691267916;4366.476022877275;4375.059362237134;4380.299152135643;4382.342648602735;6399.840003999937;6470.952656927604;6522.543421960418;6524.967375163284;6530.771423000172;6261.279952805486;6284.025975973731;6298.968505157445;6311.887371229319;6313.90529142054;6177.4749146323065;6256.249250090018;6289.308176100717;6292.968535157295;6312.3056463788025;6198.473129784019;6223.782167624111;6305.5901366411035;6312.779052733133;6332.461740752087;6215.96892015537;6229.563930525001;6270.404311590391;6272.655003974825;6289.182406287337;6085.817425477243;6110.78612248587;6129.4483496483745;6146.78486252979;6150.876982460415 05:12:35 INFO - PID 7116 | |5;yui.html;864.2696921101671;887.2148148888232;893.3567831161562;894.579547612622;912.4798864647149;13326.999999999976;13982.720345593081;15172.848271517281;15803.288852001659;15927.20363981802;15407.306671199794;15530.45643402481;15936.920315398436;16037.518874433787;16488.505344839643;1005.5877090392959;1021.7292417509366;1023.3450591621369;1023.5087158164085;1026.0765311219886;1013.4932533733133;1020.0309705779503;1020.9081182693556;1021.5760459409373;1021.9744506387325;1066.802641511319;1071.8928107189258;1072.8712554493472;1074.1084899533407;1081.2701426537096;1070.0797314309686;1072.399456304472;1073.0396295315688;1073.5759375046853;1076.1122074288744;778.1401551285804;780.2158830375437;781.5193655901636;784.7881072110555;789;15660.216989150496;15768.448104316294;15929.681406371808;15966.521004369888;15980.920095399564;17948.461546153638;18051.729224061648;18142.09289535518;18351.35770248035;18440.90779546094;14787.40850365984;15016.399344026226;15018.774718379123;15112.773308400383;15217.086974781549;3230.7415406767404;3236.8867089651985;3249.658785827478;3277.737780977516;3288.8520016599073;90427;91529;91940;92222.99999999933;92437;12939.094263401472;13038.869611303955;13196.670083247996;13231.603051908458;13233.478150012872;22093.889530552246;22147.446313842283;22246.77753222447;25845.353866153495;26474.735252647613;8210.589470526449;8468.534230617375;8485.490870547786;8507.872381914276;8540.829183416421;3855.267499175148;3926.1951299983434;3927.7643341399607;3937.42907278443;3955.0903292242947;4282.935755963663;4348.760818155032;4385.6710746694125;4397.890052748707;4432.578905004019;900.3517467423445;923.1460898668705;929.2890938432105;933.118203297877;938.7230766923774;711.5161690050816;720.5532569806753;725.0719079578148;726.7529040126383;749.9775006749807;11770.705732356759;12965.481380744854;13349.46602135923;13615.387307571184;13717.725645487035;734.584959497882;736.4697417859132;746.3469464218808;748.831512909591;755.3617193471508;5332.413434522199;5433.864153396196;5545.500904918576;5583.3858275589655;5617.859553511195;86042.13957860466;88178;88811;89561.55219223992;91597.08402915885;73976;74499.62750186214;75695.24304756992;76017.23982760102;78674.60662696764;62388.37611623826;68916.6554167226;69073.65463172652;69118.30881691219;70698;12616.49534018629;13778.65553361134;13998.090124141898;14043;14056.929715351358;33922.66077339195;34103.82948085244;35191.824040879634;35469.82265088658;35685;53018.46981530135;55975;56558.43441565532;56718;58674.4132558686;15078;15691.686166276839;15879.12664803447;17422.564435889206;17637.294508220042;19068.427947161606;19090.618187635893;19194.232230710615;19300.517487062934;19613;18078.186481608096;18826.152823122717;18835.24659013624;18934.905325473286;19408.4177474676;18107.004114773816;18207.635847282716;18405.263789448807;18522.444326670222;18901.243950241835;16004.359825606845;16052.919735401249;16074.43739469113;16540.172991350624;16622.3351065956;11791.233569818278;11831.645050648494;12167.634970950885;12229.205101668364;12318.692032699255;13449.058565900294;13490.730185396433;13636.590902272948;13644.181349119084;14363.856361436252 05:12:35 INFO - PID 7116 | __end_tp_report 05:12:35 INFO - PID 7116 | __start_cc_report 05:12:35 INFO - PID 7116 | _x_x_mozilla_cycle_collect,327 05:12:35 INFO - PID 7116 | __end_cc_report 05:12:35 INFO - PID 7116 | __startTimestamp1494245555588__endTimestamp 05:12:35 INFO - PID 7116 | 05:12:35 INFO - PID 7116 | ------- Summary: start ------- 05:12:35 INFO - PID 7116 | Number of tests: 6 05:12:35 INFO - PID 7116 | 05:12:35 INFO - PID 7116 | [#0] dojo.html Cycles:165 Average:5782.64 Median:6039.91 stddev:691.93 (11.5%) stddev-sans-first:667.86 05:12:35 INFO - PID 7116 | Values: 3378.7 3390.3 3411.2 3412.5 3417.1 5706.9 5723.5 5733.7 5753.3 5791.6 5716.8 5752.9 5756.7 5789.5 5807.9 5100.2 5128.1 5131.4 5135.9 5218.4 5165.1 5181.8 5226.0 5226.1 5229.6 5022.3 5049.7 5086.8 5111.0 5162.7 5144.8 5147.6 5148.2 5157.5 5165.6 5094.9 5129.5 5134.8 5149.0 5168.9 5703.6 5718.5 5755.2 5765.1 5817.3 6254.9 6280.5 6285.7 6300.2 6311.9 6293.2 6309.5 6337.4 6350.7 6355.0 5821.4 5830.1 5870.2 5870.5 5931.6 6326.2 6373.6 6379.3 6380.0 6386.2 6033.7 6056.6 6081.1 6117.2 6162.9 6196.3 6206.1 6206.2 6207.0 6209.8 6122.8 6179.5 6191.3 6192.3 6259.7 6207.9 6247.7 6277.7 6282.9 6296.7 4731.4 4739.9 4751.2 4767.9 4789.8 4134.3 4187.5 4212.6 4217.6 4239.8 5928.5 5970.1 5988.6 5995.4 6037.6 6191.4 6255.4 6278.5 6281.6 6287.8 5899.6 5904.6 5975.9 5982.4 6019.9 5319.9 5338.8 5391.6 5392.6 5407.5 6381.1 6500.6 6507.5 6521.0 6527.1 6284.4 6287.4 6290.6 6298.1 6315.7 6488.2 6608.3 6627.6 6630.4 6643.8 6096.5 6122.7 6122.8 6133.3 6184.4 6228.3 6321.4 6330.9 6341.4 6347.7 5961.8 6039.9 6053.6 6066.3 6119.8 6145.2 6148.5 6158.4 6163.4 6171.8 6012.5 6102.4 6113.3 6121.8 6149.7 6141.5 6146.5 6152.7 6184.1 6195.6 5975.2 6027.9 6029.4 6034.6 6056.0 05:12:35 INFO - PID 7116 | 05:12:35 INFO - PID 7116 | [#1] ext.html Cycles:180 Average:38634.53 Median:34696.48 stddev:58555.13 (168.8%) stddev-sans-first:58650.19 05:12:35 INFO - PID 7116 | Values: 720.5 730.6 1126.6 1132.9 1196.5 35693.3 36683.3 36785.6 36822.6 36831.3 34266.7 34482.8 34552.3 34786.1 34792.5 6664.1 6791.3 7155.4 7341.2 7348.3 7212.1 7219.5 7257.4 7281.6 7295.9 7271.1 7279.2 7298.9 7302.7 7328.6 7231.0 7279.0 7288.3 7289.0 7301.6 7197.5 7249.3 7257.2 7260.3 7283.0 35825.5 35991.5 36128.3 36198.8 36281.5 3574.4 3577.2 3582.9 3586.1 3613.2 28404.6 28573.4 28667.1 28764.0 28852.7 3738.4 3745.5 3755.2 3766.9 3777.8 196159.0 197189.0 197966.0 200120.0 200423.0 44196.6 46475.8 46550.3 46723.0 46766.3 48219.8 48297.5 48478.5 48478.8 48614.0 14636.9 14665.1 14685.0 14711.1 14722.4 11629.9 11680.4 11731.1 11750.4 11756.2 13814.6 13890.9 13894.2 14077.4 14095.2 5553.9 5685.5 5718.5 5727.2 5745.1 1061.5 1088.7 1089.7 1096.5 1108.4 25422.9 25865.4 25874.6 25912.0 26017.2 1171.1 1178.6 1185.3 1193.4 1210.0 13315.1 13560.4 13598.7 13753.9 13769.5 262144.0 263221.0 263385.0 263474.0 263673.0 49803.5 49990.3 50436.5 50543.0 50700.0 1470.5 1490.4 1513.1 1514.4 1514.7 23387.0 23740.0 23878.6 24455.8 24480.6 36688.4 36932.6 36951.4 37041.0 37048.0 207442.0 208518.0 209841.0 209966.0 210743.0 33944.3 35402.6 35941.1 36007.9 36142.5 42733.4 44402.3 44775.6 44856.0 45428.5 32795.0 32842.3 32867.7 33967.5 34034.3 32932.8 33063.7 33612.5 34688.1 34704.8 38385.8 38394.0 38423.0 38576.2 38598.0 31435.1 31785.5 31813.2 32407.7 33147.5 26459.0 26949.6 27000.6 27196.6 27519.4 05:12:35 INFO - PID 7116 | 05:12:35 INFO - PID 7116 | [#2] jquery.html Cycles:180 Average:34022.50 Median:2201.85 stddev:95695.17 (4346.1%) stddev-sans-first:95930.37 05:12:35 INFO - PID 7116 | Values: 424.7 441.1 443.3 452.9 454.2 19062.6 19687.3 20466.0 20566.4 20658.7 21662.8 22138.4 22248.3 22331.4 22362.2 5391.5 5639.8 5659.9 5660.0 5687.6 5412.0 5490.9 5500.3 5503.8 5557.5 5506.1 5530.5 5542.7 5550.4 5563.0 5486.5 5533.1 5704.2 5743.9 5767.6 5180.1 5182.1 5188.6 5189.5 5192.6 25006.5 26070.5 26419.9 26433.0 26509.3 2153.9 2164.8 2179.1 2200.8 2202.9 16284.8 16544.2 16772.7 16901.3 17171.7 2146.3 2228.6 2239.6 2246.5 2246.7 105911.5 118354.0 121703.4 123473.4 125840.4 12070.3 12071.6 12596.4 12707.9 12733.4 17073.0 17129.1 17178.6 17244.6 17253.7 8808.7 8899.5 8953.9 9203.0 9301.3 8507.4 8522.5 8720.2 8814.3 8887.3 7760.2 7815.7 7889.8 7989.5 8069.8 2196.7 2217.5 2226.6 2226.7 2410.4 1050.2 1069.0 1074.7 1077.0 1087.2 20651.8 20683.5 20685.4 20927.3 21007.0 1100.4 1100.5 1102.9 1104.8 1105.0 11106.8 11480.4 12876.7 14128.9 14374.5 564901.0 565589.0 569090.0 588009.1 601082.0 99445.5 102267.5 103380.5 104322.0 105552.0 1290.0 1314.6 1354.9 1357.6 1358.4 20630.4 20997.8 21294.9 21468.0 21738.6 44872.6 44969.0 45593.8 45966.5 46883.3 60378.7 60899.0 62043.4 62528.4 63130.0 9275.1 9280.4 9324.3 9337.3 9530.3 14345.3 14642.6 14925.9 15019.8 15183.8 12709.7 12876.0 13007.8 13089.7 13382.8 11473.4 11543.5 11842.1 11998.2 12048.0 13166.1 13227.9 13256.7 13308.0 13598.8 9140.7 9143.5 9239.4 9375.2 9431.5 12392.3 12392.6 12951.3 13128.7 13309.2 05:12:35 INFO - PID 7116 | 05:12:35 INFO - PID 7116 | [#3] mootools.html Cycles:180 Average:7080.01 Median:3856.11 stddev:4630.28 (120.1%) stddev-sans-first:4623.40 05:12:35 INFO - PID 7116 | Values: 1370.9 1400.4 1401.6 1404.0 1405.0 10810.8 11245.1 11255.7 11426.1 11545.2 11390.1 11427.9 11556.4 11563.8 11642.4 2339.2 2371.7 2398.6 2405.9 2408.6 2281.5 2298.9 2312.1 2332.3 2338.4 2340.6 2344.9 2368.7 2387.7 2391.3 2206.3 2263.2 2310.6 2312.0 2313.6 2231.2 2262.2 2262.7 2309.5 2323.8 11371.1 11447.5 11467.4 11541.9 11549.7 6493.6 6675.0 6701.4 6706.1 6710.9 3930.4 4104.1 4161.1 4167.8 4230.2 1349.6 1380.3 1394.6 1400.1 1404.1 16773.2 16921.4 16969.2 17113.2 17117.2 5048.0 5147.5 5413.1 5418.9 5480.9 12529.4 12614.6 12627.6 12652.1 12677.9 6527.3 6528.9 6556.0 6559.8 6590.8 5993.2 6015.6 6139.9 6204.2 6243.0 4028.2 4126.1 4139.9 4156.8 4158.5 1250.3 1252.2 1258.6 1268.2 1285.8 825.3 829.3 845.0 852.3 865.4 5810.5 5933.1 5934.6 5962.2 6131.9 581.3 589.4 599.5 604.2 608.8 3781.8 4320.5 4386.8 4458.6 4517.9 14830.7 15171.6 15193.3 15280.2 15354.2 14597.9 15370.0 15458.5 15535.8 15582.4 9404.5 9445.1 9537.8 9622.7 9633.0 6517.4 6784.4 6786.9 6797.3 6819.3 13476.9 13524.7 13879.4 13894.2 13929.7 13781.8 13789.4 13904.1 14119.4 14130.1 9425.5 9663.2 9705.2 9728.5 9787.9 10474.7 10484.8 10513.0 10640.9 10646.5 8544.8 8558.7 8584.0 8592.2 8671.0 8183.7 8189.7 8259.8 8391.5 8500.1 7863.7 7943.2 8015.3 8029.6 8035.9 5357.8 5395.1 5411.1 5579.2 5656.7 5696.6 5756.8 5816.2 5831.8 5940.4 05:12:35 INFO - PID 7116 | 05:12:35 INFO - PID 7116 | [#4] prototype.html Cycles:180 Average:5217.39 Median:6055.80 stddev:1608.94 (26.6%) stddev-sans-first:1571.83 05:12:35 INFO - PID 7116 | Values: 372.8 387.7 391.9 391.9 395.7 5820.9 5948.6 5966.9 5988.4 6000.3 5781.5 5851.4 5869.8 5878.4 5882.0 4421.6 4424.3 4429.3 4432.7 4444.4 4270.4 4361.3 4406.1 4412.5 4424.5 4368.8 4372.8 4375.8 4379.2 4381.0 4377.8 4381.0 4413.3 4415.6 4429.0 3708.7 3777.9 3818.3 3823.8 3841.6 5761.3 5765.1 5765.2 5775.1 5804.7 5152.1 5154.3 5155.5 5157.0 5161.3 6178.4 6189.3 6224.7 6262.8 6272.8 4277.7 4292.8 4293.3 4296.7 4304.7 6280.2 6424.1 6438.9 6528.0 6591.8 4307.0 4322.3 4330.3 4333.3 4333.7 4375.8 4384.6 4386.3 4389.9 4390.1 5038.4 5053.5 5124.4 5130.7 5141.8 6198.0 6233.7 6250.5 6267.7 6268.9 1499.2 1506.0 1508.6 1515.7 1515.9 972.6 1000.7 1002.0 1002.5 1005.3 6045.8 6053.7 6057.9 6073.2 6098.5 6263.8 6350.0 6394.0 6418.8 6435.3 6065.5 6072.4 6094.5 6123.4 6136.9 3387.6 3406.5 3418.5 3419.8 3420.9 6641.7 6679.7 6823.3 6823.5 6826.1 6597.4 6602.4 6642.4 6666.7 6667.6 6646.5 6731.2 6792.7 6820.3 6844.4 6466.4 6490.9 6503.4 6507.0 6537.3 6271.5 6294.3 6400.8 6417.4 6464.2 6687.0 6745.3 6757.1 6762.3 6774.0 4365.0 4366.5 4375.1 4380.3 4382.3 6399.8 6471.0 6522.5 6525.0 6530.8 6261.3 6284.0 6299.0 6311.9 6313.9 6177.5 6256.2 6289.3 6293.0 6312.3 6198.5 6223.8 6305.6 6312.8 6332.5 6216.0 6229.6 6270.4 6272.7 6289.2 6085.8 6110.8 6129.4 6146.8 6150.9 05:12:35 INFO - PID 7116 | 05:12:35 INFO - PID 7116 | [#5] yui.html Cycles:180 Average:19653.57 Median:19142.43 stddev:24579.46 (128.4%) stddev-sans-first:24607.92 05:12:35 INFO - PID 7116 | Values: 864.3 887.2 893.4 894.6 912.5 13327.0 13982.7 15172.8 15803.3 15927.2 15407.3 15530.5 15936.9 16037.5 16488.5 1005.6 1021.7 1023.3 1023.5 1026.1 1013.5 1020.0 1020.9 1021.6 1022.0 1066.8 1071.9 1072.9 1074.1 1081.3 1070.1 1072.4 1073.0 1073.6 1076.1 778.1 780.2 781.5 784.8 789.0 15660.2 15768.4 15929.7 15966.5 15980.9 17948.5 18051.7 18142.1 18351.4 18440.9 14787.4 15016.4 15018.8 15112.8 15217.1 3230.7 3236.9 3249.7 3277.7 3288.9 90427.0 91529.0 91940.0 92223.0 92437.0 12939.1 13038.9 13196.7 13231.6 13233.5 22093.9 22147.4 22246.8 25845.4 26474.7 8210.6 8468.5 8485.5 8507.9 8540.8 3855.3 3926.2 3927.8 3937.4 3955.1 4282.9 4348.8 4385.7 4397.9 4432.6 900.4 923.1 929.3 933.1 938.7 711.5 720.6 725.1 726.8 750.0 11770.7 12965.5 13349.5 13615.4 13717.7 734.6 736.5 746.3 748.8 755.4 5332.4 5433.9 5545.5 5583.4 5617.9 86042.1 88178.0 88811.0 89561.6 91597.1 73976.0 74499.6 75695.2 76017.2 78674.6 62388.4 68916.7 69073.7 69118.3 70698.0 12616.5 13778.7 13998.1 14043.0 14056.9 33922.7 34103.8 35191.8 35469.8 35685.0 53018.5 55975.0 56558.4 56718.0 58674.4 15078.0 15691.7 15879.1 17422.6 17637.3 19068.4 19090.6 19194.2 19300.5 19613.0 18078.2 18826.2 18835.2 18934.9 19408.4 18107.0 18207.6 18405.3 18522.4 18901.2 16004.4 16052.9 16074.4 16540.2 16622.3 11791.2 11831.6 12167.6 12229.2 12318.7 13449.1 13490.7 13636.6 13644.2 14363.9 05:12:35 INFO - PID 7116 | -------- Summary: end -------- 05:12:35 INFO - PID 7116 | 05:12:36 INFO - TEST-INFO | 7116: exit 0 05:12:36 INFO - TEST-OK | dromaeo_css | took 1113254ms 05:12:36 INFO - TEST-START | kraken 05:12:36 INFO - operating with platform_type : linux_ 05:12:36 INFO - Initialising browser for kraken test... 05:12:36 INFO - TEST-INFO | started process 7538 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpKHrB46/profile http://localhost:44776/getInfo.html) 05:12:39 INFO - PID 7538 | __metrics Screen width/height:1600/1200 05:12:39 INFO - PID 7538 | colorDepth:24 05:12:39 INFO - PID 7538 | Browser inner width/height: 1024/695 05:12:39 INFO - PID 7538 | __metrics 05:12:41 INFO - TEST-INFO | 7538: exit 0 05:12:41 INFO - Browser initialized. 05:12:41 INFO - Running cycle 1/1 for kraken test... 05:12:41 INFO - TEST-INFO | started process 7712 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpKHrB46/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:12:53 INFO - PID 7712 | RSS: Main: 156200960 05:12:53 INFO - PID 7712 | 05:12:56 INFO - PID 7712 | Cycle 1(1): loaded http://localhost:44776/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:44776/tests/kraken/driver.html?testName=audio-beat-detection) 05:12:57 INFO - PID 7712 | RSS: Main: 162508800 05:12:57 INFO - PID 7712 | 05:12:59 INFO - PID 7712 | Cycle 1(1): loaded http://localhost:44776/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:44776/tests/kraken/driver.html?testName=audio-dft) 05:13:00 INFO - PID 7712 | RSS: Main: 160948224 05:13:00 INFO - PID 7712 | 05:13:03 INFO - PID 7712 | Cycle 1(1): loaded http://localhost:44776/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:44776/tests/kraken/driver.html?testName=audio-fft) 05:13:03 INFO - PID 7712 | RSS: Main: 156983296 05:13:03 INFO - PID 7712 | 05:13:05 INFO - PID 7712 | Cycle 1(1): loaded http://localhost:44776/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:44776/tests/kraken/driver.html?testName=audio-oscillator) 05:13:06 INFO - PID 7712 | RSS: Main: 158490624 05:13:06 INFO - PID 7712 | 05:13:08 INFO - PID 7712 | Cycle 1(1): loaded http://localhost:44776/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:44776/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:13:08 INFO - PID 7712 | RSS: Main: 158289920 05:13:08 INFO - PID 7712 | 05:13:12 INFO - PID 7712 | Cycle 1(1): loaded http://localhost:44776/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:44776/tests/kraken/driver.html?testName=imaging-darkroom) 05:13:12 INFO - PID 7712 | RSS: Main: 164167680 05:13:12 INFO - PID 7712 | 05:13:16 INFO - PID 7712 | Cycle 1(1): loaded http://localhost:44776/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:44776/tests/kraken/driver.html?testName=imaging-desaturate) 05:13:16 INFO - PID 7712 | RSS: Main: 163188736 05:13:16 INFO - PID 7712 | 05:13:19 INFO - PID 7712 | Cycle 1(1): loaded http://localhost:44776/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:44776/tests/kraken/driver.html?testName=json-parse-financial) 05:13:20 INFO - PID 7712 | RSS: Main: 164192256 05:13:20 INFO - PID 7712 | 05:13:21 INFO - PID 7712 | Cycle 1(1): loaded http://localhost:44776/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:44776/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:13:22 INFO - PID 7712 | RSS: Main: 164302848 05:13:22 INFO - PID 7712 | 05:13:23 INFO - PID 7712 | Cycle 1(1): loaded http://localhost:44776/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:44776/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:13:24 INFO - PID 7712 | RSS: Main: 163848192 05:13:24 INFO - PID 7712 | 05:13:26 INFO - PID 7712 | Cycle 1(1): loaded http://localhost:44776/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:44776/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:13:27 INFO - PID 7712 | RSS: Main: 164007936 05:13:27 INFO - PID 7712 | 05:13:29 INFO - PID 7712 | Cycle 1(1): loaded http://localhost:44776/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:44776/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:13:30 INFO - PID 7712 | RSS: Main: 164270080 05:13:30 INFO - PID 7712 | 05:13:33 INFO - PID 7712 | Cycle 1(1): loaded http://localhost:44776/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:44776/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:13:34 INFO - PID 7712 | RSS: Main: 164552704 05:13:34 INFO - PID 7712 | 05:13:35 INFO - PID 7712 | Cycle 1(1): loaded http://localhost:44776/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:44776/tests/kraken/driver.html?testName=ai-astar) 05:13:36 INFO - PID 7712 | RSS: Main: 166354944 05:13:36 INFO - PID 7712 | 05:13:36 INFO - PID 7712 | __start_tp_report 05:13:36 INFO - PID 7712 | _x_x_mozilla_page_load 05:13:36 INFO - PID 7712 | _x_x_mozilla_page_load_details 05:13:36 INFO - PID 7712 | |i|pagename|runs| 05:13:36 INFO - PID 7712 | |0;ai-astar;101;112;112;110;111;111;111;113;112;111 05:13:36 INFO - PID 7712 | |1;audio-beat-detection;147;120;120;171;124;121;117;123;147;120 05:13:36 INFO - PID 7712 | |2;audio-dft;163;164;165;165;163;164;165;170;169;163 05:13:36 INFO - PID 7712 | |3;audio-fft;74;79;79;96;75;74;75;74;99;75 05:13:36 INFO - PID 7712 | |4;audio-oscillator;84;82;107;83;82;81;94;91;82;110 05:13:36 INFO - PID 7712 | |5;imaging-gaussian-blur;113;114;114;113;114;114;114;114;117;114 05:13:36 INFO - PID 7712 | |6;imaging-darkroom;150;148;149;149;152;148;150;149;150;148 05:13:36 INFO - PID 7712 | |7;imaging-desaturate;94;95;95;96;95;99;94;94;95;95 05:13:36 INFO - PID 7712 | |8;json-parse-financial;46;46;51;45;46;47;47;52;49;46 05:13:36 INFO - PID 7712 | |9;json-stringify-tinderbox;56;55;56;55;55;55;55;55;56;56 05:13:36 INFO - PID 7712 | |10;stanford-crypto-aes;84;82;89;91;82;82;82;82;83;82 05:13:36 INFO - PID 7712 | |11;stanford-crypto-ccm;140;127;127;125;125;133;125;125;219;125 05:13:36 INFO - PID 7712 | |12;stanford-crypto-pbkdf2;183;177;181;187;182;181;177;189;185;193 05:13:36 INFO - PID 7712 | |13;stanford-crypto-sha256-iterative;70;67;68;65;68;67;66;67;64;65 05:13:36 INFO - PID 7712 | __end_tp_report 05:13:36 INFO - PID 7712 | __start_cc_report 05:13:36 INFO - PID 7712 | _x_x_mozilla_cycle_collect,743 05:13:36 INFO - PID 7712 | __end_cc_report 05:13:36 INFO - PID 7712 | __startTimestamp1494245616042__endTimestamp 05:13:36 INFO - PID 7712 | 05:13:36 INFO - PID 7712 | ------- Summary: start ------- 05:13:36 INFO - PID 7712 | Number of tests: 14 05:13:36 INFO - PID 7712 | 05:13:36 INFO - PID 7712 | [#0] ai-astar Cycles:10 Average:110.40 Median:111.50 stddev:3.41 (3.1%) stddev-sans-first:0.88 05:13:36 INFO - PID 7712 | Values: 101.0 112.0 112.0 110.0 111.0 111.0 111.0 113.0 112.0 111.0 05:13:36 INFO - PID 7712 | 05:13:36 INFO - PID 7712 | [#1] audio-beat-detection Cycles:10 Average:131.00 Median:123.50 stddev:17.90 (14.5%) stddev-sans-first:18.03 05:13:36 INFO - PID 7712 | Values: 147.0 120.0 120.0 171.0 124.0 121.0 117.0 123.0 147.0 120.0 05:13:36 INFO - PID 7712 | 05:13:36 INFO - PID 7712 | [#2] audio-dft Cycles:10 Average:165.10 Median:165.00 stddev:2.47 (1.5%) stddev-sans-first:2.50 05:13:36 INFO - PID 7712 | Values: 163.0 164.0 165.0 165.0 163.0 164.0 165.0 170.0 169.0 163.0 05:13:36 INFO - PID 7712 | 05:13:36 INFO - PID 7712 | [#3] audio-fft Cycles:10 Average:80.00 Median:77.00 stddev:9.44 (12.3%) stddev-sans-first:9.76 05:13:36 INFO - PID 7712 | Values: 74.0 79.0 79.0 96.0 75.0 74.0 75.0 74.0 99.0 75.0 05:13:36 INFO - PID 7712 | 05:13:36 INFO - PID 7712 | [#4] audio-oscillator Cycles:10 Average:89.60 Median:82.50 stddev:10.86 (13.2%) stddev-sans-first:11.33 05:13:36 INFO - PID 7712 | Values: 84.0 82.0 107.0 83.0 82.0 81.0 94.0 91.0 82.0 110.0 05:13:36 INFO - PID 7712 | 05:13:36 INFO - PID 7712 | [#5] imaging-gaussian-blur Cycles:10 Average:114.10 Median:114.00 stddev:1.10 (1.0%) stddev-sans-first:1.09 05:13:36 INFO - PID 7712 | Values: 113.0 114.0 114.0 113.0 114.0 114.0 114.0 114.0 117.0 114.0 05:13:36 INFO - PID 7712 | 05:13:36 INFO - PID 7712 | [#6] imaging-darkroom Cycles:10 Average:149.30 Median:149.50 stddev:1.25 (0.8%) stddev-sans-first:1.30 05:13:36 INFO - PID 7712 | Values: 150.0 148.0 149.0 149.0 152.0 148.0 150.0 149.0 150.0 148.0 05:13:36 INFO - PID 7712 | 05:13:36 INFO - PID 7712 | [#7] imaging-desaturate Cycles:10 Average:95.20 Median:95.00 stddev:1.48 (1.6%) stddev-sans-first:1.50 05:13:36 INFO - PID 7712 | Values: 94.0 95.0 95.0 96.0 95.0 99.0 94.0 94.0 95.0 95.0 05:13:36 INFO - PID 7712 | 05:13:36 INFO - PID 7712 | [#8] json-parse-financial Cycles:10 Average:47.50 Median:47.00 stddev:2.37 (5.0%) stddev-sans-first:2.45 05:13:36 INFO - PID 7712 | Values: 46.0 46.0 51.0 45.0 46.0 47.0 47.0 52.0 49.0 46.0 05:13:36 INFO - PID 7712 | 05:13:36 INFO - PID 7712 | [#9] json-stringify-tinderbox Cycles:10 Average:55.40 Median:55.50 stddev:0.52 (0.9%) stddev-sans-first:0.50 05:13:36 INFO - PID 7712 | Values: 56.0 55.0 56.0 55.0 55.0 55.0 55.0 55.0 56.0 56.0 05:13:36 INFO - PID 7712 | 05:13:36 INFO - PID 7712 | [#10] stanford-crypto-aes Cycles:10 Average:83.90 Median:82.50 stddev:3.31 (4.0%) stddev-sans-first:3.52 05:13:36 INFO - PID 7712 | Values: 84.0 82.0 89.0 91.0 82.0 82.0 82.0 82.0 83.0 82.0 05:13:36 INFO - PID 7712 | 05:13:36 INFO - PID 7712 | [#11] stanford-crypto-ccm Cycles:10 Average:137.10 Median:127.00 stddev:29.19 (23.0%) stddev-sans-first:30.94 05:13:36 INFO - PID 7712 | Values: 140.0 127.0 127.0 125.0 125.0 133.0 125.0 125.0 219.0 125.0 05:13:36 INFO - PID 7712 | 05:13:36 INFO - PID 7712 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:183.50 Median:184.00 stddev:5.10 (2.8%) stddev-sans-first:5.41 05:13:36 INFO - PID 7712 | Values: 183.0 177.0 181.0 187.0 182.0 181.0 177.0 189.0 185.0 193.0 05:13:36 INFO - PID 7712 | 05:13:36 INFO - PID 7712 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:66.70 Median:67.00 stddev:1.77 (2.6%) stddev-sans-first:1.41 05:13:36 INFO - PID 7712 | Values: 70.0 67.0 68.0 65.0 68.0 67.0 66.0 67.0 64.0 65.0 05:13:36 INFO - PID 7712 | -------- Summary: end -------- 05:13:36 INFO - PID 7712 | 05:13:37 INFO - TEST-INFO | 7712: exit 0 05:13:37 INFO - TEST-OK | kraken | took 60919ms 05:13:37 INFO - SUITE-END | took 1174s 05:13:37 INFO - Completed test suite (00:19:34) 05:13:37 INFO - javascript benchmark 05:13:37 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7703.270422983391, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3378.695917367438, 3390.2541440883006, 3411.215420453296, 3412.539307193528, 3417.1457135716073, 5706.942930570693, 5723.4848863602265, 5733.655980641164, 5753.309602847659, 5791.565632577553, 5716.8284951451415, 5752.856178595537, 5756.712164391774, 5789.536837053026, 5807.941920580793, 5100.1584738518195, 5128.076946149691, 5131.435542090367, 5135.922961155586, 5218.373795144588, 5165.070287348276, 5181.766820493068, 5225.980933717927, 5226.137687281594, 5229.581633469314, 5022.296878437021, 5049.671771334888, 5086.821961231376, 5110.952254787797, 5162.6902385856965, 5144.819931302386, 5147.562457191143, 5148.150555158394, 5157.4584668610005, 5165.63840531163, 5094.923576146361, 5129.5383415492415, 5134.794608215667, 5148.9742551287, 5168.948310516922, 5703.62926409782, 5718.485336319751, 5755.165501002373, 5765.1352297155345, 5817.272840894888, 6254.906176407358, 6280.528960327993, 6285.717142728542, 6300.243970723497, 6311.936880631227, 6293.244810622708, 6309.526785491106, 6337.397947195009, 6350.682465876687, 6355.046742988588, 5821.359650438449, 5830.067189249699, 5870.236869207019, 5870.4716575507555, 5931.614445061057, 6326.240851097898, 6373.553851230462, 6379.298277189506, 6380.042993551005, 6386.16979792624, 6033.668148251801, 6056.636601803906, 6081.057436097412, 6117.174181485531, 6162.938370616326, 6196.318404975449, 6206.100115483229, 6206.224221972254, 6207.0, 6209.813705588839, 6122.816315510542, 6179.5056395488255, 6191.25704915404, 6192.287886892975, 6259.6870156492905, 6207.906881396782, 6247.687615619201, 6277.686115694197, 6282.874342513124, 6296.685165741695, 4731.432228132646, 4739.857804265808, 4751.168545504592, 4767.856964291077, 4789.784459699322, 4134.297169481196, 4187.5184353799705, 4212.615025919575, 4217.641500472433, 4239.766812825263, 5928.496077833346, 5970.13433052205, 5988.640681559121, 5995.430434108753, 6037.607555508878, 6191.4118158774845, 6255.40573645503, 6278.466330361879, 6281.591696539802, 6287.779927702509, 5899.616524925866, 5904.586678932519, 5975.940240597625, 5982.40175982407, 6019.939800602026, 5319.946800532022, 5338.786448542092, 5391.56867450603, 5392.622516423813, 5407.486288802557, 6381.1066450696935, 6500.642464664489, 6507.544471887017, 6521.0, 6527.086207930798, 6284.402981716729, 6287.371262873676, 6290.622562646256, 6298.149749783904, 6315.684215789101, 6488.188976377953, 6608.273089960197, 6627.602343859384, 6630.436412904957, 6643.833904152435, 6096.526685943624, 6122.733612273432, 6122.785702500391, 6133.304060594526, 6184.350643182401, 6228.346023667631, 6321.399467050623, 6330.936690633219, 6341.365863413806, 6347.650879201688, 5961.791337303173, 6039.909401359071, 6053.606515576474, 6066.332703402534, 6119.8470038247615, 6145.201123853871, 6148.538859585638, 6158.414950579688, 6163.3836616338, 6171.783987560414, 6012.458878700938, 6102.359252278625, 6113.32428171423, 6121.816345509642, 6149.72326245329, 6141.4553230608135, 6146.508279337731, 6152.723127459186, 6184.134221208944, 6195.628262304276, 5975.223220981245, 6027.879442411039, 6029.397060293935, 6034.63792172471, 6056.0], "value": 5734.131237197547, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [720.4884531982292, 730.64563686612, 1126.6000569797723, 1132.8810474900135, 1196.521391443423, 35693.28613427733, 36683.26633467329, 36785.632143678624, 36822.63177368225, 36831.26337473249, 34266.65733342666, 34482.82758586203, 34552.30895382091, 34786.130346741345, 34792.47811282826, 6664.067030615705, 6791.3208679132185, 7155.356017958383, 7341.155767086773, 7348.301911318416, 7212.134543854745, 7219.530730502527, 7257.419406447471, 7281.635918204095, 7295.927040729604, 7271.091113610799, 7279.235680253577, 7298.890516642228, 7302.744403945863, 7328.596927169004, 7231.0, 7279.0, 7288.344049035586, 7289.0159828423275, 7301.634918254119, 7197.4601904857345, 7249.347558719741, 7257.201707812136, 7260.34656880878, 7282.963585182093, 35825.46261806075, 35991.4601280981, 36128.277434451426, 36198.8190059048, 36281.45577816309, 3574.392353299945, 3577.2487777566744, 3582.8925132246072, 3586.1393265616325, 3613.1509095362567, 28404.573931391045, 28573.42853142946, 28667.13998580046, 28764.0, 28852.711472885214, 3738.3831667775057, 3745.4569087482164, 3755.1926335837925, 3766.9058273543105, 3777.8111094445167, 196159.0, 197189.0, 197966.0, 200119.99999999854, 200423.0, 44196.55803441989, 46475.76762116168, 46550.301745473844, 46723.0, 46766.29850552244, 48219.75890120597, 48297.517024830006, 48478.5152148474, 48478.75760621245, 48614.0, 14636.926815366069, 14665.120092794466, 14685.0, 14711.117332959842, 14722.411103555738, 11629.88370116305, 11680.415979201007, 11731.120165987584, 11750.412479375997, 11756.177067605186, 13814.585562433143, 13890.930545347208, 13894.235817029958, 14077.436902523988, 14095.180963807075, 5553.944460555424, 5685.469965865151, 5718.485336319751, 5727.226824378656, 5745.109508026179, 1061.490484567412, 1088.6951653537021, 1089.7221208591916, 1096.4627332607124, 1108.3959242213014, 25422.872885635825, 25865.353366165997, 25874.6118808218, 25912.0, 26017.219483415527, 1171.1450641031925, 1178.5580407347245, 1185.2576712233003, 1193.3675152169365, 1209.9576514821938, 13315.134516256607, 13560.389782459813, 13598.728025439634, 13753.931230343784, 13769.518066867611, 262144.0, 263221.0, 263385.0, 263474.0, 263673.0, 49803.501964979885, 49990.25014624783, 50436.49563504318, 50543.0, 50700.0, 1470.4779803169934, 1490.4485340424112, 1513.122389014369, 1514.3866733972538, 1514.681916797485, 23387.0, 23740.0, 23878.641820372362, 24455.75544244535, 24480.632790508513, 36688.44967325439, 36932.63067369292, 36951.44572831463, 37041.0, 37048.0, 207442.0, 208518.0, 209841.0, 209966.0, 210743.0, 33944.32111357809, 35402.64597353993, 35941.1014724634, 36007.87866062828, 36142.457863131545, 42733.35899961441, 44402.333964991194, 44775.552244478444, 44856.0, 45428.54571454243, 32795.0, 32842.343153136324, 32867.671323286464, 33967.4904876432, 34034.31931361408, 32932.83533582317, 33063.669363307024, 33612.495812562345, 34688.132796680286, 34704.82647586847, 38385.808070959465, 38394.0, 38423.0, 38576.22847542977, 38598.0, 31435.05694829159, 31785.523217151298, 31813.20466988344, 32407.675923241408, 33147.50278745869, 26459.0, 26949.595756064067, 27000.594991074755, 27196.592051118852, 27519.44961100807], "value": 17016.974607825472, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [424.71968500789484, 441.1353746656553, 443.31507820417454, 452.8664044106986, 454.2346146742738, 19062.618747625056, 19687.31094411694, 20466.0, 20566.38300850975, 20658.69011964818, 21662.783372166272, 22138.44653883654, 22248.332550023486, 22331.44171395712, 22362.21732239372, 5391.487808658171, 5639.774409023655, 5659.8585035374235, 5660.0, 5687.601867869251, 5412.0, 5490.890182196354, 5500.28496295481, 5503.752331145088, 5557.499825015748, 5506.146547285177, 5530.451473587402, 5542.695151766651, 5550.389457159709, 5563.0, 5486.451354864522, 5533.114701647737, 5704.201411802351, 5743.942560574404, 5767.567432442584, 5180.093483640348, 5182.144946083891, 5188.6367954243215, 5189.481051894818, 5192.6105542084115, 25006.49987000268, 26070.478590428276, 26419.867900660374, 26433.0, 26509.3372665683, 2153.935381938544, 2164.7726988666277, 2179.106566307822, 2200.7689192634703, 2202.9228976985887, 16284.83715162845, 16544.200288724238, 16772.664546709, 16901.323947042103, 17171.656566868718, 2146.270268108835, 2228.5542891421783, 2239.563285159378, 2246.472079061419, 2246.7079279693535, 105911.47044264806, 118353.99999999914, 121703.3914830429, 123473.38263308626, 125840.37079814542, 12070.27578345302, 12071.637850864488, 12596.370181490889, 12707.85629293368, 12733.36333183337, 17073.0, 17129.14354282281, 17178.570535736708, 17244.568885777957, 17253.74119388185, 8808.735737927873, 8899.466032037968, 8953.865692014626, 9203.0, 9301.302402319852, 8507.404481686222, 8522.531260780717, 8720.171583699539, 8814.294856411472, 8887.333449991276, 7760.185180556074, 7815.687372505036, 7889.763307100796, 7989.520628762293, 8069.838603227902, 2196.670499425099, 2217.4899773051966, 2226.5769503794227, 2226.6660000999977, 2410.3853517352964, 1050.2333296693457, 1069.0485467933545, 1074.7098283463422, 1076.9730756730987, 1087.2280680716622, 20651.793482064986, 20683.482912926997, 20685.379438616867, 20927.26754563583, 21007.0, 1100.4442756408123, 1100.5432745410565, 1102.873169585492, 1104.7900898829196, 1105.0441368216595, 11106.833397499044, 11480.368579728196, 12876.678083047811, 14128.929355353157, 14374.496892608708, 564901.0, 565589.0, 569090.0, 588009.119908804, 601082.0, 99445.50277248568, 102267.4886625562, 103380.48309758553, 104322.0, 105552.0, 1289.9551363395492, 1314.6319030671427, 1354.9390277437342, 1357.5927221833608, 1358.3819362190377, 20630.381088567367, 20997.790022100195, 21294.893525532894, 21468.0, 21738.565228695654, 44872.55127448684, 44968.95402798263, 45593.77203113963, 45966.540334596226, 46883.29675054945, 60378.69810650919, 60899.0, 62043.37956620376, 62528.374716252256, 63130.0, 9275.118863707938, 9280.443173409618, 9324.300677449082, 9337.346385752931, 9530.285228607743, 14345.282735863373, 14642.633934151732, 14925.92537037308, 15019.849801501845, 15183.772243416137, 12709.682257943625, 12876.0, 13007.804882926574, 13089.672758181121, 13382.799258011333, 11473.368964706688, 11543.480543375736, 11842.11184161174, 11998.160128790902, 12048.01207800703, 13166.144200626928, 13227.867721322664, 13256.734865302833, 13308.0, 13598.796018059935, 9140.725778226664, 9143.542822858697, 9239.445633262027, 9375.156235938799, 9431.500652327277, 12392.256464612152, 12392.56626018085, 12951.287679177736, 13128.671783205496, 13309.201447913156], "value": 10374.000115294722, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1370.93830777615, 1400.3838311143093, 1401.5795261421572, 1404.0382338098404, 1404.950826721065, 10810.837837432435, 11245.100391968643, 11255.662330130088, 11426.143039272067, 11545.249558778694, 11390.08879289657, 11427.942860285708, 11556.364399957998, 11563.768724625503, 11642.359670218135, 2339.2397470821966, 2371.6679664846847, 2398.568257713611, 2405.927822165329, 2408.6387041943763, 2281.4752606900424, 2298.9425264368356, 2312.0636142362287, 2332.323626148415, 2338.368640467073, 2340.578695834749, 2344.9062037518565, 2368.7039120109985, 2387.7015373078366, 2391.342380845264, 2206.3270702435752, 2263.1852533088077, 2310.607196776544, 2312.028947841902, 2313.641385585237, 2231.2413779314948, 2262.162999690125, 2262.694536237603, 2309.4919117794057, 2323.8373313868037, 11371.147163962652, 11447.484863181176, 11467.369294688871, 11541.884581154165, 11549.711257218552, 6493.610383377012, 6675.0, 6701.425165086201, 6706.094677218562, 6710.899336509956, 3930.371140617516, 4104.1381309924955, 4161.146964872194, 4167.791610419497, 4230.238557059728, 1349.6099018011366, 1380.3029470117526, 1394.5537428023038, 1400.0619584878054, 1404.115407293409, 16773.161341932977, 16921.407750728788, 16969.236384362608, 17113.203113673135, 17117.22972466242, 5047.974760126176, 5147.536721695065, 5413.106837371868, 5418.945810541923, 5480.862978425571, 12529.43617537213, 12614.55849045279, 12627.558035468715, 12652.114351995457, 12677.873221267853, 6527.3472652734345, 6528.869422611521, 6555.967220163964, 6559.770408035696, 6590.7693230736695, 5993.190919225849, 6015.578909476295, 6139.877202455926, 6204.224471941007, 6243.0, 4028.1540876415693, 4126.1128857295225, 4139.91720165595, 4156.7921603919685, 4158.480189976253, 1250.306080125539, 1252.2236213547658, 1258.6349958512112, 1268.1693490763564, 1285.755706415778, 825.2861274997084, 829.2578142562494, 845.0197770586091, 852.3351785607236, 865.3553102938351, 5810.477057064884, 5933.139694744238, 5934.643921364732, 5962.195103661037, 6131.908021379683, 581.3343721438929, 589.3546566509665, 599.5413508665874, 604.1632339210225, 608.7808388979963, 3781.8487260509823, 4320.4599425071865, 4386.758728269912, 4458.554144585581, 4517.887052823706, 14830.70338593222, 15171.620709482351, 15193.316300766492, 15280.235988200546, 15354.155521446428, 14597.927010365092, 15370.0, 15458.5362439127, 15535.766963495556, 15582.376704931676, 9404.482753448627, 9445.14993650561, 9537.804835380086, 9622.711318660451, 9633.036696330311, 6517.3808488193545, 6784.3894049535775, 6786.898196527155, 6797.286284940208, 6819.318068193141, 13476.865231347561, 13524.661883452993, 13879.375428105557, 13894.166350019032, 13929.721405571629, 13781.793273101111, 13789.379477923318, 13904.096233744775, 14119.43522259098, 14130.081544699562, 9425.481598511873, 9663.226941844776, 9705.175060119687, 9728.513574321398, 9787.902120978984, 10474.68575942723, 10484.79030419372, 10513.0, 10640.946795265974, 10646.467676616294, 8544.829103417773, 8558.700445484377, 8583.957080214559, 8592.183742544448, 8670.956645216733, 8183.71357002502, 8189.7133600323705, 8259.793505162419, 8391.454555453876, 8500.14998500145, 7863.724769633035, 7943.205679432011, 8015.318697910743, 8029.59852007409, 8035.879461807961, 5357.8392648220615, 5395.082835917825, 5411.134218525017, 5579.191017302387, 5656.717164141694, 5696.601237913306, 5756.827295180984, 5816.243888294494, 5831.7667293307795, 5940.376260492586], "value": 5253.815117714261, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [372.8154563491071, 387.71696661437153, 391.91573811630496, 391.9255341485118, 395.6794996053199, 5820.854478638036, 5948.583599148056, 5966.880662386755, 5988.431099045594, 6000.279966404027, 5781.479666829984, 5851.385604511529, 5869.823905282838, 5878.353381128072, 5882.000119959213, 4421.557844215577, 4424.269995450747, 4429.269170586849, 4432.667549933752, 4444.355568442574, 4270.444842170514, 4361.302191649337, 4406.140802543506, 4412.536683648219, 4424.535423780505, 4368.781560921957, 4372.759498227596, 4375.8249670013165, 4379.2117418864755, 4380.97809510952, 4377.824887004516, 4381.014271788854, 4413.271810151321, 4415.602595766396, 4429.0, 3708.740388172829, 3777.924441511182, 3818.2554401891643, 3823.7896915669626, 3841.635044670752, 5761.337446193657, 5765.126333941485, 5765.1928729977835, 5775.104858746901, 5804.738786754606, 5152.124138896359, 5154.329937108189, 5155.536001759822, 5156.9742151289, 5161.303224064778, 6178.41305076017, 6189.288231853305, 6224.657643829588, 6262.808017193991, 6272.843178920563, 4277.700560960734, 4292.80682369291, 4293.2701440755145, 4296.699231053827, 4304.677149213821, 6280.152179455807, 6424.072778166578, 6438.903416448757, 6527.967360163217, 6591.835204119888, 4307.030918043478, 4322.308430651081, 4330.328799036154, 4333.349997500337, 4333.674974376934, 4375.824967001285, 4384.583464570861, 4386.298192289282, 4389.934150987738, 4390.143921935256, 5038.420581633086, 5053.46938571452, 5124.385073791169, 5130.666506677054, 5141.820036298712, 6197.96901015501, 6233.688315584202, 6250.531210159256, 6267.71795269214, 6268.874622507525, 1499.1904371639193, 1505.9698806024037, 1508.6077619818707, 1515.6968606278788, 1515.9469418570518, 972.5526257921294, 1000.7047920863363, 1002.036009421542, 1002.4636819301638, 1005.2862467647906, 6045.848853778691, 6053.727582258809, 6057.878842423127, 6073.210482637317, 6098.54260930432, 6263.78076767311, 6349.952257877399, 6393.968030159819, 6418.77534286307, 6435.259945106279, 6065.5450841187085, 6072.39276072398, 6094.481969032682, 6123.38766123393, 6136.9079463808075, 3387.5765529308837, 3406.4549672052353, 3418.5043168740394, 3419.8119103449053, 3420.9486857697157, 6641.701123449457, 6679.666016699146, 6823.283555226729, 6823.488238382141, 6826.078479405316, 6597.406233439014, 6602.372774586503, 6642.435392991553, 6666.699998499982, 6667.566608170453, 6646.501512386591, 6731.225909020525, 6792.694328755218, 6820.283870193558, 6844.384005439435, 6466.385693359123, 6490.935090649033, 6503.414692677682, 6506.974256970342, 6537.313582073813, 6271.466925311217, 6294.276158241861, 6400.807975760735, 6417.358264173732, 6464.159659244268, 6686.966565167338, 6745.25802161752, 6757.121574195323, 6762.256151823197, 6774.0, 4365.039691267916, 4366.476022877275, 4375.059362237134, 4380.299152135643, 4382.342648602735, 6399.840003999937, 6470.952656927604, 6522.543421960418, 6524.967375163284, 6530.771423000172, 6261.279952805486, 6284.025975973731, 6298.968505157445, 6311.887371229319, 6313.90529142054, 6177.4749146323065, 6256.249250090018, 6289.308176100717, 6292.968535157295, 6312.3056463788025, 6198.473129784019, 6223.782167624111, 6305.5901366411035, 6312.779052733133, 6332.461740752087, 6215.96892015537, 6229.563930525001, 6270.404311590391, 6272.655003974825, 6289.182406287337, 6085.817425477243, 6110.78612248587, 6129.4483496483745, 6146.78486252979, 6150.876982460415], "value": 4705.810678478821, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [864.2696921101671, 887.2148148888232, 893.3567831161562, 894.579547612622, 912.4798864647149, 13326.999999999976, 13982.720345593081, 15172.848271517281, 15803.288852001659, 15927.20363981802, 15407.306671199794, 15530.45643402481, 15936.920315398436, 16037.518874433787, 16488.505344839643, 1005.5877090392959, 1021.7292417509366, 1023.3450591621369, 1023.5087158164085, 1026.0765311219886, 1013.4932533733133, 1020.0309705779503, 1020.9081182693556, 1021.5760459409373, 1021.9744506387325, 1066.802641511319, 1071.8928107189258, 1072.8712554493472, 1074.1084899533407, 1081.2701426537096, 1070.0797314309686, 1072.399456304472, 1073.0396295315688, 1073.5759375046853, 1076.1122074288744, 778.1401551285804, 780.2158830375437, 781.5193655901636, 784.7881072110555, 789.0, 15660.216989150496, 15768.448104316294, 15929.681406371808, 15966.521004369888, 15980.920095399564, 17948.461546153638, 18051.729224061648, 18142.09289535518, 18351.35770248035, 18440.90779546094, 14787.40850365984, 15016.399344026226, 15018.774718379123, 15112.773308400383, 15217.086974781549, 3230.7415406767404, 3236.8867089651985, 3249.658785827478, 3277.737780977516, 3288.8520016599073, 90427.0, 91529.0, 91940.0, 92222.99999999933, 92437.0, 12939.094263401472, 13038.869611303955, 13196.670083247996, 13231.603051908458, 13233.478150012872, 22093.889530552246, 22147.446313842283, 22246.77753222447, 25845.353866153495, 26474.735252647613, 8210.589470526449, 8468.534230617375, 8485.490870547786, 8507.872381914276, 8540.829183416421, 3855.267499175148, 3926.1951299983434, 3927.7643341399607, 3937.42907278443, 3955.0903292242947, 4282.935755963663, 4348.760818155032, 4385.6710746694125, 4397.890052748707, 4432.578905004019, 900.3517467423445, 923.1460898668705, 929.2890938432105, 933.118203297877, 938.7230766923774, 711.5161690050816, 720.5532569806753, 725.0719079578148, 726.7529040126383, 749.9775006749807, 11770.705732356759, 12965.481380744854, 13349.46602135923, 13615.387307571184, 13717.725645487035, 734.584959497882, 736.4697417859132, 746.3469464218808, 748.831512909591, 755.3617193471508, 5332.413434522199, 5433.864153396196, 5545.500904918576, 5583.3858275589655, 5617.859553511195, 86042.13957860466, 88178.0, 88811.0, 89561.55219223992, 91597.08402915885, 73976.0, 74499.62750186214, 75695.24304756992, 76017.23982760102, 78674.60662696764, 62388.37611623826, 68916.6554167226, 69073.65463172652, 69118.30881691219, 70698.0, 12616.49534018629, 13778.65553361134, 13998.090124141898, 14043.0, 14056.929715351358, 33922.66077339195, 34103.82948085244, 35191.824040879634, 35469.82265088658, 35685.0, 53018.46981530135, 55975.0, 56558.43441565532, 56718.0, 58674.4132558686, 15078.0, 15691.686166276839, 15879.12664803447, 17422.564435889206, 17637.294508220042, 19068.427947161606, 19090.618187635893, 19194.232230710615, 19300.517487062934, 19613.0, 18078.186481608096, 18826.152823122717, 18835.24659013624, 18934.905325473286, 19408.4177474676, 18107.004114773816, 18207.635847282716, 18405.263789448807, 18522.444326670222, 18901.243950241835, 16004.359825606845, 16052.919735401249, 16074.43739469113, 16540.172991350624, 16622.3351065956, 11791.233569818278, 11831.645050648494, 12167.634970950885, 12229.205101668364, 12318.692032699255, 13449.058565900294, 13490.730185396433, 13636.590902272948, 13644.181349119084, 14363.856361436252], "value": 8348.598590736863, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1508.8000000000002, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [101.0, 112.0, 112.0, 110.0, 111.0, 111.0, 111.0, 113.0, 112.0, 111.0], "value": 110.4, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 120.0, 120.0, 171.0, 124.0, 121.0, 117.0, 123.0, 147.0, 120.0], "value": 131.0, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 164.0, 165.0, 165.0, 163.0, 164.0, 165.0, 170.0, 169.0, 163.0], "value": 165.1, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 79.0, 79.0, 96.0, 75.0, 74.0, 75.0, 74.0, 99.0, 75.0], "value": 80.0, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 82.0, 107.0, 83.0, 82.0, 81.0, 94.0, 91.0, 82.0, 110.0], "value": 89.6, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [113.0, 114.0, 114.0, 113.0, 114.0, 114.0, 114.0, 114.0, 117.0, 114.0], "value": 114.1, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [150.0, 148.0, 149.0, 149.0, 152.0, 148.0, 150.0, 149.0, 150.0, 148.0], "value": 149.3, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 95.0, 95.0, 96.0, 95.0, 99.0, 94.0, 94.0, 95.0, 95.0], "value": 95.2, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [46.0, 46.0, 51.0, 45.0, 46.0, 47.0, 47.0, 52.0, 49.0, 46.0], "value": 47.5, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [56.0, 55.0, 56.0, 55.0, 55.0, 55.0, 55.0, 55.0, 56.0, 56.0], "value": 55.4, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 82.0, 89.0, 91.0, 82.0, 82.0, 82.0, 82.0, 83.0, 82.0], "value": 83.9, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [140.0, 127.0, 127.0, 125.0, 125.0, 133.0, 125.0, 125.0, 219.0, 125.0], "value": 137.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [183.0, 177.0, 181.0, 187.0, 182.0, 181.0, 177.0, 189.0, 185.0, 193.0], "value": 183.5, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [70.0, 67.0, 68.0, 65.0, 68.0, 67.0, 66.0, 67.0, 64.0, 65.0], "value": 66.7, "unit": "score"}]}]} 05:13:37 INFO - Return code: 0 05:13:37 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 05:13:37 INFO - # TBPL SUCCESS # 05:13:37 INFO - Running post-action listener: _resource_record_post_action 05:13:37 INFO - [mozharness: 2017-05-08 12:13:37.847446Z] Finished run-tests step (success) 05:13:37 INFO - Running post-run listener: _resource_record_post_run 05:13:37 INFO - Total resource usage - Wall time: 1191s; CPU: 13.0%; Read bytes: 4096; Write bytes: 367411200; Read time: 16; Write time: 257048 05:13:37 INFO - TinderboxPrint: CPU usage
13.2% 05:13:37 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 16 05:13:37 INFO - TinderboxPrint: I/O write bytes / time
367,411,200 / 257,048 05:13:37 INFO - TinderboxPrint: CPU idle
8,246.6 (86.8%) 05:13:37 INFO - TinderboxPrint: CPU user
1,201.1 (12.6%) 05:13:37 INFO - TinderboxPrint: Swap in / out
0 / 0 05:13:37 INFO - install - Wall time: 17s; CPU: 14.0%; Read bytes: 0; Write bytes: 103600128; Read time: 0; Write time: 108520 05:13:37 INFO - run-tests - Wall time: 1175s; CPU: 13.0%; Read bytes: 0; Write bytes: 263811072; Read time: 0; Write time: 148528 05:13:38 INFO - Running post-run listener: _upload_blobber_files 05:13:38 INFO - Blob upload gear active. 05:13:38 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 05:13:38 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 05:13:38 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox-Non-PGO', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 05:13:38 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox-Non-PGO -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 05:13:38 INFO - (blobuploader) - INFO - Open directory for files ... 05:13:38 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 05:13:38 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:13:38 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:13:39 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 05:13:39 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:13:39 INFO - (blobuploader) - INFO - Done attempting. 05:13:39 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 05:13:39 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:13:39 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:13:43 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 05:13:43 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:13:43 INFO - (blobuploader) - INFO - Done attempting. 05:13:43 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 05:13:43 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:13:43 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:13:44 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 05:13:44 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:13:44 INFO - (blobuploader) - INFO - Done attempting. 05:13:44 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 05:13:44 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:13:44 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:13:44 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 05:13:44 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:13:44 INFO - (blobuploader) - INFO - Done attempting. 05:13:44 INFO - (blobuploader) - INFO - Iteration through files over. 05:13:44 INFO - Return code: 0 05:13:44 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 05:13:44 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 05:13:44 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/b6bbfb2eaa05083d8fec22c4afe0c1c53f8b24b563daa0c30e7cc634363e20e561e647cf55d5b3cc714e25f523765a8f1c8b98b68af1c46c37994b8e394c8acf", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/70bafab97a56b81c0dc5efdd0f4177c76272d907bd65acc5b064f3dd99c548292d11214cd6bd9830f29cabba84c3caea558cecac88a5be310161e213ad00bc3f", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c99fa7b2579fe6cb80ac43def19ba804abd36e43b3b983e3c9fc3bec3a6660d2cef3facb3468fffae701d4ba4d0f9f16e182e91042ab9d99ce350469d3639410", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/7f607382afbe8297d270aab2eeca7a33a16b82013f825d407f53745fdfa749a13ecddcdced609520d36d8b9d5033488366fcb7cfabb7e89d1fd4185f1a0dcaa1"} 05:13:44 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 05:13:44 INFO - Writing to file /builds/slave/test/properties/blobber_files 05:13:44 INFO - Contents: 05:13:44 INFO - blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/b6bbfb2eaa05083d8fec22c4afe0c1c53f8b24b563daa0c30e7cc634363e20e561e647cf55d5b3cc714e25f523765a8f1c8b98b68af1c46c37994b8e394c8acf", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/70bafab97a56b81c0dc5efdd0f4177c76272d907bd65acc5b064f3dd99c548292d11214cd6bd9830f29cabba84c3caea558cecac88a5be310161e213ad00bc3f", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c99fa7b2579fe6cb80ac43def19ba804abd36e43b3b983e3c9fc3bec3a6660d2cef3facb3468fffae701d4ba4d0f9f16e182e91042ab9d99ce350469d3639410", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/7f607382afbe8297d270aab2eeca7a33a16b82013f825d407f53745fdfa749a13ecddcdced609520d36d8b9d5033488366fcb7cfabb7e89d1fd4185f1a0dcaa1"} 05:13:44 INFO - Running post-run listener: copy_logs_to_upload_dir 05:13:44 INFO - Copying logs to upload dir... 05:13:44 INFO - mkdir: /builds/slave/test/build/upload/logs 05:13:44 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1248.789367 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 48 secs) (at 2017-05-08 05:13:43.843006) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-05-08 05:13:43.847669) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/b6bbfb2eaa05083d8fec22c4afe0c1c53f8b24b563daa0c30e7cc634363e20e561e647cf55d5b3cc714e25f523765a8f1c8b98b68af1c46c37994b8e394c8acf", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/70bafab97a56b81c0dc5efdd0f4177c76272d907bd65acc5b064f3dd99c548292d11214cd6bd9830f29cabba84c3caea558cecac88a5be310161e213ad00bc3f", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c99fa7b2579fe6cb80ac43def19ba804abd36e43b3b983e3c9fc3bec3a6660d2cef3facb3468fffae701d4ba4d0f9f16e182e91042ab9d99ce350469d3639410", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/7f607382afbe8297d270aab2eeca7a33a16b82013f825d407f53745fdfa749a13ecddcdced609520d36d8b9d5033488366fcb7cfabb7e89d1fd4185f1a0dcaa1"} build_url:https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011282 build_url: 'https://queue.taskcluster.net/v1/task/Ux01QjPkRBa95o8xlSG6LQ/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/b6bbfb2eaa05083d8fec22c4afe0c1c53f8b24b563daa0c30e7cc634363e20e561e647cf55d5b3cc714e25f523765a8f1c8b98b68af1c46c37994b8e394c8acf", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/70bafab97a56b81c0dc5efdd0f4177c76272d907bd65acc5b064f3dd99c548292d11214cd6bd9830f29cabba84c3caea558cecac88a5be310161e213ad00bc3f", "dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/c99fa7b2579fe6cb80ac43def19ba804abd36e43b3b983e3c9fc3bec3a6660d2cef3facb3468fffae701d4ba4d0f9f16e182e91042ab9d99ce350469d3639410", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/7f607382afbe8297d270aab2eeca7a33a16b82013f825d407f53745fdfa749a13ecddcdced609520d36d8b9d5033488366fcb7cfabb7e89d1fd4185f1a0dcaa1"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-05-08 05:13:43.880337) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-05-08 05:13:43.880664) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=1f5564757af27664ca02d71f000001b0-1494243361.446884-1326264662 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004479 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-05-08 05:13:43.963020) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-05-08 05:13:43.966355) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-05-08 05:13:43.966654) ========= ========= Total master_lag: 0.30 =========