builder: mozilla-central_ubuntu64_hw_test-dromaeojs-e10s slave: talos-linux64-ix-022 starttime: 1485953582.62 results: success (0) revision: 9e7b1041929fccc06f6fad91cf66b9edcdfc0129 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-02-01 04:53:02.617336) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-02-01 04:53:02.617802) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-02-01 04:53:02.618390) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-02-01 04:53:02.672994) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-01 04:53:02.673486) ========= 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=9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-02-01 04:53:03-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 69.9M=0s 2017-02-01 04:53:03 (69.9 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.187316 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-01 04:53:02.878892) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-02-01 04:53:02.882355) ========= 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=9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.016387 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-02-01 04:53:02.931892) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-01 04:53:02.932237) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 9e7b1041929fccc06f6fad91cf66b9edcdfc0129 --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 9e7b1041929fccc06f6fad91cf66b9edcdfc0129 --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=9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-02-01 04:53:03,306 truncating revision to first 12 chars 2017-02-01 04:53:03,306 Setting DEBUG logging. 2017-02-01 04:53:03,306 attempt 1/10 2017-02-01 04:53:03,307 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/9e7b1041929f?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-02-01 04:53:03,740 unpacking tar archive at: mozilla-central-9e7b1041929f/testing/mozharness/ program finished with exit code 0 elapsedTime=0.792039 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-02-01 04:53:03.737699) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-02-01 04:53:03.738018) ========= script_repo_revision: 9e7b1041929fccc06f6fad91cf66b9edcdfc0129 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-02-01 04:53:03.738395) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-02-01 04:53:03.738654) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-02-01 04:53:03.747850) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 47 secs) (at 2017-02-01 04:53:03.748247) ========= /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=9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 04:53:04 INFO - MultiFileLogger online at 20170201 04:53:04 in /builds/slave/test 04:53:04 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:53:04 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 04:53:04 INFO - {'append_to_log': False, 04:53:04 INFO - 'base_work_dir': '/builds/slave/test', 04:53:04 INFO - 'blob_upload_branch': 'Firefox-Non-PGO', 04:53:04 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 04:53:04 INFO - 'branch': 'Firefox-Non-PGO', 04:53:04 INFO - 'buildbot_json_path': 'buildprops.json', 04:53:04 INFO - 'config_files': ('talos/linux_config.py',), 04:53:04 INFO - 'default_actions': ('clobber', 04:53:04 INFO - 'read-buildbot-config', 04:53:04 INFO - 'download-and-extract', 04:53:04 INFO - 'populate-webroot', 04:53:04 INFO - 'create-virtualenv', 04:53:04 INFO - 'install', 04:53:04 INFO - 'run-tests'), 04:53:04 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:53:04 INFO - 'download_minidump_stackwalk': True, 04:53:04 INFO - 'download_symbols': 'ondemand', 04:53:04 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 04:53:04 INFO - 'tooltool.py': '/tools/tooltool.py', 04:53:04 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 04:53:04 INFO - '/tools/misc-python/virtualenv.py')}, 04:53:04 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:53:04 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:53:04 INFO - 'installer_path': 'installer.exe', 04:53:04 INFO - 'log_level': 'info', 04:53:04 INFO - 'log_name': 'talos', 04:53:04 INFO - 'log_to_console': True, 04:53:04 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 04:53:04 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 04:53:04 INFO - 'opt_config_files': (), 04:53:04 INFO - 'pip_index': False, 04:53:04 INFO - 'sps_profile': False, 04:53:04 INFO - 'sps_profile_interval': 0, 04:53:04 INFO - 'suite': 'dromaeojs-e10s', 04:53:04 INFO - 'system_bits': '32', 04:53:04 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 04:53:04 INFO - 'title': 'talos-linux64-ix-022', 04:53:04 INFO - 'tooltool_cache': '/builds/tooltool_cache', 04:53:04 INFO - 'use_talos_json': True, 04:53:04 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 04:53:04 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:53:04 INFO - 'work_dir': 'build'} 04:53:04 INFO - [mozharness: 2017-02-01 12:53:04.221896Z] Running clobber step. 04:53:04 INFO - Running pre-action listener: _resource_record_pre_action 04:53:04 INFO - Running main action method: clobber 04:53:04 INFO - rmtree: /builds/slave/test/build 04:53:04 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 04:53:05 INFO - Running post-action listener: _resource_record_post_action 04:53:05 INFO - [mozharness: 2017-02-01 12:53:05.198623Z] Finished clobber step (success) 04:53:05 INFO - [mozharness: 2017-02-01 12:53:05.198722Z] Running read-buildbot-config step. 04:53:05 INFO - Running pre-action listener: _resource_record_pre_action 04:53:05 INFO - Running main action method: read_buildbot_config 04:53:05 INFO - Using buildbot properties: 04:53:05 INFO - { 04:53:05 INFO - "project": "", 04:53:05 INFO - "product": "firefox", 04:53:05 INFO - "who": "cbook@mozilla.com", 04:53:05 INFO - "installer_path": "public/build/target.tar.bz2", 04:53:05 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-e10s", 04:53:05 INFO - "repository": "https://hg.mozilla.org/mozilla-central/", 04:53:05 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central talos dromaeojs-e10s", 04:53:05 INFO - "stage_platform": "linux64", 04:53:05 INFO - "basedir": "/builds/slave/test", 04:53:05 INFO - "buildnumber": 398, 04:53:05 INFO - "platform": "ubuntu64_hw", 04:53:05 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 04:53:05 INFO - "slavebuilddir": "test", 04:53:05 INFO - "taskId": "BAS-4vlIS8iDoiX3WSFPXA", 04:53:05 INFO - "branch": "mozilla-central", 04:53:05 INFO - "script_repo_revision": "production", 04:53:05 INFO - "revision": "9e7b1041929fccc06f6fad91cf66b9edcdfc0129", 04:53:05 INFO - "slavename": "talos-linux64-ix-022", 04:53:05 INFO - "repo_path": "mozilla-central" 04:53:05 INFO - } 04:53:05 INFO - Finding installer, test and symbols from parent task. 04:53:05 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/BAS-4vlIS8iDoiX3WSFPXA'}, attempt #1 04:53:05 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/BAS-4vlIS8iDoiX3WSFPXA'}, attempt #1 04:53:06 INFO - Task dependencies: VnnkjD7MTYqEJ8m5I6V2zg 04:53:06 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/VnnkjD7MTYqEJ8m5I6V2zg'}, attempt #1 04:53:06 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.tar.bz2 04:53:06 INFO - Set test_url: https://queue.taskcluster.net/v1/task/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/test_packages.json 04:53:06 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.crashreporter-symbols.zip 04:53:06 INFO - Running post-action listener: _resource_record_post_action 04:53:06 INFO - [mozharness: 2017-02-01 12:53:06.600673Z] Finished read-buildbot-config step (success) 04:53:06 INFO - [mozharness: 2017-02-01 12:53:06.600890Z] Running download-and-extract step. 04:53:06 INFO - Running pre-action listener: _resource_record_pre_action 04:53:06 INFO - Running main action method: download_and_extract 04:53:06 INFO - mkdir: /builds/slave/test/build/tests 04:53:06 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:06 INFO - trying https://queue.taskcluster.net/v1/task/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.test_packages.json 04:53:06 INFO - Downloading https://queue.taskcluster.net/v1/task/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 04:53:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 04:53:07 INFO - Downloaded 896 bytes. 04:53:07 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 04:53:07 INFO - Using the following test package requirements: 04:53:07 INFO - {u'common': [u'target.common.tests.zip'], 04:53:07 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 04:53:07 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 04:53:07 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 04:53:07 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 04:53:07 INFO - u'mozbase': [u'target.common.tests.zip'], 04:53:07 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 04:53:07 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 04:53:07 INFO - u'web-platform': [u'target.common.tests.zip', 04:53:07 INFO - u'target.web-platform.tests.zip'], 04:53:07 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 04:53:07 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 04:53:07 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.common.tests.zip 04:53:07 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.common.tests.zip'}, attempt #1 04:53:07 INFO - Fetch https://queue.taskcluster.net/v1/task/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.common.tests.zip into memory 04:53:08 INFO - Expected file size: 20363869 04:53:08 INFO - Obtained file size: 20363869 04:53:12 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 04:53:12 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.common.tests.zip 04:53:12 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.common.tests.zip'}, attempt #1 04:53:12 INFO - Fetch https://queue.taskcluster.net/v1/task/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.common.tests.zip into memory 04:53:13 INFO - Expected file size: 20363869 04:53:13 INFO - Obtained file size: 20363869 04:53:17 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.talos.tests.zip 04:53:17 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.talos.tests.zip'}, attempt #1 04:53:17 INFO - Fetch https://queue.taskcluster.net/v1/task/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.talos.tests.zip into memory 04:53:18 INFO - Expected file size: 14403454 04:53:18 INFO - Obtained file size: 14403454 04:53:18 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:18 INFO - trying https://queue.taskcluster.net/v1/task/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.tar.bz2 04:53:18 INFO - Downloading https://queue.taskcluster.net/v1/task/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 04:53:18 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 04:53:19 INFO - Downloaded 56174107 bytes. 04:53:19 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.tar.bz2 04:53:19 INFO - mkdir: /builds/slave/test/properties 04:53:19 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 04:53:19 INFO - Writing to file /builds/slave/test/properties/build_url 04:53:19 INFO - Contents: 04:53:19 INFO - build_url:https://queue.taskcluster.net/v1/task/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.tar.bz2 04:53:19 INFO - Running post-action listener: _resource_record_post_action 04:53:19 INFO - Running post-action listener: set_extra_try_arguments 04:53:19 INFO - [mozharness: 2017-02-01 12:53:19.673625Z] Finished download-and-extract step (success) 04:53:19 INFO - [mozharness: 2017-02-01 12:53:19.673722Z] Running populate-webroot step. 04:53:19 INFO - Running pre-action listener: _resource_record_pre_action 04:53:19 INFO - Running main action method: populate_webroot 04:53:19 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 04:53:19 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 04:53:19 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 04:53:19 INFO - '--tppagecycles', 04:53:19 INFO - '7'], 04:53:19 INFO - 'tests': ['tsvgm']}}, 04:53:19 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 04:53:19 INFO - 'tests': ['tresize', 'tcanvasmark']}, 04:53:19 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 04:53:19 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 04:53:19 INFO - 'tests': ['dromaeo_css', 'kraken']}, 04:53:19 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 04:53:19 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 04:53:19 INFO - 'talos_options': ['--disable-e10s'], 04:53:19 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:53:19 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 04:53:19 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:53:19 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 04:53:19 INFO - 'talos_options': ['--disable-e10s'], 04:53:19 INFO - 'tests': ['damp', 'tps']}, 04:53:19 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 04:53:19 INFO - 'tests': ['damp', 'tps']}, 04:53:19 INFO - 'g3': {'talos_options': ['--disable-e10s'], 04:53:19 INFO - 'tests': ['dromaeo_dom']}, 04:53:19 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 04:53:19 INFO - 'g4': {'talos_options': ['--disable-e10s'], 04:53:19 INFO - 'tests': ['basic_compositor_video']}, 04:53:19 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 04:53:19 INFO - 'other': {'talos_options': ['--disable-e10s'], 04:53:19 INFO - 'tests': ['a11yr', 04:53:19 INFO - 'ts_paint', 04:53:19 INFO - 'tpaint', 04:53:19 INFO - 'sessionrestore', 04:53:19 INFO - 'sessionrestore_no_auto_restore', 04:53:19 INFO - 'tabpaint']}, 04:53:19 INFO - 'other-e10s': {'tests': ['a11yr', 04:53:19 INFO - 'ts_paint', 04:53:19 INFO - 'tpaint', 04:53:19 INFO - 'sessionrestore', 04:53:19 INFO - 'sessionrestore_no_auto_restore', 04:53:19 INFO - 'tabpaint']}, 04:53:19 INFO - 'other-e10s_l64': {'tests': ['a11yr', 04:53:19 INFO - 'ts_paint', 04:53:19 INFO - 'tpaint', 04:53:19 INFO - 'sessionrestore', 04:53:19 INFO - 'sessionrestore_no_auto_restore', 04:53:19 INFO - 'tabpaint']}, 04:53:19 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 04:53:19 INFO - 'ts_paint', 04:53:19 INFO - 'tpaint', 04:53:19 INFO - 'sessionrestore', 04:53:19 INFO - 'sessionrestore_no_auto_restore', 04:53:19 INFO - 'tabpaint']}, 04:53:19 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 04:53:19 INFO - 'tests': ['a11yr', 04:53:19 INFO - 'ts_paint', 04:53:19 INFO - 'tpaint', 04:53:19 INFO - 'sessionrestore', 04:53:19 INFO - 'sessionrestore_no_auto_restore', 04:53:19 INFO - 'tabpaint']}, 04:53:19 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 04:53:19 INFO - 'tests': ['a11yr', 04:53:19 INFO - 'ts_paint', 04:53:19 INFO - 'tpaint', 04:53:19 INFO - 'sessionrestore', 04:53:19 INFO - 'sessionrestore_no_auto_restore', 04:53:19 INFO - 'tabpaint']}, 04:53:19 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 04:53:19 INFO - 'tests': ['tsvgx', 04:53:19 INFO - 'tsvgr_opacity', 04:53:19 INFO - 'tart', 04:53:19 INFO - 'tscrollx', 04:53:19 INFO - 'cart', 04:53:19 INFO - 'tsvg_static']}, 04:53:19 INFO - 'svgr-e10s': {'tests': ['tsvgx', 04:53:19 INFO - 'tsvgr_opacity', 04:53:19 INFO - 'tart', 04:53:19 INFO - 'tscrollx', 04:53:19 INFO - 'cart', 04:53:19 INFO - 'tsvg_static']}, 04:53:19 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 04:53:19 INFO - 'talos_options': ['--disable-e10s'], 04:53:19 INFO - 'tests': ['tp5o']}, 04:53:19 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 04:53:19 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 04:53:19 INFO - 'talos_options': ['--disable-e10s', 04:53:19 INFO - '--xperf_path', 04:53:19 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:53:19 INFO - 'tests': ['tp5n']}, 04:53:19 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 04:53:19 INFO - 'talos_options': ['--xperf_path', 04:53:19 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:53:19 INFO - 'tests': ['tp5n']}}, 04:53:19 INFO - 'talos.zip': {'path': '', 04:53:19 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 04:53:19 INFO - Running post-action listener: _resource_record_post_action 04:53:19 INFO - [mozharness: 2017-02-01 12:53:19.686857Z] Finished populate-webroot step (success) 04:53:19 INFO - [mozharness: 2017-02-01 12:53:19.686948Z] Running create-virtualenv step. 04:53:19 INFO - Running pre-action listener: _resource_record_pre_action 04:53:19 INFO - Running main action method: create_virtualenv 04:53:19 INFO - Creating virtualenv /builds/slave/test/build/venv 04:53:19 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:19 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 04:53:19 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 04:53:19 INFO - Using real prefix '/usr' 04:53:19 INFO - New python executable in /builds/slave/test/build/venv/bin/python 04:53:20 INFO - Installing distribute.............................................................................................................................................................................................done. 04:53:22 INFO - Installing pip.................done. 04:53:22 INFO - Return code: 0 04:53:22 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 04:53:22 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 04:53:22 INFO - Reading from file tmpfile_stdout 04:53:22 INFO - Output received: 04:53:22 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:22 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 04:53:22 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:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:53:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:22 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:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:53:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:22 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 0x1d1e1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e2fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2090480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x208d820>, '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 0x208e520>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x208e9b0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917', '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:22 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:22 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:22 INFO - Using env: {'DISPLAY': ':0', 04:53:22 INFO - 'HOME': '/home/cltbld', 04:53:22 INFO - 'LANG': 'en_US.UTF-8', 04:53:22 INFO - 'LANGUAGE': 'en_US:en', 04:53:22 INFO - 'LOGNAME': 'cltbld', 04:53:22 INFO - 'MAIL': '/var/mail/cltbld', 04:53:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:53:22 INFO - 'MOZ_NO_REMOTE': '1', 04:53:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:53:22 INFO - 'NO_EM_RESTART': '1', 04:53:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:53:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:53:22 INFO - 'PWD': '/builds/slave/test', 04:53:22 INFO - 'SHELL': '/bin/bash', 04:53:22 INFO - 'SHLVL': '1', 04:53:22 INFO - 'TERM': 'linux', 04:53:22 INFO - 'TMOUT': '86400', 04:53:22 INFO - 'USER': 'cltbld', 04:53:22 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917', 04:53:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:53:22 INFO - '_': '/tools/buildbot/bin/python'} 04:53:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:53:22 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:22 INFO - Cleaning up... 04:53:22 INFO - Return code: 0 04:53:22 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 04:53:22 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:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:53:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:22 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:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:53:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:22 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 0x1d1e1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e2fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2090480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x208d820>, '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 0x208e520>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x208e9b0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917', '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:22 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:22 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:22 INFO - Using env: {'DISPLAY': ':0', 04:53:22 INFO - 'HOME': '/home/cltbld', 04:53:22 INFO - 'LANG': 'en_US.UTF-8', 04:53:22 INFO - 'LANGUAGE': 'en_US:en', 04:53:22 INFO - 'LOGNAME': 'cltbld', 04:53:22 INFO - 'MAIL': '/var/mail/cltbld', 04:53:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:53:22 INFO - 'MOZ_NO_REMOTE': '1', 04:53:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:53:22 INFO - 'NO_EM_RESTART': '1', 04:53:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:53:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:53:22 INFO - 'PWD': '/builds/slave/test', 04:53:22 INFO - 'SHELL': '/bin/bash', 04:53:22 INFO - 'SHLVL': '1', 04:53:22 INFO - 'TERM': 'linux', 04:53:22 INFO - 'TMOUT': '86400', 04:53:22 INFO - 'USER': 'cltbld', 04:53:22 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917', 04:53:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:53:22 INFO - '_': '/tools/buildbot/bin/python'} 04:53:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:53:22 INFO - Downloading/unpacking psutil>=3.1.1 04:53:22 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:22 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:22 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:22 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:22 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:22 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:24 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 04:53:25 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:53:25 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:53:25 INFO - Installing collected packages: psutil 04:53:25 INFO - Running setup.py install for psutil 04:53:25 INFO - building 'psutil._psutil_linux' extension 04:53:25 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:25 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:25 INFO - building 'psutil._psutil_posix' extension 04:53:25 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:25 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:25 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:53:25 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:53:25 INFO - Successfully installed psutil 04:53:25 INFO - Cleaning up... 04:53:25 INFO - Return code: 0 04:53:25 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 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 - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:53:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 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 - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:53:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:25 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 0x1d1e1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e2fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2090480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x208d820>, '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 0x208e520>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x208e9b0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917', '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:25 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:25 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:25 INFO - Using env: {'DISPLAY': ':0', 04:53:25 INFO - 'HOME': '/home/cltbld', 04:53:25 INFO - 'LANG': 'en_US.UTF-8', 04:53:25 INFO - 'LANGUAGE': 'en_US:en', 04:53:25 INFO - 'LOGNAME': 'cltbld', 04:53:25 INFO - 'MAIL': '/var/mail/cltbld', 04:53:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:53:25 INFO - 'MOZ_NO_REMOTE': '1', 04:53:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:53:25 INFO - 'NO_EM_RESTART': '1', 04:53:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:53:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:53:25 INFO - 'PWD': '/builds/slave/test', 04:53:25 INFO - 'SHELL': '/bin/bash', 04:53:25 INFO - 'SHLVL': '1', 04:53:25 INFO - 'TERM': 'linux', 04:53:25 INFO - 'TMOUT': '86400', 04:53:25 INFO - 'USER': 'cltbld', 04:53:25 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917', 04:53:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:53:25 INFO - '_': '/tools/buildbot/bin/python'} 04:53:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:53:25 INFO - Downloading/unpacking mozsystemmonitor==0.3 04:53:25 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:25 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:25 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:25 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:25 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:25 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:27 INFO - Downloading mozsystemmonitor-0.3.tar.gz 04:53:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 04:53:27 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:27 INFO - Installing collected packages: mozsystemmonitor 04:53:27 INFO - Running setup.py install for mozsystemmonitor 04:53:27 INFO - Successfully installed mozsystemmonitor 04:53:27 INFO - Cleaning up... 04:53:28 INFO - Return code: 0 04:53:28 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 04:53:28 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:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:53:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:28 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:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:53:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:28 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 0x1d1e1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e2fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2090480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x208d820>, '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 0x208e520>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x208e9b0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917', '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:28 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:28 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:28 INFO - Using env: {'DISPLAY': ':0', 04:53:28 INFO - 'HOME': '/home/cltbld', 04:53:28 INFO - 'LANG': 'en_US.UTF-8', 04:53:28 INFO - 'LANGUAGE': 'en_US:en', 04:53:28 INFO - 'LOGNAME': 'cltbld', 04:53:28 INFO - 'MAIL': '/var/mail/cltbld', 04:53:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:53:28 INFO - 'MOZ_NO_REMOTE': '1', 04:53:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:53:28 INFO - 'NO_EM_RESTART': '1', 04:53:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:53:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:53:28 INFO - 'PWD': '/builds/slave/test', 04:53:28 INFO - 'SHELL': '/bin/bash', 04:53:28 INFO - 'SHLVL': '1', 04:53:28 INFO - 'TERM': 'linux', 04:53:28 INFO - 'TMOUT': '86400', 04:53:28 INFO - 'USER': 'cltbld', 04:53:28 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917', 04:53:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:53:28 INFO - '_': '/tools/buildbot/bin/python'} 04:53:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:53:28 INFO - Downloading/unpacking jsonschema==2.5.1 04:53:28 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:28 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:28 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:28 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:28 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:28 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:30 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 04:53:30 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 04:53:30 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:30 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:30 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:30 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:30 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:30 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:30 INFO - Downloading functools32-3.2.3-2.tar.gz 04:53:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 04:53:30 INFO - warning: no files found matching '*.txt' 04:53:30 INFO - no previously-included directories found matching 'build' 04:53:30 INFO - no previously-included directories found matching 'dist' 04:53:30 INFO - no previously-included directories found matching '.git*' 04:53:30 INFO - Installing collected packages: jsonschema, functools32 04:53:30 INFO - Running setup.py install for functools32 04:53:30 INFO - warning: no files found matching '*.txt' 04:53:30 INFO - no previously-included directories found matching 'build' 04:53:30 INFO - no previously-included directories found matching 'dist' 04:53:30 INFO - no previously-included directories found matching '.git*' 04:53:30 INFO - Successfully installed jsonschema functools32 04:53:30 INFO - Cleaning up... 04:53:30 INFO - Return code: 0 04:53:30 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 04:53:30 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:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:53:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:30 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:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:53:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:30 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 0x1d1e1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e2fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2090480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x208d820>, '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 0x208e520>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x208e9b0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917', '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:30 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:30 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:30 INFO - Using env: {'DISPLAY': ':0', 04:53:30 INFO - 'HOME': '/home/cltbld', 04:53:30 INFO - 'LANG': 'en_US.UTF-8', 04:53:30 INFO - 'LANGUAGE': 'en_US:en', 04:53:30 INFO - 'LOGNAME': 'cltbld', 04:53:30 INFO - 'MAIL': '/var/mail/cltbld', 04:53:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:53:30 INFO - 'MOZ_NO_REMOTE': '1', 04:53:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:53:30 INFO - 'NO_EM_RESTART': '1', 04:53:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:53:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:53:30 INFO - 'PWD': '/builds/slave/test', 04:53:30 INFO - 'SHELL': '/bin/bash', 04:53:30 INFO - 'SHLVL': '1', 04:53:30 INFO - 'TERM': 'linux', 04:53:30 INFO - 'TMOUT': '86400', 04:53:30 INFO - 'USER': 'cltbld', 04:53:30 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917', 04:53:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:53:30 INFO - '_': '/tools/buildbot/bin/python'} 04:53:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:53:30 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 04:53:30 INFO - Cleaning up... 04:53:30 INFO - Return code: 0 04:53:30 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 04:53:30 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:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:53:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:30 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:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:53:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:30 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 0x1d1e1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e2fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2090480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x208d820>, '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 0x208e520>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x208e9b0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917', '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:30 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:30 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:30 INFO - Using env: {'DISPLAY': ':0', 04:53:30 INFO - 'HOME': '/home/cltbld', 04:53:30 INFO - 'LANG': 'en_US.UTF-8', 04:53:30 INFO - 'LANGUAGE': 'en_US:en', 04:53:30 INFO - 'LOGNAME': 'cltbld', 04:53:30 INFO - 'MAIL': '/var/mail/cltbld', 04:53:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:53:30 INFO - 'MOZ_NO_REMOTE': '1', 04:53:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:53:30 INFO - 'NO_EM_RESTART': '1', 04:53:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:53:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:53:30 INFO - 'PWD': '/builds/slave/test', 04:53:30 INFO - 'SHELL': '/bin/bash', 04:53:30 INFO - 'SHLVL': '1', 04:53:30 INFO - 'TERM': 'linux', 04:53:30 INFO - 'TMOUT': '86400', 04:53:30 INFO - 'USER': 'cltbld', 04:53:30 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917', 04:53:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:53:30 INFO - '_': '/tools/buildbot/bin/python'} 04:53:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:53:31 INFO - Downloading/unpacking blobuploader==1.2.4 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:33 INFO - Downloading blobuploader-1.2.4.tar.gz 04:53:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 04:53:33 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 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:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 04:53:33 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 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:33 INFO - Downloading docopt-0.6.1.tar.gz 04:53:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 04:53:34 INFO - Installing collected packages: blobuploader, requests, docopt 04:53:34 INFO - Running setup.py install for blobuploader 04:53:34 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 04:53:34 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 04:53:34 INFO - Running setup.py install for requests 04:53:34 INFO - Running setup.py install for docopt 04:53:34 INFO - Successfully installed blobuploader requests docopt 04:53:34 INFO - Cleaning up... 04:53:34 INFO - Return code: 0 04:53:34 INFO - Installing None 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', '--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 0x1d1e1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e2fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2090480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x208d820>, '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 0x208e520>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x208e9b0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917', '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', '--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:34 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: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': '9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917', 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 - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:53:34 INFO - Running setup.py (path:/tmp/pip-KTZ7kq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:53:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:53:34 INFO - Running setup.py (path:/tmp/pip-VP0nHW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:53:34 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:53:35 INFO - Running setup.py (path:/tmp/pip-Pjt4dZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:53:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:53:35 INFO - Running setup.py (path:/tmp/pip-62NDcf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:53:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:53:35 INFO - Running setup.py (path:/tmp/pip-sWRCzK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:53:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:53:35 INFO - Running setup.py (path:/tmp/pip-uxh22B-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:53:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:53:35 INFO - Running setup.py (path:/tmp/pip-GyX00K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:53:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:53:35 INFO - Running setup.py (path:/tmp/pip-ldMxqC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:53:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:53:35 INFO - Running setup.py (path:/tmp/pip-Z8k7nD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:53:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:53:35 INFO - Running setup.py (path:/tmp/pip-_iCGqI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:53:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:53:35 INFO - Running setup.py (path:/tmp/pip-qb8a07-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:53:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:53:35 INFO - Running setup.py (path:/tmp/pip-Q15zeE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:53:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:53:35 INFO - Running setup.py (path:/tmp/pip-CQxQEF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:53:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:53:35 INFO - Running setup.py (path:/tmp/pip-EqsVHQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:53:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:53:35 INFO - Running setup.py (path:/tmp/pip-gXkJjI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:53:35 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:53:35 INFO - Running setup.py (path:/tmp/pip-yAc8oe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:53:36 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:53:36 INFO - Running setup.py (path:/tmp/pip-8F8LwE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:53:36 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 04:53:36 INFO - Running setup.py install for manifestparser 04:53:36 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 04:53:36 INFO - Running setup.py install for mozcrash 04:53:36 INFO - Running setup.py install for mozdebug 04:53:36 INFO - Running setup.py install for mozdevice 04:53:36 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 04:53:36 INFO - Installing dm script to /builds/slave/test/build/venv/bin 04:53:36 INFO - Running setup.py install for mozfile 04:53:36 INFO - Running setup.py install for mozhttpd 04:53:36 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 04:53:36 INFO - Running setup.py install for mozinfo 04:53:36 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 04:53:36 INFO - Running setup.py install for mozInstall 04:53:36 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 04:53:36 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 04:53:36 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 04:53:36 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 04:53:36 INFO - Running setup.py install for mozleak 04:53:37 INFO - Running setup.py install for mozlog 04:53:37 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 04:53:37 INFO - Running setup.py install for moznetwork 04:53:37 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 04:53:37 INFO - Running setup.py install for mozprocess 04:53:37 INFO - Running setup.py install for mozprofile 04:53:37 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 04:53:37 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 04:53:37 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 04:53:37 INFO - Running setup.py install for mozrunner 04:53:37 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 04:53:37 INFO - Running setup.py install for mozscreenshot 04:53:37 INFO - Running setup.py install for moztest 04:53:37 INFO - Running setup.py install for mozversion 04:53:37 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 04:53:37 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 04:53:37 INFO - Cleaning up... 04:53:37 INFO - Return code: 0 04:53:37 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:53:37 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:37 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:53:37 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:37 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:37 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:53:37 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:37 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 0x1d1e1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e2fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2090480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x208d820>, '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 0x208e520>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x208e9b0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917', '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:37 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:37 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:37 INFO - Using env: {'DISPLAY': ':0', 04:53:37 INFO - 'HOME': '/home/cltbld', 04:53:37 INFO - 'LANG': 'en_US.UTF-8', 04:53:37 INFO - 'LANGUAGE': 'en_US:en', 04:53:37 INFO - 'LOGNAME': 'cltbld', 04:53:37 INFO - 'MAIL': '/var/mail/cltbld', 04:53:37 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:53:37 INFO - 'MOZ_NO_REMOTE': '1', 04:53:37 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:53:37 INFO - 'NO_EM_RESTART': '1', 04:53:37 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:53:37 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:53:37 INFO - 'PWD': '/builds/slave/test', 04:53:37 INFO - 'SHELL': '/bin/bash', 04:53:37 INFO - 'SHLVL': '1', 04:53:37 INFO - 'TERM': 'linux', 04:53:37 INFO - 'TMOUT': '86400', 04:53:37 INFO - 'USER': 'cltbld', 04:53:37 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917', 04:53:37 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:53:37 INFO - '_': '/tools/buildbot/bin/python'} 04:53:38 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:53:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:53:38 INFO - Running setup.py (path:/tmp/pip-l50FbN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:53:38 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:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:53:38 INFO - Running setup.py (path:/tmp/pip-IHhRTg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:53:38 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:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:53:38 INFO - Running setup.py (path:/tmp/pip-G2WEwr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:53:38 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:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:53:38 INFO - Running setup.py (path:/tmp/pip-MeuXFA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:53:38 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.49 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:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:53:38 INFO - Running setup.py (path:/tmp/pip-TJ_z6P-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:53:38 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:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:53:38 INFO - Running setup.py (path:/tmp/pip-Ih5cW3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:53:38 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:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:53:38 INFO - Running setup.py (path:/tmp/pip-sCVPnb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:53:38 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:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:53:38 INFO - Running setup.py (path:/tmp/pip-RM9Ntu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:53:38 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:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:53:38 INFO - Running setup.py (path:/tmp/pip-RtmiLg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:53:38 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:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:53:38 INFO - Running setup.py (path:/tmp/pip-WZt9Dx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:53:38 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:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:53:38 INFO - Running setup.py (path:/tmp/pip-PGgSpl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:53:38 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:38 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:53:38 INFO - Running setup.py (path:/tmp/pip-FcYs_A-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:53:39 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.24 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:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:53:39 INFO - Running setup.py (path:/tmp/pip-V3Uq_q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:53:39 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:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:53:39 INFO - Running setup.py (path:/tmp/pip-AkdwIS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:53:39 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:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:53:39 INFO - Running setup.py (path:/tmp/pip-fwo7V_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:53:39 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:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:53:39 INFO - Running setup.py (path:/tmp/pip-Gq6taK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:53:39 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:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:53:39 INFO - Running setup.py (path:/tmp/pip-3lRJGx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:53:39 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:39 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:39 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:39 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:39 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:53:39 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 04:53:39 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:53:39 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:39 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:39 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:39 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:39 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:39 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:41 INFO - Downloading blessings-1.6.tar.gz 04:53:41 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 04:53:41 INFO - Installing collected packages: blessings 04:53:41 INFO - Running setup.py install for blessings 04:53:41 INFO - Successfully installed blessings 04:53:41 INFO - Cleaning up... 04:53:41 INFO - Return code: 0 04:53:41 INFO - Done creating virtualenv /builds/slave/test/build/venv. 04:53:41 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:53:41 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:53:41 INFO - Reading from file tmpfile_stdout 04:53:41 INFO - Current package versions: 04:53:41 INFO - argparse == 1.2.1 04:53:41 INFO - blessings == 1.6 04:53:41 INFO - blobuploader == 1.2.4 04:53:41 INFO - docopt == 0.6.1 04:53:41 INFO - functools32 == 3.2.3-2 04:53:41 INFO - jsonschema == 2.5.1 04:53:41 INFO - manifestparser == 1.1 04:53:41 INFO - mozInstall == 1.12 04:53:41 INFO - mozcrash == 1.0 04:53:41 INFO - mozdebug == 0.1 04:53:41 INFO - mozdevice == 0.49 04:53:41 INFO - mozfile == 1.2 04:53:41 INFO - mozhttpd == 0.7 04:53:41 INFO - mozinfo == 0.9 04:53:41 INFO - mozleak == 0.1 04:53:41 INFO - mozlog == 3.4 04:53:41 INFO - moznetwork == 0.27 04:53:41 INFO - mozprocess == 0.24 04:53:41 INFO - mozprofile == 0.28 04:53:41 INFO - mozrunner == 6.13 04:53:41 INFO - mozscreenshot == 0.1 04:53:41 INFO - mozsystemmonitor == 0.3 04:53:41 INFO - moztest == 0.8 04:53:41 INFO - mozversion == 1.4 04:53:41 INFO - psutil == 3.1.1 04:53:41 INFO - requests == 1.2.3 04:53:41 INFO - wsgiref == 0.1.2 04:53:41 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:53:41 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:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:53:41 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:41 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:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:53:41 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:53:41 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 0x1d1e1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e2fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2090480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x208d820>, '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 0x208e520>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x208e9b0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917', '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:41 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:41 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:41 INFO - Using env: {'DISPLAY': ':0', 04:53:41 INFO - 'HOME': '/home/cltbld', 04:53:41 INFO - 'LANG': 'en_US.UTF-8', 04:53:41 INFO - 'LANGUAGE': 'en_US:en', 04:53:41 INFO - 'LOGNAME': 'cltbld', 04:53:41 INFO - 'MAIL': '/var/mail/cltbld', 04:53:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:53:41 INFO - 'MOZ_NO_REMOTE': '1', 04:53:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:53:41 INFO - 'NO_EM_RESTART': '1', 04:53:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:53:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:53:41 INFO - 'PWD': '/builds/slave/test', 04:53:41 INFO - 'SHELL': '/bin/bash', 04:53:41 INFO - 'SHLVL': '1', 04:53:41 INFO - 'TERM': 'linux', 04:53:41 INFO - 'TMOUT': '86400', 04:53:41 INFO - 'USER': 'cltbld', 04:53:41 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917', 04:53:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:53:41 INFO - '_': '/tools/buildbot/bin/python'} 04:53:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:53:42 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:42 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:42 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:42 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:42 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:42 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:42 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:42 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:42 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:42 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:42 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:42 INFO - Cleaning up... 04:53:42 INFO - Return code: 0 04:53:42 INFO - Installing jsonschema 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', '--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 0x1d1e1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e2fa80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2090480>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x208d820>, '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 0x208e520>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x208e9b0>, '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': '9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917', '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', '--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:42 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: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': '9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917', 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 - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 04:53:42 INFO - Cleaning up... 04:53:42 INFO - Return code: 0 04:53:42 INFO - Running post-action listener: _resource_record_post_action 04:53:42 INFO - Running post-action listener: _start_resource_monitoring 04:53:42 INFO - Starting resource monitoring. 04:53:42 INFO - [mozharness: 2017-02-01 12:53:42.397217Z] Finished create-virtualenv step (success) 04:53:42 INFO - [mozharness: 2017-02-01 12:53:42.397777Z] Running install step. 04:53:42 INFO - Running pre-action listener: _resource_record_pre_action 04:53:42 INFO - Running main action method: install 04:53:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:53:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:53:42 INFO - Reading from file tmpfile_stdout 04:53:42 INFO - Detecting whether we're running mozinstall >=1.0... 04:53:42 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 04:53:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 04:53:42 INFO - Reading from file tmpfile_stdout 04:53:42 INFO - Output received: 04:53:42 INFO - Usage: mozinstall [options] installer 04:53:42 INFO - Options: 04:53:42 INFO - -h, --help show this help message and exit 04:53:42 INFO - -d DEST, --destination=DEST 04:53:42 INFO - Directory to install application into. [default: 04:53:42 INFO - "/builds/slave/test"] 04:53:42 INFO - --app=APP Application being installed. [default: firefox] 04:53:42 INFO - mkdir: /builds/slave/test/build/application 04:53:42 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:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 04:53:58 INFO - Reading from file tmpfile_stdout 04:53:58 INFO - Output received: 04:53:58 INFO - /builds/slave/test/build/application/firefox/firefox 04:53:58 INFO - Running post-action listener: _resource_record_post_action 04:53:58 INFO - [mozharness: 2017-02-01 12:53:58.927982Z] Finished install step (success) 04:53:58 INFO - [mozharness: 2017-02-01 12:53:58.928135Z] Running run-tests step. 04:53:58 INFO - Running pre-action listener: _resource_record_pre_action 04:53:58 INFO - Running main action method: run_tests 04:53:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 04:53:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 04:53:58 INFO - Python 2.7.3 04:53:58 INFO - Return code: 0 04:53:58 INFO - grabbing minidump binary from tooltool 04:53:58 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:58 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 0x208d820>, '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 0x208e520>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x208e9b0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 04:53:58 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:53:58 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:53:58 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:53:58 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 04:53:59 INFO - Return code: 0 04:53:59 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 04:53:59 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 04:53:59 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 04:53:59 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 04:53:59 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 04:53:59 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/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-022', '--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:53:59 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/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-022 --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:53:59 INFO - Using env: {'DISPLAY': ':0', 04:53:59 INFO - 'HOME': '/home/cltbld', 04:53:59 INFO - 'LANG': 'en_US.UTF-8', 04:53:59 INFO - 'LANGUAGE': 'en_US:en', 04:53:59 INFO - 'LOGNAME': 'cltbld', 04:53:59 INFO - 'MAIL': '/var/mail/cltbld', 04:53:59 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 04:53:59 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 04:53:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:53:59 INFO - 'MOZ_NO_REMOTE': '1', 04:53:59 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 04:53:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:53:59 INFO - 'NO_EM_RESTART': '1', 04:53:59 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:53:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:53:59 INFO - 'PWD': '/builds/slave/test', 04:53:59 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 04:53:59 INFO - 'SHELL': '/bin/bash', 04:53:59 INFO - 'SHLVL': '1', 04:53:59 INFO - 'TERM': 'linux', 04:53:59 INFO - 'TMOUT': '86400', 04:53:59 INFO - 'USER': 'cltbld', 04:53:59 INFO - 'XDG_SESSION_COOKIE': '9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917', 04:53:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:53:59 INFO - '_': '/tools/buildbot/bin/python'} 04:53:59 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/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-022', '--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:53:59 INFO - mozversion application_buildid: 20170201121440 04:53:59 INFO - mozversion application_changeset: 9e7b1041929fccc06f6fad91cf66b9edcdfc0129 04:53:59 INFO - mozversion application_display_name: Nightly 04:53:59 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 04:53:59 INFO - mozversion application_name: Firefox 04:53:59 INFO - mozversion application_remotingname: firefox 04:53:59 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 04:53:59 INFO - mozversion application_vendor: Mozilla 04:53:59 INFO - mozversion application_version: 54.0a1 04:53:59 INFO - mozversion platform_buildid: 20170201121440 04:53:59 INFO - mozversion platform_changeset: 9e7b1041929fccc06f6fad91cf66b9edcdfc0129 04:53:59 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 04:53:59 INFO - mozversion platform_version: 54.0a1 04:53:59 INFO - using testdate: 1485953639 04:53:59 INFO - actual date: 1485953639 04:53:59 INFO - starting webserver on 'localhost:60727' 04:53:59 INFO - SUITE-START | Running 2 tests 04:53:59 INFO - TEST-START | dromaeo_css 04:53:59 INFO - operating with platform_type : linux_ 04:53:59 INFO - Initialising browser for dromaeo_css test... 04:53:59 INFO - TEST-INFO | started process 5995 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpkZmGEL/profile http://localhost:60727/getInfo.html) 04:54:03 INFO - PROCESS | 5995 | JavaScript error: chrome://webcompat/content/lib/ua_overrider.jsm, line 109: NS_ERROR_INSUFFICIENT_DOMAIN_LEVELS: Component returned failure code: 0x804b0050 (NS_ERROR_INSUFFICIENT_DOMAIN_LEVELS) [nsIEffectiveTLDService.getBaseDomain] 04:54:04 INFO - PROCESS | 5995 | __metrics Screen width/height:1600/1200 04:54:04 INFO - PROCESS | 5995 | colorDepth:24 04:54:04 INFO - PROCESS | 5995 | Browser inner width/height: 1024/697 04:54:04 INFO - PROCESS | 5995 | __metrics 04:54:04 INFO - PROCESS | 5995 | 1485953644511 addons.xpi WARN Exception running bootstrap method shutdown on shield-recipe-client@mozilla.org: ReferenceError: LogManager is not defined (resource://gre/modules/addons/XPIProvider.jsm -> jar:file:///builds/slave/test/build/application/firefox/browser/features/shield-recipe-client@mozilla.org.xpi!/bootstrap.js:65:3) JS Stack trace: this.shutdown@resource://gre/modules/addons/XPIProvider.jsm -> jar:file:///builds/slave/test/build/application/firefox/browser/features/shield-recipe-client@bootstrap.js:65:3 < callBootstrapMethod@XPIProvider.jsm:4903:11 < observe@XPIProvider.jsm:2884:15 < permitUnload@remote-browser.xml:353:13 < CanCloseWindow@browser.js:6274:36 < canClose@browser.js:5140:12 < forceQuit@jar:file:///tmp/tmpkZmGEL/profile/extensions/talos-powers@TalosPowersService.js:238:7 < whenDone@jar:file:///tmp/tmpkZmGEL/profile/extensions/talos-powers@TalosPowersService.js:223:9 < promise callback*forceQuit@jar:file:///tmp/tmpkZmGEL/profile/extensions/talos-powers@TalosPowersService.js:225:7 < receiveMessage@jar:file:///tmp/tmpkZmGEL/profile/extensions/talos-powers@TalosPowersService.js:55:9 04:54:04 ERROR - PROCESS | 5995 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3284: TypeError: this.tabs is undefined 04:54:05 INFO - TEST-INFO | 5995: exit 0 04:54:05 INFO - Browser initialized. 04:54:05 INFO - Running cycle 1/1 for dromaeo_css test... 04:54:05 INFO - TEST-INFO | started process 6115 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpkZmGEL/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:54:17 INFO - PROCESS | 6115 | RSS: Main: 159580160 04:54:17 INFO - PROCESS | 6115 | 04:57:20 INFO - PROCESS | 6115 | Cycle 1(1): loaded http://localhost:60727/tests/dromaeo/cssquery-dojo.html (next: http://localhost:60727/tests/dromaeo/cssquery-ext.html) 04:57:21 INFO - PROCESS | 6115 | RSS: Main: 169279488 04:57:21 INFO - PROCESS | 6115 | 04:59:05 INFO - PROCESS | 6115 | ************************* 04:59:05 INFO - PROCESS | 6115 | A coding exception was thrown and uncaught in a Task. 04:59:05 INFO - PROCESS | 6115 | 04:59:05 ERROR - PROCESS | 6115 | Full message: TypeError: NetworkError when attempting to fetch resource. 04:59:05 INFO - PROCESS | 6115 | Full stack: 04:59:05 INFO - PROCESS | 6115 | ************************* 05:00:23 INFO - PROCESS | 6115 | Cycle 1(1): loaded http://localhost:60727/tests/dromaeo/cssquery-ext.html (next: http://localhost:60727/tests/dromaeo/cssquery-jquery.html) 05:00:24 INFO - PROCESS | 6115 | RSS: Main: 164155392 05:00:24 INFO - PROCESS | 6115 | 05:03:26 INFO - PROCESS | 6115 | Cycle 1(1): loaded http://localhost:60727/tests/dromaeo/cssquery-jquery.html (next: http://localhost:60727/tests/dromaeo/cssquery-mootools.html) 05:03:27 INFO - PROCESS | 6115 | RSS: Main: 171507712 05:03:27 INFO - PROCESS | 6115 | 05:06:29 INFO - PROCESS | 6115 | Cycle 1(1): loaded http://localhost:60727/tests/dromaeo/cssquery-mootools.html (next: http://localhost:60727/tests/dromaeo/cssquery-prototype.html) 05:06:29 INFO - PROCESS | 6115 | RSS: Main: 164503552 05:06:29 INFO - PROCESS | 6115 | 05:09:32 INFO - PROCESS | 6115 | Cycle 1(1): loaded http://localhost:60727/tests/dromaeo/cssquery-prototype.html (next: http://localhost:60727/tests/dromaeo/cssquery-yui.html) 05:09:33 INFO - PROCESS | 6115 | RSS: Main: 168914944 05:09:33 INFO - PROCESS | 6115 | 05:12:36 INFO - PROCESS | 6115 | Cycle 1(1): loaded http://localhost:60727/tests/dromaeo/cssquery-yui.html (next: http://localhost:60727/tests/dromaeo/cssquery-dojo.html) 05:12:36 INFO - PROCESS | 6115 | RSS: Main: 170401792 05:12:36 INFO - PROCESS | 6115 | 05:12:36 INFO - PROCESS | 6115 | __start_tp_report 05:12:36 INFO - PROCESS | 6115 | _x_x_mozilla_page_load 05:12:36 INFO - PROCESS | 6115 | _x_x_mozilla_page_load_details 05:12:36 INFO - PROCESS | 6115 | |i|pagename|runs| 05:12:36 INFO - PROCESS | 6115 | |0;dojo.html;2499.4251322195896;2537.8072306016165;2555.757203065708;2566.9358266043346;2580.9354766130855;4464.441944756905;4594.8391806286745;4621.6071633911115;4642.35007099006;4657.743824089674;4482.843100491484;4541.545845415465;4557.202489564322;4557.430321209848;4559.566841150086;4186.162767446515;4191.55988621195;4217.15656868626;4272.786360681969;4287.271163902128;4293.2701440755145;4297.59172878576;4302.548232435596;4306.5262821089655;4316.913661726763;58.11174921128385;4345.717528360662;4347.391365208858;4363.105563359503;4387.692861499696;4175.519815221258;4229.386738922839;4232.9365059523825;4316.417283666728;4323.502797178333;4247.532771395144;4275.893102672427;4290.077633308822;4290.141971605692;4319.913601727979;4458;4594.1271158479785;4652.278896771006;4684.765761711935;4713.505081966378;4739.9526004739855;4825.565699087099;4838.588719958808;4877.756112194376;4941.45643979162;4879.707217566957;4887.853364399074;4896.265560165968;4903.65674402792;4952.504749525055;4616.8614941551805;4628.560286772751;4630.83792067276;4631.6294696424875;4678.274867395559;4834.854954351375;4893.7063776173545;4893.779779909913;4934.901301974012;4945.431275403303;4675.812967481263;4727.598154156866;4728.929066064012;4739.336492890998;4741.288806679026;4770.809167633325;4802.943352462453;4818.301346304766;4829.492903245108;4839.128956787742;4781.976090119597;4786.856394308176;4800.591949684316;4801.567858892717;4877.585405240523;4783.162946484351;4810.8797280068275;4816.95183048172;4835.081334546425;4876.683015603974;4104.979475102665;4155.97922010388;4158.293090174617;4160.750354978711;4172.645325147397;3656.3784156693428;3669.4679271505483;3693.759905606127;3720.311742327678;3732.794696291676;4226.281532139544;4233.449651545341;4233.597808208216;4233.767142807175;4237.131388065439;4706.3411122442885;4816.710997340171;4903.264510323409;4921.606271498272;4959.429665588504;4177.644900183458;4189.455370801777;4214.578542145761;4237.512686041083;4258.212230737324;4442.178197033559;4458.264386376211;4458.665600080007;4460.977695111504;4501.864944051684;4560.452745670408;4591.311303304531;4593;4595.655325850575;4639.628829693616;4759.048190361872;4791.832285869978;4899.069176856386;4937.136001199848;4957.578605818401;4609.746463944515;4615.515370886009;4624.791884365144;4650.116477869194;4655.20861453547;4851.51484851512;4897.2654101885;4909.410870695539;4917.877053073702;4958.603311734981;4728.101660684459;4778.546038126373;4865.1242776300605;4906.043321552405;4961.03259864323;4706.105839890547;4722.645801564828;4738;4760.143174228672;4773.904521909473;4567.680262381734;4573.131105090022;4584.9312260315455;4709.599684026896;4776.761161941819;4525.298578720303;4557.1797076526545;4559.726416415026;4569.771511424482;4584.289435137559;4606.585407313358;4642.53574642533;4654.371659826015;4663.860084197479;4696.1546921554445;4506.616937560213;4560.6351491879905;4568.223402021597;4604.792784324646;4605.125026245003 05:12:36 INFO - PROCESS | 6115 | |1;ext.html;523.3222976245761;544.9918251226233;552.4227182594186;569.220168369334;570.9400512946138;40455;42916.3562546562;42925.35611965823;46601.30098048532;46812;42262.36606450906;42489.57510424895;42730.78634606831;42834.7858260709;42896.356554651706;7837.098733645633;8005.239502247277;8010.39922005849;9669.854952175723;10000.59997600095;9760;9870.753231169207;9892.455914924676;9894.208463322917;9932.503374831265;9939.055789699967;9984.154515962951;9987.40075595463;9991.250656200815;9995.75010624733;9899.356541824794;9908.355956862853;9945.950270248602;9965.800683986352;9985.550650220757;9801.411915285034;9859.288695608693;9880.555375008142;9880.65417710384;9893.851592226123;35505.28989420223;35908;35952.64047359519;35968.46047309293;36037;3418.2138108235245;3507.4914137450182;3572.2319701264355;3615.258871931248;3618.294432585647;24539.87730061356;25886.87056564724;26162.73837261641;26188.60717089245;26209.73790262092;3264.5266436366833;3380.2732412531423;3431.4681224410256;3527.2416430467574;3545.06055895188;223356;225512;225605;226219;226423;48170.759146204044;48228.758856206194;48375.75812120917;48482.75758621185;48790.75604622025;49113;49353;49393;49438.25842612363;49465.50534494681;13337.599872003855;13615.455381784617;13624.386902589407;13627;13717.382717777724;9092.227160691284;9370.531473426301;10354.17166626668;10599.894001060045;10601.310914790514;18784.154713037948;19662.657348250832;19933.103010364568;19950.50123746918;19958.900205498878;7417.295356941082;7513.737019204302;7735;7816.335611472975;7885.921140788519;798.4809873582218;801.4470015689155;826.3554427546524;828.5401602110886;843.3843294395126;28105.43789124206;28384.716152838206;28404;28505.857470712515;28940.5529723513;957.4446820843893;957.7988622389237;968.5496244246318;991.2070343724992;992.6972273456665;14696.265186740835;15339.769903451457;15530.223488825739;15643.530694078969;15691.686166276611;358202;359325;359735;361900;363219;51550;52003.219951700754;52132.739336303835;52222.21666675003;52268.73865630647;1216.087934049463;1253.0977696058824;1254.8682388349275;1264.7027948432112;1265.3483456020158;26133.73866261313;27098.45803083967;27721;27789.44421111526;28052.29869253285;44435.55564444314;44917;44926.101477970915;45040.324395134754;45068;296500;297923;298755;299476;300740;24127.879360603787;24690.382740431633;24784.132555360477;38116;38911.80544097262;36760.26479470342;37152.44271335986;37894.24211515809;38094;38210.42684359681;31829.363412731152;32006.03981880547;32217.838910805294;32354;32706.509402358508;32041.198970025936;32331.838340808146;32545.186370340933;33579;33726.49410258897;31179.064628061195;31632.051038468882;32081.518777217894;32174;32373;26650.733492664825;28993.7100628991;29025.419491609628;29150.854245728635;29173.85413072921;22468.10127594878;22500.662490062336;22737.431564210365;22794.31617051491;22915.88542057279 05:12:36 INFO - PROCESS | 6115 | |2;jquery.html;380.68783597450084;386.9187470631167;393.6063936063936;396.1265409771454;415.1199457150839;13951.162930224194;16844.915775421123;16911.323547058135;18502.62994740106;18503.444896653105;18058.27766889326;18262.269509219648;18386.264549418007;18386.448406547825;18708.81291187088;5192.299039629639;5218.530332270095;5294.761735721882;5339.786408543654;5452.809151679692;5277.551408130314;5347.732613369316;5357.249985002103;5377.354717433914;5381.838544843661;5177.404598471167;5294.655847369928;5305.0450918834595;5320.893582128355;5322.840314790543;5180.326557547513;5270.262163297141;5298.682079075268;5304.230886521472;5309.62832601718;4589.33454649074;4711.835085772016;4725.64557658177;4752.358431611723;4758.524147585248;22394.44013899649;22777.31668049961;22855.31434056981;22906;23036.769632303796;1880.962380752391;1889.3765057531118;1898.8670793044491;1916.8179022992792;1957.8140076692835;9964.601415943354;10260.897391026068;12070.577529786504;13197.406116724675;14703.19132447715;1537.9923100384426;1565.1235308227429;1581.7706432567213;1593.7689035089847;1624.0093542938798;83927.58036209841;84893;85228;85495.99999999937;87499.56250218708;10596.470176491144;10755.83866242007;10979.341239525655;11069.391183484824;11103.72240693989;12054.216475929037;15576.922115389578;15595.610109747347;15597.376104955674;15611.3755449783;7013;7162.588310069161;7337.70649174027;7393.48245622812;7394.889076663854;6953.304669533108;6980.197277313174;7136.393406560397;7136.464765142635;7137.357637812518;3879.650831425185;4034.536028356718;4038.414429907647;4137.482814648169;4138.296489596776;1904.8285654290903;1945.737325461073;1970.6945423459388;1973.605278944217;1979.7327360806107;797.6051854332027;820.4953953318666;821.8109834737924;822.925936665691;841.427829076234;17481.388151414638;17749.7337539937;18300.725489117674;18470.630587388445;18780.154893029845;817.852786498436;819.8114433680167;820.5281962871372;823.5635113389793;838.6854929401475;10052.994700529889;10131.13885319756;10365.9481702591;10405.84391234132;10409.635662751767;494882;499529;500552;503530;509543;69515.65242173757;79639.20360796318;91927.54036229776;92043;94906;871.834351473218;885.9512726800087;890.5992303463338;896.3725392225338;897.7620930453435;15530.1458419788;15722.685546289238;15804.446844360393;16017.67964640724;16068.758968615246;33789.3242135151;39962.40056399098;39992;41095.589044109176;42349.78825105855;54487.45512544982;54748.72625636846;54821;55156.44843551513;55973.44026559682;6544.149260596092;7533.472656913963;7796.415268854745;7963.80090497719;8052.074011488754;9190.49452280131;12233.632991010283;12329.876701232874;12396.690082748004;12560.748785024065;10278.691639250834;10437.947810260901;10477.63328283537;10668.253222274367;10927.92369449802;6679.4990375721045;10231.846522302023;10320.948395257976;10652.733681658021;10940;10527.105196058421;10700.892991070301;10867.945660271647;10959.397233151934;11213.66359009231;7608.581528015791;7621.047369078865;7759.883601746092;8019.117897031439;8260.256576908107;8703.738887833375;10672.946635267084;10684.358938463716;10964.671059868217;11018.889811101786 05:12:36 INFO - PROCESS | 6115 | |3;mootools.html;1281.7436512697464;1305.8302420685309;1309.1948451702203;1313.888319492843;1324.6489680234736;6231.470325022378;6448.258450278219;6479.481641468683;6808.421284190844;6824.249332573413;6667.166604174478;6953.165620125579;6985.371316581507;7104;7149.034880291159;2043.3563427520357;2075.740532433446;2079.334612923865;2083.4583008417767;2085.061722225005;2069.213698794456;2096.1824888293577;2108.9156433742633;2109.673000684889;2190.4414374334524;2126.36209137259;2138.625740495415;2142.9035693393835;2144.4210063282903;2151.591197672445;2017.767956684978;2035.307995281604;2042.693595960603;2043.632146213681;2045.7238272833126;2057.310800881706;2074.408793493847;2145.3778404262744;2147.3987283560627;2149.247763282854;6929.480288978347;6993.405560527362;7038.331358520933;7044.189918159426;7051.224365319811;4217.451731274945;4332.025294308755;4332.155229730204;4332.566743325674;4341.956580434186;2414.4567472318763;2720.986395068012;2746.9725302746915;2778.902738404146;2793.9301517462022;1081.0756802933536;1093.6609651008134;1117.793208256475;1127.2053202492223;1192.9642110736693;9190.632374705005;9266.721998339994;9297.535123243812;9321.254299656011;9356.953215233949;3678.6505281998166;3859.9035024124623;3908.550516690617;3919.627635374635;3940.5074365704286;7317.670704818296;7340.9632951835965;7344.045274114331;7359.558426494427;7371.299726525972;4334.306510958231;4392.428984232093;4399.802008909607;4434.068845542408;4437.156940181355;3892.3577609694084;3997.7801220932547;4029.3351596986167;4053.5135783705555;4058.512978442606;3185.904422867318;3212.5181222816764;3287.852046657906;3294.901152965415;3295.3903527847424;1047.4239168457318;1053.2942928237946;1058.402002868377;1066.4347895615335;1072.3512275073624;820.667629609997;836.60679480644;842.8567143585606;858.5621333120154;863.749512641327;4737.086691684589;4771.997880445076;4823.131836269506;4838.129136755418;4901.068796928572;896.852019416789;906.7823722306599;917.1699611851285;924.6578765856676;930.5812384427035;3203.1511649412923;3300.174956260935;3351.949720754191;3355.5906519261966;3399.6770306820813;8069.072056713436;8096.473729207582;8305.667773289;8382.580870956428;8397.496150231005;8142.226488483585;8144.348452123816;8201.261886430131;8392.538410387488;8395.412321137585;6412.551121421456;6529.477641788645;6554.344565543408;6582.506312026521;6588.703508342041;4772.809087636595;4799.880002999953;4849.054434385261;4861.392325959255;4897.2654101885;7423.591702456417;7520.774376768706;7693.49992250502;7755.681534139323;7774.183710710294;7614.428917831074;7625.694972201271;7679.424043196671;7685.423593230418;7709.653065612173;5863.237779088691;5894.793682221101;5930.080837470199;5938.079597662369;5940.376260492586;6497.18785151856;6518.967405162944;6558;6587.703553340016;6594.109795177781;5973.581849270509;6060.636361818305;6111.786087486917;6152.569320147547;6197.659128747962;6027.728752206073;6040.335563088145;6059.697015149137;6095.3904609538695;6097.664628445478;5414.783408663767;5567.832965011056;5569.470900264469;5570.275864137636;5570.888582228414;4279.122779830065;4281.1437712458255;4329.891752706208;4390.692651514363;4465.732056076646;4217.219814334358;4364.563543645737;4419.491758447691;4472.888177795451;4539.432570928634 05:12:36 INFO - PROCESS | 6115 | |4;prototype.html;354.16063928489484;362.7406404420839;367.6323676323676;367.93009328227635;372.52131011650033;4856.320115183873;4916.213405855064;4939.506049395059;4959.256111583264;4965.776540055697;4798.736069516175;4878.975605121969;4899.093667671475;4905.730184839832;4922.6800257983205;3946.4869566956254;3980.4476254260862;3984.1434091670358;3990.361542153256;3994.760314381132;3956.960430395688;3966.254847866929;3971.5631280559114;3985.302572049894;3986.720929534934;3955.5055618047745;3965.504311961005;3970.7419017763896;3972.5828787977134;3991.940120898189;3869.32286849803;3924.8822535323984;3925;3966.801659917007;3966.900827479322;3549.4853246279404;3559.430491121408;3569.321828852536;3582.4564559163027;3592.6227746086547;4829.3721816164025;4834.776003038606;4842.41890973082;4842.878928026792;4851.345068415754;4348.956510434887;4531.77341132942;4532.274836026253;4534.9319760203625;4564.543545645409;5067;5126.641135120543;5128.948710512885;5133.794648214067;5158.200478925773;3912.1979994101425;3917.8628747993966;3929.1748732766155;3956.4065390191413;3961.7424867383816;5218;5329.573634109262;5384.542313903323;5408.215808707794;5409.83770486886;3726.273376691519;3730.4446454178974;3755.2301778135416;3765.5669597996034;3769.6230376962635;3802.942955855609;3813.466114743938;3821.464994900716;3821.7515861468914;3852.9807350963624;4334.306510958231;4377.956220437755;4378.605925466723;4379.189849877783;4407.867763967086;5071;5149.742512874342;5166.457521960216;5188.195829646411;5236.659617124875;1262.501311981762;1277.96484847274;1284.8715128487077;1286.70685960609;1291.8837304642627;837.874318852177;882.4440602420434;884.6947803007952;895.4269267668698;906.977325566866;4327.913441731211;4337.284348082531;4346.217680817484;4360.520342762294;4386.363977223285;5166.380034395821;5180.4560521145495;5182.922256166161;5190.6107041972;5233.581313494911;4210.831421817767;4318.870433886988;4370.950971766753;4390.53899340571;4393.582609652078;2721.924839688312;2736.5758307462374;2739.602757600137;2745.409736906575;2769.7645700115313;4698.530146985274;4756.8097276108565;4771.880702982453;4779.518349311725;4781.708938586632;4983.300328082096;5263.157894736812;5274.472552744694;5282.996230716229;5287.836675931289;4775.594074503706;4780.976095119641;4789.658895509263;4793.49668284832;4799.472058073609;5045.1927691570645;5132.769025393941;5160.400275914479;5173.689578625294;5196.2465442509865;4922.581580565692;5087.414947280962;5129.384473863161;5137.51193636604;5238.37139543242;4795.9280610790165;4921.237208232729;4937.21004639256;4939.259111133215;4940.912999140183;3748.981255093707;3797.2785170817456;3798.582155962897;3809.3904975203836;3847.3459511883607;5327.786888524415;5337.492938170868;5363.704996225245;5369.19462080691;5369.731513424391;4839.249916262985;5011.749412529286;5105.2086926526445;5123.103456895103;5128.974055248082;5027.49725027509;5053.84838454847;5082.322833464874;5101.245327523245;5140.897182056263;5005.524475174852;5021.593953692972;5023.57299629521;5032.245163225399;5036.597072234139;4978.228374601942;5040.747962601782;5096.872578185426;5118.38579370478;5128.589712822891;4969.577076401933;4994.6503744738975;4996.225585034325;5000.874978125576;5051.772670229922 05:12:36 INFO - PROCESS | 6115 | |5;yui.html;669.2237005074115;687.7455341523637;732.8570928668909;758.1470845299039;774.2683164409633;12417.875821241785;13398.531051413203;13426.328683565807;13440.059195856269;13500.054996150273;12762.489500419995;12840;12852.48590056399;12860.356982150903;12877.549285774976;649.7855707616487;667.1527160506155;783.4868161354322;810.8864758933724;819.778659761864;820.6471217376526;822.4037572759731;829.672279449617;830.0578843013163;831.8377916306292;872.9869051964225;873.5806812729893;879.0462348352046;879.8196369744187;880.2649787427474;863.4560227056913;868.8175483148547;871.1593312453481;872.6116877989298;873.2882700598991;629.7229219143562;634.9428551430348;635.3836778325017;635.6885126288132;638.5657752728143;12804.935975320064;13296.26870522121;14239.216843073627;14263.072900261554;14296.285185740775;13611.863881361258;14484.493042743454;14546.345414456375;14631.122132671968;14785.852141478555;10692.786144277148;10726.141908647289;10826.512806923707;10840.728981775439;10899.073578745816;3310.304835984422;3333.283344081034;3352.430086885211;3409.6419875913166;3478.930421391558;65039.99999999953;65915.3408465914;66441.335586644;66868.66565667189;67871;10961.342319460859;10972;11215.71960700989;11254.268472549258;11260.217030716054;21132.577348452945;21418.57162856734;21538.78461215368;21611.567768644854;21652.566948660937;6733.494987875831;6737.523518285886;6766.120404347502;6787.728490860409;6854;3431.725461963037;3566.1159286179827;3575.3743094958277;3585.1754096557415;3599.1182160370354;2890.3930174663137;3081.3221091359865;3214.244652506659;3222.3233121044373;3246.561714168557;539.1750621549036;544.6813614035755;544.8801263721975;556.2379540030104;560.5263552298302;567.29088639201;587.1105275507609;602.4908951935607;619.7118339971845;620.9223847019123;9035.683751068813;9098.272138228926;9155.908440915638;9224.769380765534;9236.214921731593;529.4678847758056;543.7770514089204;554.2655980825423;556.0685851199225;562.8733534954685;4202.201581699467;4229.281022226229;4472.977635111869;4491.348754430589;4495.527969563149;66298;68089;68099.65950170218;68126.65936670384;69344.6532767343;47118.5288147121;56830.715846420506;59442.999999999134;59975;60326;39288.6071139285;39560.802195988836;44327;44347.33478997753;44980.77509612431;9180.357374983687;9901.108900199017;9934.751631208988;9935.155511781579;9951.502424878872;30652.84673576618;34388.65611343855;35254.82372588121;35463.290734185684;36530.26939461249;40727.389089163094;41926.58073419227;44295.335569965835;44586;45326.54673453355;11377.203595748219;11385.665938482756;11393.544258229578;11666.88333116658;11915.523379065087;12981.610551683465;13143.277119758122;13351.532696355582;13452;13984.497208797959;10631.468426578795;10919.727006824574;11037.779244415227;11072;11335.886641133813;11612;11909.880901191224;12004.738317897021;12151.453184606891;12441.813372799596;11302.49835240558;11855.170138090596;11959.043276537683;11983.460744266355;12324.81512777327;9927.40435573868;10457.477126143815;10474.633387831389;10500.632477863239;10671.46642667848;8303.294219991369;8419.40252601916;9673.951630241803;9953;10030.699079027641 05:12:36 INFO - PROCESS | 6115 | __end_tp_report 05:12:36 INFO - PROCESS | 6115 | __start_cc_report 05:12:36 INFO - PROCESS | 6115 | _x_x_mozilla_cycle_collect,343 05:12:36 INFO - PROCESS | 6115 | __end_cc_report 05:12:36 INFO - PROCESS | 6115 | __startTimestamp1485954756645__endTimestamp 05:12:36 INFO - PROCESS | 6115 | 05:12:36 INFO - PROCESS | 6115 | ------- Summary: start ------- 05:12:36 INFO - PROCESS | 6115 | Number of tests: 6 05:12:36 INFO - PROCESS | 6115 | 05:12:36 INFO - PROCESS | 6115 | [#0] dojo.html Cycles:165 Average:4483.90 Median:4615.52 stddev:565.68 (12.3%) stddev-sans-first:545.58 05:12:36 INFO - PROCESS | 6115 | Values: 2499.4 2537.8 2555.8 2566.9 2580.9 4464.4 4594.8 4621.6 4642.4 4657.7 4482.8 4541.5 4557.2 4557.4 4559.6 4186.2 4191.6 4217.2 4272.8 4287.3 4293.3 4297.6 4302.5 4306.5 4316.9 58.1 4345.7 4347.4 4363.1 4387.7 4175.5 4229.4 4232.9 4316.4 4323.5 4247.5 4275.9 4290.1 4290.1 4319.9 4458.0 4594.1 4652.3 4684.8 4713.5 4740.0 4825.6 4838.6 4877.8 4941.5 4879.7 4887.9 4896.3 4903.7 4952.5 4616.9 4628.6 4630.8 4631.6 4678.3 4834.9 4893.7 4893.8 4934.9 4945.4 4675.8 4727.6 4728.9 4739.3 4741.3 4770.8 4802.9 4818.3 4829.5 4839.1 4782.0 4786.9 4800.6 4801.6 4877.6 4783.2 4810.9 4817.0 4835.1 4876.7 4105.0 4156.0 4158.3 4160.8 4172.6 3656.4 3669.5 3693.8 3720.3 3732.8 4226.3 4233.4 4233.6 4233.8 4237.1 4706.3 4816.7 4903.3 4921.6 4959.4 4177.6 4189.5 4214.6 4237.5 4258.2 4442.2 4458.3 4458.7 4461.0 4501.9 4560.5 4591.3 4593.0 4595.7 4639.6 4759.0 4791.8 4899.1 4937.1 4957.6 4609.7 4615.5 4624.8 4650.1 4655.2 4851.5 4897.3 4909.4 4917.9 4958.6 4728.1 4778.5 4865.1 4906.0 4961.0 4706.1 4722.6 4738.0 4760.1 4773.9 4567.7 4573.1 4584.9 4709.6 4776.8 4525.3 4557.2 4559.7 4569.8 4584.3 4606.6 4642.5 4654.4 4663.9 4696.2 4506.6 4560.6 4568.2 4604.8 4605.1 05:12:36 INFO - PROCESS | 6115 | 05:12:36 INFO - PROCESS | 6115 | [#1] ext.html Cycles:180 Average:45126.47 Median:197851.73 stddev:78700.31 (39.8%) stddev-sans-first:78849.83 05:12:36 INFO - PROCESS | 6115 | Values: 523.3 545.0 552.4 569.2 570.9 40455.0 42916.4 42925.4 46601.3 46812.0 42262.4 42489.6 42730.8 42834.8 42896.4 7837.1 8005.2 8010.4 9669.9 10000.6 9760.0 9870.8 9892.5 9894.2 9932.5 9939.1 9984.2 9987.4 9991.3 9995.8 9899.4 9908.4 9946.0 9965.8 9985.6 9801.4 9859.3 9880.6 9880.7 9893.9 35505.3 35908.0 35952.6 35968.5 36037.0 3418.2 3507.5 3572.2 3615.3 3618.3 24539.9 25886.9 26162.7 26188.6 26209.7 3264.5 3380.3 3431.5 3527.2 3545.1 223356.0 225512.0 225605.0 226219.0 226423.0 48170.8 48228.8 48375.8 48482.8 48790.8 49113.0 49353.0 49393.0 49438.3 49465.5 13337.6 13615.5 13624.4 13627.0 13717.4 9092.2 9370.5 10354.2 10599.9 10601.3 18784.2 19662.7 19933.1 19950.5 19958.9 7417.3 7513.7 7735.0 7816.3 7885.9 798.5 801.4 826.4 828.5 843.4 28105.4 28384.7 28404.0 28505.9 28940.6 957.4 957.8 968.5 991.2 992.7 14696.3 15339.8 15530.2 15643.5 15691.7 358202.0 359325.0 359735.0 361900.0 363219.0 51550.0 52003.2 52132.7 52222.2 52268.7 1216.1 1253.1 1254.9 1264.7 1265.3 26133.7 27098.5 27721.0 27789.4 28052.3 44435.6 44917.0 44926.1 45040.3 45068.0 296500.0 297923.0 298755.0 299476.0 300740.0 24127.9 24690.4 24784.1 38116.0 38911.8 36760.3 37152.4 37894.2 38094.0 38210.4 31829.4 32006.0 32217.8 32354.0 32706.5 32041.2 32331.8 32545.2 33579.0 33726.5 31179.1 31632.1 32081.5 32174.0 32373.0 26650.7 28993.7 29025.4 29150.9 29173.9 22468.1 22500.7 22737.4 22794.3 22915.9 05:12:36 INFO - PROCESS | 6115 | 05:12:36 INFO - PROCESS | 6115 | [#2] jquery.html Cycles:180 Average:28574.99 Median:22567.00 stddev:82697.71 (366.5%) stddev-sans-first:82902.61 05:12:36 INFO - PROCESS | 6115 | Values: 380.7 386.9 393.6 396.1 415.1 13951.2 16844.9 16911.3 18502.6 18503.4 18058.3 18262.3 18386.3 18386.4 18708.8 5192.3 5218.5 5294.8 5339.8 5452.8 5277.6 5347.7 5357.2 5377.4 5381.8 5177.4 5294.7 5305.0 5320.9 5322.8 5180.3 5270.3 5298.7 5304.2 5309.6 4589.3 4711.8 4725.6 4752.4 4758.5 22394.4 22777.3 22855.3 22906.0 23036.8 1881.0 1889.4 1898.9 1916.8 1957.8 9964.6 10260.9 12070.6 13197.4 14703.2 1538.0 1565.1 1581.8 1593.8 1624.0 83927.6 84893.0 85228.0 85496.0 87499.6 10596.5 10755.8 10979.3 11069.4 11103.7 12054.2 15576.9 15595.6 15597.4 15611.4 7013.0 7162.6 7337.7 7393.5 7394.9 6953.3 6980.2 7136.4 7136.5 7137.4 3879.7 4034.5 4038.4 4137.5 4138.3 1904.8 1945.7 1970.7 1973.6 1979.7 797.6 820.5 821.8 822.9 841.4 17481.4 17749.7 18300.7 18470.6 18780.2 817.9 819.8 820.5 823.6 838.7 10053.0 10131.1 10365.9 10405.8 10409.6 494882.0 499529.0 500552.0 503530.0 509543.0 69515.7 79639.2 91927.5 92043.0 94906.0 871.8 886.0 890.6 896.4 897.8 15530.1 15722.7 15804.4 16017.7 16068.8 33789.3 39962.4 39992.0 41095.6 42349.8 54487.5 54748.7 54821.0 55156.4 55973.4 6544.1 7533.5 7796.4 7963.8 8052.1 9190.5 12233.6 12329.9 12396.7 12560.7 10278.7 10437.9 10477.6 10668.3 10927.9 6679.5 10231.8 10320.9 10652.7 10940.0 10527.1 10700.9 10867.9 10959.4 11213.7 7608.6 7621.0 7759.9 8019.1 8260.3 8703.7 10672.9 10684.4 10964.7 11018.9 05:12:36 INFO - PROCESS | 6115 | 05:12:36 INFO - PROCESS | 6115 | [#3] mootools.html Cycles:180 Average:4601.55 Median:4843.59 stddev:2408.30 (49.7%) stddev-sans-first:2402.13 05:12:36 INFO - PROCESS | 6115 | Values: 1281.7 1305.8 1309.2 1313.9 1324.6 6231.5 6448.3 6479.5 6808.4 6824.2 6667.2 6953.2 6985.4 7104.0 7149.0 2043.4 2075.7 2079.3 2083.5 2085.1 2069.2 2096.2 2108.9 2109.7 2190.4 2126.4 2138.6 2142.9 2144.4 2151.6 2017.8 2035.3 2042.7 2043.6 2045.7 2057.3 2074.4 2145.4 2147.4 2149.2 6929.5 6993.4 7038.3 7044.2 7051.2 4217.5 4332.0 4332.2 4332.6 4342.0 2414.5 2721.0 2747.0 2778.9 2793.9 1081.1 1093.7 1117.8 1127.2 1193.0 9190.6 9266.7 9297.5 9321.3 9357.0 3678.7 3859.9 3908.6 3919.6 3940.5 7317.7 7341.0 7344.0 7359.6 7371.3 4334.3 4392.4 4399.8 4434.1 4437.2 3892.4 3997.8 4029.3 4053.5 4058.5 3185.9 3212.5 3287.9 3294.9 3295.4 1047.4 1053.3 1058.4 1066.4 1072.4 820.7 836.6 842.9 858.6 863.7 4737.1 4772.0 4823.1 4838.1 4901.1 896.9 906.8 917.2 924.7 930.6 3203.2 3300.2 3351.9 3355.6 3399.7 8069.1 8096.5 8305.7 8382.6 8397.5 8142.2 8144.3 8201.3 8392.5 8395.4 6412.6 6529.5 6554.3 6582.5 6588.7 4772.8 4799.9 4849.1 4861.4 4897.3 7423.6 7520.8 7693.5 7755.7 7774.2 7614.4 7625.7 7679.4 7685.4 7709.7 5863.2 5894.8 5930.1 5938.1 5940.4 6497.2 6519.0 6558.0 6587.7 6594.1 5973.6 6060.6 6111.8 6152.6 6197.7 6027.7 6040.3 6059.7 6095.4 6097.7 5414.8 5567.8 5569.5 5570.3 5570.9 4279.1 4281.1 4329.9 4390.7 4465.7 4217.2 4364.6 4419.5 4472.9 4539.4 05:12:36 INFO - PROCESS | 6115 | 05:12:36 INFO - PROCESS | 6115 | [#4] prototype.html Cycles:180 Average:4264.87 Median:4799.10 stddev:1204.44 (25.1%) stddev-sans-first:1171.50 05:12:36 INFO - PROCESS | 6115 | Values: 354.2 362.7 367.6 367.9 372.5 4856.3 4916.2 4939.5 4959.3 4965.8 4798.7 4879.0 4899.1 4905.7 4922.7 3946.5 3980.4 3984.1 3990.4 3994.8 3957.0 3966.3 3971.6 3985.3 3986.7 3955.5 3965.5 3970.7 3972.6 3991.9 3869.3 3924.9 3925.0 3966.8 3966.9 3549.5 3559.4 3569.3 3582.5 3592.6 4829.4 4834.8 4842.4 4842.9 4851.3 4349.0 4531.8 4532.3 4534.9 4564.5 5067.0 5126.6 5128.9 5133.8 5158.2 3912.2 3917.9 3929.2 3956.4 3961.7 5218.0 5329.6 5384.5 5408.2 5409.8 3726.3 3730.4 3755.2 3765.6 3769.6 3802.9 3813.5 3821.5 3821.8 3853.0 4334.3 4378.0 4378.6 4379.2 4407.9 5071.0 5149.7 5166.5 5188.2 5236.7 1262.5 1278.0 1284.9 1286.7 1291.9 837.9 882.4 884.7 895.4 907.0 4327.9 4337.3 4346.2 4360.5 4386.4 5166.4 5180.5 5182.9 5190.6 5233.6 4210.8 4318.9 4371.0 4390.5 4393.6 2721.9 2736.6 2739.6 2745.4 2769.8 4698.5 4756.8 4771.9 4779.5 4781.7 4983.3 5263.2 5274.5 5283.0 5287.8 4775.6 4781.0 4789.7 4793.5 4799.5 5045.2 5132.8 5160.4 5173.7 5196.2 4922.6 5087.4 5129.4 5137.5 5238.4 4795.9 4921.2 4937.2 4939.3 4940.9 3749.0 3797.3 3798.6 3809.4 3847.3 5327.8 5337.5 5363.7 5369.2 5369.7 4839.2 5011.7 5105.2 5123.1 5129.0 5027.5 5053.8 5082.3 5101.2 5140.9 5005.5 5021.6 5023.6 5032.2 5036.6 4978.2 5040.7 5096.9 5118.4 5128.6 4969.6 4994.7 4996.2 5000.9 5051.8 05:12:36 INFO - PROCESS | 6115 | 05:12:36 INFO - PROCESS | 6115 | [#5] yui.html Cycles:180 Average:14866.64 Median:24262.31 stddev:18194.00 (75.0%) stddev-sans-first:18213.80 05:12:36 INFO - PROCESS | 6115 | Values: 669.2 687.7 732.9 758.1 774.3 12417.9 13398.5 13426.3 13440.1 13500.1 12762.5 12840.0 12852.5 12860.4 12877.5 649.8 667.2 783.5 810.9 819.8 820.6 822.4 829.7 830.1 831.8 873.0 873.6 879.0 879.8 880.3 863.5 868.8 871.2 872.6 873.3 629.7 634.9 635.4 635.7 638.6 12804.9 13296.3 14239.2 14263.1 14296.3 13611.9 14484.5 14546.3 14631.1 14785.9 10692.8 10726.1 10826.5 10840.7 10899.1 3310.3 3333.3 3352.4 3409.6 3478.9 65040.0 65915.3 66441.3 66868.7 67871.0 10961.3 10972.0 11215.7 11254.3 11260.2 21132.6 21418.6 21538.8 21611.6 21652.6 6733.5 6737.5 6766.1 6787.7 6854.0 3431.7 3566.1 3575.4 3585.2 3599.1 2890.4 3081.3 3214.2 3222.3 3246.6 539.2 544.7 544.9 556.2 560.5 567.3 587.1 602.5 619.7 620.9 9035.7 9098.3 9155.9 9224.8 9236.2 529.5 543.8 554.3 556.1 562.9 4202.2 4229.3 4473.0 4491.3 4495.5 66298.0 68089.0 68099.7 68126.7 69344.7 47118.5 56830.7 59443.0 59975.0 60326.0 39288.6 39560.8 44327.0 44347.3 44980.8 9180.4 9901.1 9934.8 9935.2 9951.5 30652.8 34388.7 35254.8 35463.3 36530.3 40727.4 41926.6 44295.3 44586.0 45326.5 11377.2 11385.7 11393.5 11666.9 11915.5 12981.6 13143.3 13351.5 13452.0 13984.5 10631.5 10919.7 11037.8 11072.0 11335.9 11612.0 11909.9 12004.7 12151.5 12441.8 11302.5 11855.2 11959.0 11983.5 12324.8 9927.4 10457.5 10474.6 10500.6 10671.5 8303.3 8419.4 9674.0 9953.0 10030.7 05:12:36 INFO - PROCESS | 6115 | -------- Summary: end -------- 05:12:36 INFO - PROCESS | 6115 | 05:12:37 INFO - TEST-INFO | 6115: exit 0 05:12:37 INFO - TEST-OK | dromaeo_css | took 1118246ms 05:12:37 INFO - TEST-START | kraken 05:12:37 INFO - operating with platform_type : linux_ 05:12:37 INFO - Initialising browser for kraken test... 05:12:37 INFO - TEST-INFO | started process 6467 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpMLeC8k/profile http://localhost:60727/getInfo.html) 05:12:41 INFO - PROCESS | 6467 | JavaScript error: chrome://webcompat/content/lib/ua_overrider.jsm, line 109: NS_ERROR_INSUFFICIENT_DOMAIN_LEVELS: Component returned failure code: 0x804b0050 (NS_ERROR_INSUFFICIENT_DOMAIN_LEVELS) [nsIEffectiveTLDService.getBaseDomain] 05:12:41 INFO - PROCESS | 6467 | __metrics Screen width/height:1600/1200 05:12:41 INFO - PROCESS | 6467 | colorDepth:24 05:12:41 INFO - PROCESS | 6467 | Browser inner width/height: 1024/697 05:12:41 INFO - PROCESS | 6467 | __metrics 05:12:42 INFO - PROCESS | 6467 | 1485954762489 addons.xpi WARN Exception running bootstrap method shutdown on shield-recipe-client@mozilla.org: ReferenceError: LogManager is not defined (resource://gre/modules/addons/XPIProvider.jsm -> jar:file:///builds/slave/test/build/application/firefox/browser/features/shield-recipe-client@mozilla.org.xpi!/bootstrap.js:65:3) JS Stack trace: this.shutdown@resource://gre/modules/addons/XPIProvider.jsm -> jar:file:///builds/slave/test/build/application/firefox/browser/features/shield-recipe-client@bootstrap.js:65:3 < callBootstrapMethod@XPIProvider.jsm:4903:11 < observe@XPIProvider.jsm:2884:15 < permitUnload@remote-browser.xml:353:13 < CanCloseWindow@browser.js:6274:36 < canClose@browser.js:5140:12 < forceQuit@jar:file:///tmp/tmpMLeC8k/profile/extensions/talos-powers@TalosPowersService.js:238:7 < whenDone@jar:file:///tmp/tmpMLeC8k/profile/extensions/talos-powers@TalosPowersService.js:223:9 < promise callback*forceQuit@jar:file:///tmp/tmpMLeC8k/profile/extensions/talos-powers@TalosPowersService.js:225:7 < receiveMessage@jar:file:///tmp/tmpMLeC8k/profile/extensions/talos-powers@TalosPowersService.js:55:9 05:12:42 ERROR - PROCESS | 6467 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3284: TypeError: this.tabs is undefined 05:12:43 INFO - TEST-INFO | 6467: exit 0 05:12:43 INFO - Browser initialized. 05:12:43 INFO - Running cycle 1/1 for kraken test... 05:12:43 INFO - TEST-INFO | started process 6583 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpMLeC8k/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 05:12:55 INFO - PROCESS | 6583 | RSS: Main: 159633408 05:12:55 INFO - PROCESS | 6583 | 05:12:58 INFO - PROCESS | 6583 | Cycle 1(1): loaded http://localhost:60727/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:60727/tests/kraken/driver.html?testName=audio-beat-detection) 05:12:59 INFO - PROCESS | 6583 | RSS: Main: 166727680 05:12:59 INFO - PROCESS | 6583 | 05:13:02 INFO - PROCESS | 6583 | Cycle 1(1): loaded http://localhost:60727/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:60727/tests/kraken/driver.html?testName=audio-dft) 05:13:02 INFO - PROCESS | 6583 | RSS: Main: 164773888 05:13:02 INFO - PROCESS | 6583 | 05:13:05 INFO - PROCESS | 6583 | Cycle 1(1): loaded http://localhost:60727/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:60727/tests/kraken/driver.html?testName=audio-fft) 05:13:06 INFO - PROCESS | 6583 | RSS: Main: 161525760 05:13:06 INFO - PROCESS | 6583 | 05:13:08 INFO - PROCESS | 6583 | Cycle 1(1): loaded http://localhost:60727/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:60727/tests/kraken/driver.html?testName=audio-oscillator) 05:13:09 INFO - PROCESS | 6583 | RSS: Main: 162709504 05:13:09 INFO - PROCESS | 6583 | 05:13:11 INFO - PROCESS | 6583 | Cycle 1(1): loaded http://localhost:60727/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:60727/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:13:12 INFO - PROCESS | 6583 | RSS: Main: 162807808 05:13:12 INFO - PROCESS | 6583 | 05:13:15 INFO - PROCESS | 6583 | Cycle 1(1): loaded http://localhost:60727/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:60727/tests/kraken/driver.html?testName=imaging-darkroom) 05:13:15 INFO - PROCESS | 6583 | RSS: Main: 167219200 05:13:15 INFO - PROCESS | 6583 | 05:13:19 INFO - PROCESS | 6583 | Cycle 1(1): loaded http://localhost:60727/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:60727/tests/kraken/driver.html?testName=imaging-desaturate) 05:13:20 INFO - PROCESS | 6583 | RSS: Main: 163680256 05:13:20 INFO - PROCESS | 6583 | 05:13:23 INFO - PROCESS | 6583 | Cycle 1(1): loaded http://localhost:60727/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:60727/tests/kraken/driver.html?testName=json-parse-financial) 05:13:23 INFO - PROCESS | 6583 | RSS: Main: 164589568 05:13:23 INFO - PROCESS | 6583 | 05:13:25 INFO - PROCESS | 6583 | Cycle 1(1): loaded http://localhost:60727/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:60727/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:13:26 INFO - PROCESS | 6583 | RSS: Main: 164761600 05:13:26 INFO - PROCESS | 6583 | 05:13:27 INFO - PROCESS | 6583 | Cycle 1(1): loaded http://localhost:60727/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:60727/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:13:28 INFO - PROCESS | 6583 | RSS: Main: 165441536 05:13:28 INFO - PROCESS | 6583 | 05:13:30 INFO - PROCESS | 6583 | Cycle 1(1): loaded http://localhost:60727/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:60727/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:13:31 INFO - PROCESS | 6583 | RSS: Main: 165658624 05:13:31 INFO - PROCESS | 6583 | 05:13:34 INFO - PROCESS | 6583 | Cycle 1(1): loaded http://localhost:60727/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:60727/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:13:35 INFO - PROCESS | 6583 | RSS: Main: 166240256 05:13:35 INFO - PROCESS | 6583 | 05:13:38 INFO - PROCESS | 6583 | Cycle 1(1): loaded http://localhost:60727/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:60727/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:13:38 INFO - PROCESS | 6583 | RSS: Main: 168747008 05:13:38 INFO - PROCESS | 6583 | 05:13:40 INFO - PROCESS | 6583 | Cycle 1(1): loaded http://localhost:60727/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:60727/tests/kraken/driver.html?testName=ai-astar) 05:13:40 INFO - PROCESS | 6583 | RSS: Main: 170045440 05:13:40 INFO - PROCESS | 6583 | 05:13:40 INFO - PROCESS | 6583 | __start_tp_report 05:13:40 INFO - PROCESS | 6583 | _x_x_mozilla_page_load 05:13:40 INFO - PROCESS | 6583 | _x_x_mozilla_page_load_details 05:13:40 INFO - PROCESS | 6583 | |i|pagename|runs| 05:13:40 INFO - PROCESS | 6583 | |0;ai-astar;109;118;117;118;118;116;116;115;117;116 05:13:40 INFO - PROCESS | 6583 | |1;audio-beat-detection;154;127;125;181;132;126;128;136;164;129 05:13:40 INFO - PROCESS | 6583 | |2;audio-dft;163;165;167;162;163;163;164;165;164;168 05:13:40 INFO - PROCESS | 6583 | |3;audio-fft;75;77;76;108;88;77;77;78;92;76 05:13:40 INFO - PROCESS | 6583 | |4;audio-oscillator;85;84;106;85;84;83;102;85;85;116 05:13:40 INFO - PROCESS | 6583 | |5;imaging-gaussian-blur;119;118;118;118;121;118;119;118;118;118 05:13:40 INFO - PROCESS | 6583 | |6;imaging-darkroom;150;149;149;150;150;151;150;151;153;150 05:13:40 INFO - PROCESS | 6583 | |7;imaging-desaturate;95;97;96;96;97;96;96;98;96;96 05:13:40 INFO - PROCESS | 6583 | |8;json-parse-financial;70;64;64;65;66;65;64;65;64;67 05:13:40 INFO - PROCESS | 6583 | |9;json-stringify-tinderbox;67;67;67;67;68;67;68;66;67;67 05:13:40 INFO - PROCESS | 6583 | |10;stanford-crypto-aes;91;87;91;96;85;86;85;86;86;85 05:13:40 INFO - PROCESS | 6583 | |11;stanford-crypto-ccm;147;132;132;132;141;138;138;141;182;134 05:13:40 INFO - PROCESS | 6583 | |12;stanford-crypto-pbkdf2;190;187;186;182;186;185;185;183;181;183 05:13:40 INFO - PROCESS | 6583 | |13;stanford-crypto-sha256-iterative;69;73;71;69;68;70;71;67;68;66 05:13:40 INFO - PROCESS | 6583 | __end_tp_report 05:13:40 INFO - PROCESS | 6583 | __start_cc_report 05:13:40 INFO - PROCESS | 6583 | _x_x_mozilla_cycle_collect,829 05:13:40 INFO - PROCESS | 6583 | __end_cc_report 05:13:40 INFO - PROCESS | 6583 | __startTimestamp1485954820750__endTimestamp 05:13:40 INFO - PROCESS | 6583 | 05:13:40 INFO - PROCESS | 6583 | ------- Summary: start ------- 05:13:40 INFO - PROCESS | 6583 | Number of tests: 14 05:13:40 INFO - PROCESS | 6583 | 05:13:40 INFO - PROCESS | 6583 | [#0] ai-astar Cycles:10 Average:116.00 Median:117.00 stddev:2.67 (2.3%) stddev-sans-first:1.09 05:13:40 INFO - PROCESS | 6583 | Values: 109.0 118.0 117.0 118.0 118.0 116.0 116.0 115.0 117.0 116.0 05:13:40 INFO - PROCESS | 6583 | 05:13:40 INFO - PROCESS | 6583 | [#1] audio-beat-detection Cycles:10 Average:140.20 Median:134.00 stddev:19.40 (14.5%) stddev-sans-first:19.92 05:13:40 INFO - PROCESS | 6583 | Values: 154.0 127.0 125.0 181.0 132.0 126.0 128.0 136.0 164.0 129.0 05:13:40 INFO - PROCESS | 6583 | 05:13:40 INFO - PROCESS | 6583 | [#2] audio-dft Cycles:10 Average:164.40 Median:164.50 stddev:1.90 (1.2%) stddev-sans-first:1.94 05:13:40 INFO - PROCESS | 6583 | Values: 163.0 165.0 167.0 162.0 163.0 163.0 164.0 165.0 164.0 168.0 05:13:40 INFO - PROCESS | 6583 | 05:13:40 INFO - PROCESS | 6583 | [#3] audio-fft Cycles:10 Average:82.40 Median:77.00 stddev:10.66 (13.8%) stddev-sans-first:10.96 05:13:40 INFO - PROCESS | 6583 | Values: 75.0 77.0 76.0 108.0 88.0 77.0 77.0 78.0 92.0 76.0 05:13:40 INFO - PROCESS | 6583 | 05:13:40 INFO - PROCESS | 6583 | [#4] audio-oscillator Cycles:10 Average:91.50 Median:84.50 stddev:11.90 (14.1%) stddev-sans-first:12.39 05:13:40 INFO - PROCESS | 6583 | Values: 85.0 84.0 106.0 85.0 84.0 83.0 102.0 85.0 85.0 116.0 05:13:40 INFO - PROCESS | 6583 | 05:13:40 INFO - PROCESS | 6583 | [#5] imaging-gaussian-blur Cycles:10 Average:118.50 Median:118.00 stddev:0.97 (0.8%) stddev-sans-first:1.01 05:13:40 INFO - PROCESS | 6583 | Values: 119.0 118.0 118.0 118.0 121.0 118.0 119.0 118.0 118.0 118.0 05:13:40 INFO - PROCESS | 6583 | 05:13:40 INFO - PROCESS | 6583 | [#6] imaging-darkroom Cycles:10 Average:150.30 Median:150.00 stddev:1.16 (0.8%) stddev-sans-first:1.22 05:13:40 INFO - PROCESS | 6583 | Values: 150.0 149.0 149.0 150.0 150.0 151.0 150.0 151.0 153.0 150.0 05:13:40 INFO - PROCESS | 6583 | 05:13:40 INFO - PROCESS | 6583 | [#7] imaging-desaturate Cycles:10 Average:96.30 Median:96.00 stddev:0.82 (0.9%) stddev-sans-first:0.73 05:13:40 INFO - PROCESS | 6583 | Values: 95.0 97.0 96.0 96.0 97.0 96.0 96.0 98.0 96.0 96.0 05:13:40 INFO - PROCESS | 6583 | 05:13:40 INFO - PROCESS | 6583 | [#8] json-parse-financial Cycles:10 Average:65.40 Median:65.00 stddev:1.90 (2.9%) stddev-sans-first:1.05 05:13:40 INFO - PROCESS | 6583 | Values: 70.0 64.0 64.0 65.0 66.0 65.0 64.0 65.0 64.0 67.0 05:13:40 INFO - PROCESS | 6583 | 05:13:40 INFO - PROCESS | 6583 | [#9] json-stringify-tinderbox Cycles:10 Average:67.10 Median:67.00 stddev:0.57 (0.8%) stddev-sans-first:0.60 05:13:40 INFO - PROCESS | 6583 | Values: 67.0 67.0 67.0 67.0 68.0 67.0 68.0 66.0 67.0 67.0 05:13:40 INFO - PROCESS | 6583 | 05:13:40 INFO - PROCESS | 6583 | [#10] stanford-crypto-aes Cycles:10 Average:87.80 Median:86.50 stddev:3.68 (4.2%) stddev-sans-first:3.71 05:13:40 INFO - PROCESS | 6583 | Values: 91.0 87.0 91.0 96.0 85.0 86.0 85.0 86.0 86.0 85.0 05:13:40 INFO - PROCESS | 6583 | 05:13:40 INFO - PROCESS | 6583 | [#11] stanford-crypto-ccm Cycles:10 Average:141.70 Median:139.50 stddev:14.99 (10.7%) stddev-sans-first:15.78 05:13:40 INFO - PROCESS | 6583 | Values: 147.0 132.0 132.0 132.0 141.0 138.0 138.0 141.0 182.0 134.0 05:13:40 INFO - PROCESS | 6583 | 05:13:40 INFO - PROCESS | 6583 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:184.80 Median:185.50 stddev:2.66 (1.4%) stddev-sans-first:2.05 05:13:40 INFO - PROCESS | 6583 | Values: 190.0 187.0 186.0 182.0 186.0 185.0 185.0 183.0 181.0 183.0 05:13:40 INFO - PROCESS | 6583 | 05:13:40 INFO - PROCESS | 6583 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:69.20 Median:69.50 stddev:2.10 (3.0%) stddev-sans-first:2.22 05:13:40 INFO - PROCESS | 6583 | Values: 69.0 73.0 71.0 69.0 68.0 70.0 71.0 67.0 68.0 66.0 05:13:40 INFO - PROCESS | 6583 | -------- Summary: end -------- 05:13:40 INFO - PROCESS | 6583 | 05:13:41 INFO - TEST-INFO | 6583: exit 0 05:13:41 INFO - TEST-OK | kraken | took 64449ms 05:13:41 INFO - SUITE-END | took 1182s 05:13:42 INFO - Completed test suite (00:19:43) 05:13:42 INFO - javascript benchmark 05:13:42 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 6324.487301161379, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2499.4251322195896, 2537.8072306016165, 2555.757203065708, 2566.9358266043346, 2580.9354766130855, 4464.441944756905, 4594.8391806286745, 4621.6071633911115, 4642.35007099006, 4657.743824089674, 4482.843100491484, 4541.545845415465, 4557.202489564322, 4557.430321209848, 4559.566841150086, 4186.162767446515, 4191.55988621195, 4217.15656868626, 4272.786360681969, 4287.271163902128, 4293.2701440755145, 4297.59172878576, 4302.548232435596, 4306.5262821089655, 4316.913661726763, 58.11174921128385, 4345.717528360662, 4347.391365208858, 4363.105563359503, 4387.692861499696, 4175.519815221258, 4229.386738922839, 4232.9365059523825, 4316.417283666728, 4323.502797178333, 4247.532771395144, 4275.893102672427, 4290.077633308822, 4290.141971605692, 4319.913601727979, 4458.0, 4594.1271158479785, 4652.278896771006, 4684.765761711935, 4713.505081966378, 4739.9526004739855, 4825.565699087099, 4838.588719958808, 4877.756112194376, 4941.45643979162, 4879.707217566957, 4887.853364399074, 4896.265560165968, 4903.65674402792, 4952.504749525055, 4616.8614941551805, 4628.560286772751, 4630.83792067276, 4631.6294696424875, 4678.274867395559, 4834.854954351375, 4893.7063776173545, 4893.779779909913, 4934.901301974012, 4945.431275403303, 4675.812967481263, 4727.598154156866, 4728.929066064012, 4739.336492890998, 4741.288806679026, 4770.809167633325, 4802.943352462453, 4818.301346304766, 4829.492903245108, 4839.128956787742, 4781.976090119597, 4786.856394308176, 4800.591949684316, 4801.567858892717, 4877.585405240523, 4783.162946484351, 4810.8797280068275, 4816.95183048172, 4835.081334546425, 4876.683015603974, 4104.979475102665, 4155.97922010388, 4158.293090174617, 4160.750354978711, 4172.645325147397, 3656.3784156693428, 3669.4679271505483, 3693.759905606127, 3720.311742327678, 3732.794696291676, 4226.281532139544, 4233.449651545341, 4233.597808208216, 4233.767142807175, 4237.131388065439, 4706.3411122442885, 4816.710997340171, 4903.264510323409, 4921.606271498272, 4959.429665588504, 4177.644900183458, 4189.455370801777, 4214.578542145761, 4237.512686041083, 4258.212230737324, 4442.178197033559, 4458.264386376211, 4458.665600080007, 4460.977695111504, 4501.864944051684, 4560.452745670408, 4591.311303304531, 4593.0, 4595.655325850575, 4639.628829693616, 4759.048190361872, 4791.832285869978, 4899.069176856386, 4937.136001199848, 4957.578605818401, 4609.746463944515, 4615.515370886009, 4624.791884365144, 4650.116477869194, 4655.20861453547, 4851.51484851512, 4897.2654101885, 4909.410870695539, 4917.877053073702, 4958.603311734981, 4728.101660684459, 4778.546038126373, 4865.1242776300605, 4906.043321552405, 4961.03259864323, 4706.105839890547, 4722.645801564828, 4738.0, 4760.143174228672, 4773.904521909473, 4567.680262381734, 4573.131105090022, 4584.9312260315455, 4709.599684026896, 4776.761161941819, 4525.298578720303, 4557.1797076526545, 4559.726416415026, 4569.771511424482, 4584.289435137559, 4606.585407313358, 4642.53574642533, 4654.371659826015, 4663.860084197479, 4696.1546921554445, 4506.616937560213, 4560.6351491879905, 4568.223402021597, 4604.792784324646, 4605.125026245003], "value": 4452.683946394431, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [523.3222976245761, 544.9918251226233, 552.4227182594186, 569.220168369334, 570.9400512946138, 40455.0, 42916.3562546562, 42925.35611965823, 46601.30098048532, 46812.0, 42262.36606450906, 42489.57510424895, 42730.78634606831, 42834.7858260709, 42896.356554651706, 7837.098733645633, 8005.239502247277, 8010.39922005849, 9669.854952175723, 10000.59997600095, 9760.0, 9870.753231169207, 9892.455914924676, 9894.208463322917, 9932.503374831265, 9939.055789699967, 9984.154515962951, 9987.40075595463, 9991.250656200815, 9995.75010624733, 9899.356541824794, 9908.355956862853, 9945.950270248602, 9965.800683986352, 9985.550650220757, 9801.411915285034, 9859.288695608693, 9880.555375008142, 9880.65417710384, 9893.851592226123, 35505.28989420223, 35908.0, 35952.64047359519, 35968.46047309293, 36037.0, 3418.2138108235245, 3507.4914137450182, 3572.2319701264355, 3615.258871931248, 3618.294432585647, 24539.87730061356, 25886.87056564724, 26162.73837261641, 26188.60717089245, 26209.73790262092, 3264.5266436366833, 3380.2732412531423, 3431.4681224410256, 3527.2416430467574, 3545.06055895188, 223356.0, 225512.0, 225605.0, 226219.0, 226423.0, 48170.759146204044, 48228.758856206194, 48375.75812120917, 48482.75758621185, 48790.75604622025, 49113.0, 49353.0, 49393.0, 49438.25842612363, 49465.50534494681, 13337.599872003855, 13615.455381784617, 13624.386902589407, 13627.0, 13717.382717777724, 9092.227160691284, 9370.531473426301, 10354.17166626668, 10599.894001060045, 10601.310914790514, 18784.154713037948, 19662.657348250832, 19933.103010364568, 19950.50123746918, 19958.900205498878, 7417.295356941082, 7513.737019204302, 7735.0, 7816.335611472975, 7885.921140788519, 798.4809873582218, 801.4470015689155, 826.3554427546524, 828.5401602110886, 843.3843294395126, 28105.43789124206, 28384.716152838206, 28404.0, 28505.857470712515, 28940.5529723513, 957.4446820843893, 957.7988622389237, 968.5496244246318, 991.2070343724992, 992.6972273456665, 14696.265186740835, 15339.769903451457, 15530.223488825739, 15643.530694078969, 15691.686166276611, 358202.0, 359325.0, 359735.0, 361900.0, 363219.0, 51550.0, 52003.219951700754, 52132.739336303835, 52222.21666675003, 52268.73865630647, 1216.087934049463, 1253.0977696058824, 1254.8682388349275, 1264.7027948432112, 1265.3483456020158, 26133.73866261313, 27098.45803083967, 27721.0, 27789.44421111526, 28052.29869253285, 44435.55564444314, 44917.0, 44926.101477970915, 45040.324395134754, 45068.0, 296500.0, 297923.0, 298755.0, 299476.0, 300740.0, 24127.879360603787, 24690.382740431633, 24784.132555360477, 38116.0, 38911.80544097262, 36760.26479470342, 37152.44271335986, 37894.24211515809, 38094.0, 38210.42684359681, 31829.363412731152, 32006.03981880547, 32217.838910805294, 32354.0, 32706.509402358508, 32041.198970025936, 32331.838340808146, 32545.186370340933, 33579.0, 33726.49410258897, 31179.064628061195, 31632.051038468882, 32081.518777217894, 32174.0, 32373.0, 26650.733492664825, 28993.7100628991, 29025.419491609628, 29150.854245728635, 29173.85413072921, 22468.10127594878, 22500.662490062336, 22737.431564210365, 22794.31617051491, 22915.88542057279], "value": 17679.1413953044, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [380.68783597450084, 386.9187470631167, 393.6063936063936, 396.1265409771454, 415.1199457150839, 13951.162930224194, 16844.915775421123, 16911.323547058135, 18502.62994740106, 18503.444896653105, 18058.27766889326, 18262.269509219648, 18386.264549418007, 18386.448406547825, 18708.81291187088, 5192.299039629639, 5218.530332270095, 5294.761735721882, 5339.786408543654, 5452.809151679692, 5277.551408130314, 5347.732613369316, 5357.249985002103, 5377.354717433914, 5381.838544843661, 5177.404598471167, 5294.655847369928, 5305.0450918834595, 5320.893582128355, 5322.840314790543, 5180.326557547513, 5270.262163297141, 5298.682079075268, 5304.230886521472, 5309.62832601718, 4589.33454649074, 4711.835085772016, 4725.64557658177, 4752.358431611723, 4758.524147585248, 22394.44013899649, 22777.31668049961, 22855.31434056981, 22906.0, 23036.769632303796, 1880.962380752391, 1889.3765057531118, 1898.8670793044491, 1916.8179022992792, 1957.8140076692835, 9964.601415943354, 10260.897391026068, 12070.577529786504, 13197.406116724675, 14703.19132447715, 1537.9923100384426, 1565.1235308227429, 1581.7706432567213, 1593.7689035089847, 1624.0093542938798, 83927.58036209841, 84893.0, 85228.0, 85495.99999999937, 87499.56250218708, 10596.470176491144, 10755.83866242007, 10979.341239525655, 11069.391183484824, 11103.72240693989, 12054.216475929037, 15576.922115389578, 15595.610109747347, 15597.376104955674, 15611.3755449783, 7013.0, 7162.588310069161, 7337.70649174027, 7393.48245622812, 7394.889076663854, 6953.304669533108, 6980.197277313174, 7136.393406560397, 7136.464765142635, 7137.357637812518, 3879.650831425185, 4034.536028356718, 4038.414429907647, 4137.482814648169, 4138.296489596776, 1904.8285654290903, 1945.737325461073, 1970.6945423459388, 1973.605278944217, 1979.7327360806107, 797.6051854332027, 820.4953953318666, 821.8109834737924, 822.925936665691, 841.427829076234, 17481.388151414638, 17749.7337539937, 18300.725489117674, 18470.630587388445, 18780.154893029845, 817.852786498436, 819.8114433680167, 820.5281962871372, 823.5635113389793, 838.6854929401475, 10052.994700529889, 10131.13885319756, 10365.9481702591, 10405.84391234132, 10409.635662751767, 494882.0, 499529.0, 500552.0, 503530.0, 509543.0, 69515.65242173757, 79639.20360796318, 91927.54036229776, 92043.0, 94906.0, 871.834351473218, 885.9512726800087, 890.5992303463338, 896.3725392225338, 897.7620930453435, 15530.1458419788, 15722.685546289238, 15804.446844360393, 16017.67964640724, 16068.758968615246, 33789.3242135151, 39962.40056399098, 39992.0, 41095.589044109176, 42349.78825105855, 54487.45512544982, 54748.72625636846, 54821.0, 55156.44843551513, 55973.44026559682, 6544.149260596092, 7533.472656913963, 7796.415268854745, 7963.80090497719, 8052.074011488754, 9190.49452280131, 12233.632991010283, 12329.876701232874, 12396.690082748004, 12560.748785024065, 10278.691639250834, 10437.947810260901, 10477.63328283537, 10668.253222274367, 10927.92369449802, 6679.4990375721045, 10231.846522302023, 10320.948395257976, 10652.733681658021, 10940.0, 10527.105196058421, 10700.892991070301, 10867.945660271647, 10959.397233151934, 11213.66359009231, 7608.581528015791, 7621.047369078865, 7759.883601746092, 8019.117897031439, 8260.256576908107, 8703.738887833375, 10672.946635267084, 10684.358938463716, 10964.671059868217, 11018.889811101786], "value": 8500.109467980454, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1281.7436512697464, 1305.8302420685309, 1309.1948451702203, 1313.888319492843, 1324.6489680234736, 6231.470325022378, 6448.258450278219, 6479.481641468683, 6808.421284190844, 6824.249332573413, 6667.166604174478, 6953.165620125579, 6985.371316581507, 7104.0, 7149.034880291159, 2043.3563427520357, 2075.740532433446, 2079.334612923865, 2083.4583008417767, 2085.061722225005, 2069.213698794456, 2096.1824888293577, 2108.9156433742633, 2109.673000684889, 2190.4414374334524, 2126.36209137259, 2138.625740495415, 2142.9035693393835, 2144.4210063282903, 2151.591197672445, 2017.767956684978, 2035.307995281604, 2042.693595960603, 2043.632146213681, 2045.7238272833126, 2057.310800881706, 2074.408793493847, 2145.3778404262744, 2147.3987283560627, 2149.247763282854, 6929.480288978347, 6993.405560527362, 7038.331358520933, 7044.189918159426, 7051.224365319811, 4217.451731274945, 4332.025294308755, 4332.155229730204, 4332.566743325674, 4341.956580434186, 2414.4567472318763, 2720.986395068012, 2746.9725302746915, 2778.902738404146, 2793.9301517462022, 1081.0756802933536, 1093.6609651008134, 1117.793208256475, 1127.2053202492223, 1192.9642110736693, 9190.632374705005, 9266.721998339994, 9297.535123243812, 9321.254299656011, 9356.953215233949, 3678.6505281998166, 3859.9035024124623, 3908.550516690617, 3919.627635374635, 3940.5074365704286, 7317.670704818296, 7340.9632951835965, 7344.045274114331, 7359.558426494427, 7371.299726525972, 4334.306510958231, 4392.428984232093, 4399.802008909607, 4434.068845542408, 4437.156940181355, 3892.3577609694084, 3997.7801220932547, 4029.3351596986167, 4053.5135783705555, 4058.512978442606, 3185.904422867318, 3212.5181222816764, 3287.852046657906, 3294.901152965415, 3295.3903527847424, 1047.4239168457318, 1053.2942928237946, 1058.402002868377, 1066.4347895615335, 1072.3512275073624, 820.667629609997, 836.60679480644, 842.8567143585606, 858.5621333120154, 863.749512641327, 4737.086691684589, 4771.997880445076, 4823.131836269506, 4838.129136755418, 4901.068796928572, 896.852019416789, 906.7823722306599, 917.1699611851285, 924.6578765856676, 930.5812384427035, 3203.1511649412923, 3300.174956260935, 3351.949720754191, 3355.5906519261966, 3399.6770306820813, 8069.072056713436, 8096.473729207582, 8305.667773289, 8382.580870956428, 8397.496150231005, 8142.226488483585, 8144.348452123816, 8201.261886430131, 8392.538410387488, 8395.412321137585, 6412.551121421456, 6529.477641788645, 6554.344565543408, 6582.506312026521, 6588.703508342041, 4772.809087636595, 4799.880002999953, 4849.054434385261, 4861.392325959255, 4897.2654101885, 7423.591702456417, 7520.774376768706, 7693.49992250502, 7755.681534139323, 7774.183710710294, 7614.428917831074, 7625.694972201271, 7679.424043196671, 7685.423593230418, 7709.653065612173, 5863.237779088691, 5894.793682221101, 5930.080837470199, 5938.079597662369, 5940.376260492586, 6497.18785151856, 6518.967405162944, 6558.0, 6587.703553340016, 6594.109795177781, 5973.581849270509, 6060.636361818305, 6111.786087486917, 6152.569320147547, 6197.659128747962, 6027.728752206073, 6040.335563088145, 6059.697015149137, 6095.3904609538695, 6097.664628445478, 5414.783408663767, 5567.832965011056, 5569.470900264469, 5570.275864137636, 5570.888582228414, 4279.122779830065, 4281.1437712458255, 4329.891752706208, 4390.692651514363, 4465.732056076646, 4217.219814334358, 4364.563543645737, 4419.491758447691, 4472.888177795451, 4539.432570928634], "value": 3812.4405396726825, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [354.16063928489484, 362.7406404420839, 367.6323676323676, 367.93009328227635, 372.52131011650033, 4856.320115183873, 4916.213405855064, 4939.506049395059, 4959.256111583264, 4965.776540055697, 4798.736069516175, 4878.975605121969, 4899.093667671475, 4905.730184839832, 4922.6800257983205, 3946.4869566956254, 3980.4476254260862, 3984.1434091670358, 3990.361542153256, 3994.760314381132, 3956.960430395688, 3966.254847866929, 3971.5631280559114, 3985.302572049894, 3986.720929534934, 3955.5055618047745, 3965.504311961005, 3970.7419017763896, 3972.5828787977134, 3991.940120898189, 3869.32286849803, 3924.8822535323984, 3925.0, 3966.801659917007, 3966.900827479322, 3549.4853246279404, 3559.430491121408, 3569.321828852536, 3582.4564559163027, 3592.6227746086547, 4829.3721816164025, 4834.776003038606, 4842.41890973082, 4842.878928026792, 4851.345068415754, 4348.956510434887, 4531.77341132942, 4532.274836026253, 4534.9319760203625, 4564.543545645409, 5067.0, 5126.641135120543, 5128.948710512885, 5133.794648214067, 5158.200478925773, 3912.1979994101425, 3917.8628747993966, 3929.1748732766155, 3956.4065390191413, 3961.7424867383816, 5218.0, 5329.573634109262, 5384.542313903323, 5408.215808707794, 5409.83770486886, 3726.273376691519, 3730.4446454178974, 3755.2301778135416, 3765.5669597996034, 3769.6230376962635, 3802.942955855609, 3813.466114743938, 3821.464994900716, 3821.7515861468914, 3852.9807350963624, 4334.306510958231, 4377.956220437755, 4378.605925466723, 4379.189849877783, 4407.867763967086, 5071.0, 5149.742512874342, 5166.457521960216, 5188.195829646411, 5236.659617124875, 1262.501311981762, 1277.96484847274, 1284.8715128487077, 1286.70685960609, 1291.8837304642627, 837.874318852177, 882.4440602420434, 884.6947803007952, 895.4269267668698, 906.977325566866, 4327.913441731211, 4337.284348082531, 4346.217680817484, 4360.520342762294, 4386.363977223285, 5166.380034395821, 5180.4560521145495, 5182.922256166161, 5190.6107041972, 5233.581313494911, 4210.831421817767, 4318.870433886988, 4370.950971766753, 4390.53899340571, 4393.582609652078, 2721.924839688312, 2736.5758307462374, 2739.602757600137, 2745.409736906575, 2769.7645700115313, 4698.530146985274, 4756.8097276108565, 4771.880702982453, 4779.518349311725, 4781.708938586632, 4983.300328082096, 5263.157894736812, 5274.472552744694, 5282.996230716229, 5287.836675931289, 4775.594074503706, 4780.976095119641, 4789.658895509263, 4793.49668284832, 4799.472058073609, 5045.1927691570645, 5132.769025393941, 5160.400275914479, 5173.689578625294, 5196.2465442509865, 4922.581580565692, 5087.414947280962, 5129.384473863161, 5137.51193636604, 5238.37139543242, 4795.9280610790165, 4921.237208232729, 4937.21004639256, 4939.259111133215, 4940.912999140183, 3748.981255093707, 3797.2785170817456, 3798.582155962897, 3809.3904975203836, 3847.3459511883607, 5327.786888524415, 5337.492938170868, 5363.704996225245, 5369.19462080691, 5369.731513424391, 4839.249916262985, 5011.749412529286, 5105.2086926526445, 5123.103456895103, 5128.974055248082, 5027.49725027509, 5053.84838454847, 5082.322833464874, 5101.245327523245, 5140.897182056263, 5005.524475174852, 5021.593953692972, 5023.57299629521, 5032.245163225399, 5036.597072234139, 4978.228374601942, 5040.747962601782, 5096.872578185426, 5118.38579370478, 5128.589712822891, 4969.577076401933, 4994.6503744738975, 4996.225585034325, 5000.874978125576, 5051.772670229922], "value": 3895.511855299103, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [669.2237005074115, 687.7455341523637, 732.8570928668909, 758.1470845299039, 774.2683164409633, 12417.875821241785, 13398.531051413203, 13426.328683565807, 13440.059195856269, 13500.054996150273, 12762.489500419995, 12840.0, 12852.48590056399, 12860.356982150903, 12877.549285774976, 649.7855707616487, 667.1527160506155, 783.4868161354322, 810.8864758933724, 819.778659761864, 820.6471217376526, 822.4037572759731, 829.672279449617, 830.0578843013163, 831.8377916306292, 872.9869051964225, 873.5806812729893, 879.0462348352046, 879.8196369744187, 880.2649787427474, 863.4560227056913, 868.8175483148547, 871.1593312453481, 872.6116877989298, 873.2882700598991, 629.7229219143562, 634.9428551430348, 635.3836778325017, 635.6885126288132, 638.5657752728143, 12804.935975320064, 13296.26870522121, 14239.216843073627, 14263.072900261554, 14296.285185740775, 13611.863881361258, 14484.493042743454, 14546.345414456375, 14631.122132671968, 14785.852141478555, 10692.786144277148, 10726.141908647289, 10826.512806923707, 10840.728981775439, 10899.073578745816, 3310.304835984422, 3333.283344081034, 3352.430086885211, 3409.6419875913166, 3478.930421391558, 65039.99999999953, 65915.3408465914, 66441.335586644, 66868.66565667189, 67871.0, 10961.342319460859, 10972.0, 11215.71960700989, 11254.268472549258, 11260.217030716054, 21132.577348452945, 21418.57162856734, 21538.78461215368, 21611.567768644854, 21652.566948660937, 6733.494987875831, 6737.523518285886, 6766.120404347502, 6787.728490860409, 6854.0, 3431.725461963037, 3566.1159286179827, 3575.3743094958277, 3585.1754096557415, 3599.1182160370354, 2890.3930174663137, 3081.3221091359865, 3214.244652506659, 3222.3233121044373, 3246.561714168557, 539.1750621549036, 544.6813614035755, 544.8801263721975, 556.2379540030104, 560.5263552298302, 567.29088639201, 587.1105275507609, 602.4908951935607, 619.7118339971845, 620.9223847019123, 9035.683751068813, 9098.272138228926, 9155.908440915638, 9224.769380765534, 9236.214921731593, 529.4678847758056, 543.7770514089204, 554.2655980825423, 556.0685851199225, 562.8733534954685, 4202.201581699467, 4229.281022226229, 4472.977635111869, 4491.348754430589, 4495.527969563149, 66298.0, 68089.0, 68099.65950170218, 68126.65936670384, 69344.6532767343, 47118.5288147121, 56830.715846420506, 59442.999999999134, 59975.0, 60326.0, 39288.6071139285, 39560.802195988836, 44327.0, 44347.33478997753, 44980.77509612431, 9180.357374983687, 9901.108900199017, 9934.751631208988, 9935.155511781579, 9951.502424878872, 30652.84673576618, 34388.65611343855, 35254.82372588121, 35463.290734185684, 36530.26939461249, 40727.389089163094, 41926.58073419227, 44295.335569965835, 44586.0, 45326.54673453355, 11377.203595748219, 11385.665938482756, 11393.544258229578, 11666.88333116658, 11915.523379065087, 12981.610551683465, 13143.277119758122, 13351.532696355582, 13452.0, 13984.497208797959, 10631.468426578795, 10919.727006824574, 11037.779244415227, 11072.0, 11335.886641133813, 11612.0, 11909.880901191224, 12004.738317897021, 12151.453184606891, 12441.813372799596, 11302.49835240558, 11855.170138090596, 11959.043276537683, 11983.460744266355, 12324.81512777327, 9927.40435573868, 10457.477126143815, 10474.633387831389, 10500.632477863239, 10671.46642667848, 8303.294219991369, 8419.40252601916, 9673.951630241803, 9953.0, 10030.699079027641], "value": 6439.064415467995, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1575.6, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [109.0, 118.0, 117.0, 118.0, 118.0, 116.0, 116.0, 115.0, 117.0, 116.0], "value": 116.0, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [154.0, 127.0, 125.0, 181.0, 132.0, 126.0, 128.0, 136.0, 164.0, 129.0], "value": 140.2, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 165.0, 167.0, 162.0, 163.0, 163.0, 164.0, 165.0, 164.0, 168.0], "value": 164.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 77.0, 76.0, 108.0, 88.0, 77.0, 77.0, 78.0, 92.0, 76.0], "value": 82.4, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 84.0, 106.0, 85.0, 84.0, 83.0, 102.0, 85.0, 85.0, 116.0], "value": 91.5, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [119.0, 118.0, 118.0, 118.0, 121.0, 118.0, 119.0, 118.0, 118.0, 118.0], "value": 118.5, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [150.0, 149.0, 149.0, 150.0, 150.0, 151.0, 150.0, 151.0, 153.0, 150.0], "value": 150.3, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 97.0, 96.0, 96.0, 97.0, 96.0, 96.0, 98.0, 96.0, 96.0], "value": 96.3, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [70.0, 64.0, 64.0, 65.0, 66.0, 65.0, 64.0, 65.0, 64.0, 67.0], "value": 65.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 67.0, 67.0, 67.0, 68.0, 67.0, 68.0, 66.0, 67.0, 67.0], "value": 67.1, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [91.0, 87.0, 91.0, 96.0, 85.0, 86.0, 85.0, 86.0, 86.0, 85.0], "value": 87.8, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 132.0, 132.0, 132.0, 141.0, 138.0, 138.0, 141.0, 182.0, 134.0], "value": 141.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [190.0, 187.0, 186.0, 182.0, 186.0, 185.0, 185.0, 183.0, 181.0, 183.0], "value": 184.8, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 73.0, 71.0, 69.0, 68.0, 70.0, 71.0, 67.0, 68.0, 66.0], "value": 69.2, "unit": "score"}]}]} 05:13:42 INFO - Return code: 0 05:13:42 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 05:13:42 ERROR - # TBPL SUCCESS # 05:13:42 INFO - Running post-action listener: _resource_record_post_action 05:13:42 INFO - [mozharness: 2017-02-01 13:13:42.573511Z] Finished run-tests step (success) 05:13:42 INFO - Running post-run listener: _resource_record_post_run 05:13:42 INFO - Total resource usage - Wall time: 1200s; CPU: 13.0%; Read bytes: 4096; Write bytes: 413384704; Read time: 12; Write time: 251748 05:13:42 INFO - TinderboxPrint: CPU usage
13.4% 05:13:42 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 12 05:13:42 INFO - TinderboxPrint: I/O write bytes / time
413,384,704 / 251,748 05:13:42 INFO - TinderboxPrint: CPU idle
8,287.9 (86.5%) 05:13:42 INFO - TinderboxPrint: CPU user
1,230.2 (12.8%) 05:13:42 INFO - TinderboxPrint: Swap in / out
0 / 0 05:13:42 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 100364288; Read time: 0; Write time: 83952 05:13:42 INFO - run-tests - Wall time: 1184s; CPU: 13.0%; Read bytes: 0; Write bytes: 296267776; Read time: 0; Write time: 163520 05:13:43 INFO - Running post-run listener: _upload_blobber_files 05:13:43 INFO - Blob upload gear active. 05:13:43 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 05:13:43 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:43 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:43 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:43 INFO - (blobuploader) - INFO - Open directory for files ... 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/resource-usage.json ... 05:13:44 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:13:44 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:13:49 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 05:13:49 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:13:49 INFO - (blobuploader) - INFO - Done attempting. 05:13:49 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 05:13:49 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:13:49 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:13:50 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 05:13:50 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:13:50 INFO - (blobuploader) - INFO - Done attempting. 05:13:50 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 05:13:50 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:13:50 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:13:51 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 05:13:51 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:13:51 INFO - (blobuploader) - INFO - Done attempting. 05:13:51 INFO - (blobuploader) - INFO - Iteration through files over. 05:13:51 INFO - Return code: 0 05:13:51 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 05:13:51 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 05:13:51 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/da396cf5a1fe094963c98cd6836aec1563b157501e2e7df486ebbcd5e73a1f1f40e36d36243bdb7799e4ce2a1c4f20fc2e4b9d950a543449426e92d58d509f34", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/0925c121f34bc6f72e7146d7b51b7e5add67e109d87ab1d62ed3fbcbb18bfefb7da3bfa02b65a68dfff50eaf6408232b60734483a8ca0ad79e1ede7736f4b224", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e59776e6bbe9535aa64700c2f761621ab052ac7da1efd5bd2a4b8079a349c0f30422feea068b27cb4645c8f1bc7581307f6b7eefae8bb18c5b75575a8d1ce808", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/38082611e05e5077173ef527691d85a85ec74b17e53c81449323a15394f833f551c71653dbd9d1ce1d01ff60267e8bb0a2deca24744bc9e952ee53863d1ad480"} 05:13:51 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 05:13:51 INFO - Writing to file /builds/slave/test/properties/blobber_files 05:13:51 INFO - Contents: 05:13:51 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/da396cf5a1fe094963c98cd6836aec1563b157501e2e7df486ebbcd5e73a1f1f40e36d36243bdb7799e4ce2a1c4f20fc2e4b9d950a543449426e92d58d509f34", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/0925c121f34bc6f72e7146d7b51b7e5add67e109d87ab1d62ed3fbcbb18bfefb7da3bfa02b65a68dfff50eaf6408232b60734483a8ca0ad79e1ede7736f4b224", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e59776e6bbe9535aa64700c2f761621ab052ac7da1efd5bd2a4b8079a349c0f30422feea068b27cb4645c8f1bc7581307f6b7eefae8bb18c5b75575a8d1ce808", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/38082611e05e5077173ef527691d85a85ec74b17e53c81449323a15394f833f551c71653dbd9d1ce1d01ff60267e8bb0a2deca24744bc9e952ee53863d1ad480"} 05:13:51 INFO - Running post-run listener: copy_logs_to_upload_dir 05:13:51 INFO - Copying logs to upload dir... 05:13:51 INFO - mkdir: /builds/slave/test/build/upload/logs 05:13:51 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1247.126448 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 47 secs) (at 2017-02-01 05:13:50.888441) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-02-01 05:13:50.892397) ========= 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=9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/da396cf5a1fe094963c98cd6836aec1563b157501e2e7df486ebbcd5e73a1f1f40e36d36243bdb7799e4ce2a1c4f20fc2e4b9d950a543449426e92d58d509f34", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/0925c121f34bc6f72e7146d7b51b7e5add67e109d87ab1d62ed3fbcbb18bfefb7da3bfa02b65a68dfff50eaf6408232b60734483a8ca0ad79e1ede7736f4b224", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e59776e6bbe9535aa64700c2f761621ab052ac7da1efd5bd2a4b8079a349c0f30422feea068b27cb4645c8f1bc7581307f6b7eefae8bb18c5b75575a8d1ce808", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/38082611e05e5077173ef527691d85a85ec74b17e53c81449323a15394f833f551c71653dbd9d1ce1d01ff60267e8bb0a2deca24744bc9e952ee53863d1ad480"} build_url:https://queue.taskcluster.net/v1/task/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011290 build_url: 'https://queue.taskcluster.net/v1/task/VnnkjD7MTYqEJ8m5I6V2zg/artifacts/public/build/target.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/da396cf5a1fe094963c98cd6836aec1563b157501e2e7df486ebbcd5e73a1f1f40e36d36243bdb7799e4ce2a1c4f20fc2e4b9d950a543449426e92d58d509f34", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/0925c121f34bc6f72e7146d7b51b7e5add67e109d87ab1d62ed3fbcbb18bfefb7da3bfa02b65a68dfff50eaf6408232b60734483a8ca0ad79e1ede7736f4b224", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/e59776e6bbe9535aa64700c2f761621ab052ac7da1efd5bd2a4b8079a349c0f30422feea068b27cb4645c8f1bc7581307f6b7eefae8bb18c5b75575a8d1ce808", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox-Non-PGO/sha512/38082611e05e5077173ef527691d85a85ec74b17e53c81449323a15394f833f551c71653dbd9d1ce1d01ff60267e8bb0a2deca24744bc9e952ee53863d1ad480"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-02-01 05:13:50.916779) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-02-01 05:13:50.917101) ========= 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=9c43b49b387003dc8f5b4e5c000001c4-1485950319.125370-101132917 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004397 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-02-01 05:13:51.002882) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-02-01 05:13:51.003204) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-02-01 05:13:51.003482) ========= ========= Total master_lag: 0.17 =========